1828308 - Intermittent browser/components/search/test/browser/telemetry/browser_search_telemetry_sources_ads.js | single tracking bug

Status: RESOLVED FIXED

(Firefox :: Search, defect, P5)

Description

[Treeherder Bug Filer]

Filed by: csabou [at] mozilla.com
Parsed log: https://treeherder.mozilla.org/logviewer?job_id=412589212&repo=autoland
Full log: https://firefox-ci-tc.services.mozilla.com/api/queue/v1/task/etF9tV46Q26CgHo-wsjjGg/runs/0/artifacts/public/logs/live_backing.log

---

[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - TEST-PASS | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | Should have matched impression values. - {"source":"unknown","provider":"example","partner_code":"","impression_id":"76bd6602-0074-4d24-a76b-b619a4718414","tagged":"false"} deepEqual {"provider":"example","tagged":"false","partner_code":"","source":"unknown","impression_id":"76bd6602-0074-4d24-a76b-b619a4718414"} - 
[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - TEST-PASS | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | Should have equal number of engagements. - 0 == 0 - 
[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - Leaving test bound test_track_ad_organic
[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - Entering test bound test_track_ad_new_window
[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - Buffered messages finished
[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - TEST-UNEXPECTED-FAIL | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | Test timed out - 
[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - Not taking screenshot here: see the one that was previously logged
[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - TEST-UNEXPECTED-FAIL | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | Uncaught exception received from previously timed out test bound test_track_ad_new_window - focus listener not removed before the end of test
[task 2023-04-15T22:26:42.082Z] 22:26:42     INFO - Entering test bound test_track_ad_pages_without_ads
[task 2023-04-15T22:26:42.668Z] 22:26:42     INFO - GECKO(4844) | MEMORY STAT | vsize 1325MB | vsizeMaxContiguous 130MB | residentFast 413MB | heapAllocated 442MB
[task 2023-04-15T22:26:42.668Z] 22:26:42     INFO - TEST-OK | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | took 45733ms
[task 2023-04-15T22:26:42.668Z] 22:26:42     INFO - Not taking screenshot here: see the one that was previously logged
[task 2023-04-15T22:26:42.668Z] 22:26:42     INFO - TEST-UNEXPECTED-FAIL | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | Found a tab after previous test timed out: https://example.org/browser/browser/components/search/test/browser/searchTelemetryAd.html?s=test&abc=ff - 
[task 2023-04-15T22:26:42.675Z] 22:26:42     INFO - Not taking screenshot here: see the one that was previously logged
[task 2023-04-15T22:26:42.675Z] 22:26:42     INFO - TEST-UNEXPECTED-FAIL | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | Found a tab after previous test timed out: https://example.org/browser/browser/components/search/test/browser/searchTelemetry.html?s=test&abc=ff - 
[task 2023-04-15T22:26:42.699Z] 22:26:42     INFO - checking window state
[task 2023-04-15T22:26:42.699Z] 22:26:42     INFO - Not taking screenshot here: see the one that was previously logged
[task 2023-04-15T22:26:42.699Z] 22:26:42     INFO - TEST-UNEXPECTED-FAIL | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | Found a browser window after previous test timed out - 
[task 2023-04-15T22:26:42.824Z] 22:26:42     INFO - TEST-START | browser/components/search/test/browser/browser_search_telemetry_sources_navigation.js
[task 2023-04-15T22:26:42.832Z] 22:26:42     INFO - Not taking screenshot here: see the one that was previously logged
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - Buffered messages logged at 22:26:42
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - Entering setup bound 
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - Buffered messages finished
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - TEST-UNEXPECTED-FAIL | browser/components/search/test/browser/browser_search_telemetry_sources_ads.js | Uncaught exception received from previously timed out test bound test_track_ad_pages_without_ads - at chrome://mochitests/content/browser/browser/components/search/test/browser/head.js:141 - TypeError: can't access property "waitForCondition", TestUtils is null
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - Stack trace:
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - assertSearchSourcesTelemetry@chrome://mochitests/content/browser/browser/components/search/test/browser/head.js:141:3
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - async*test_track_ad_pages_without_ads@chrome://mochitests/content/browser/browser/components/search/test/browser/browser_search_telemetry_sources_ads.js:512:9
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - async*handleTask@chrome://mochikit/content/browser-test.js:1043:26
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - _runTaskBasedTest@chrome://mochikit/content/browser-test.js:1115:18
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - async*Tester_execTest@chrome://mochikit/content/browser-test.js:1257:14
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - nextTest/<@chrome://mochikit/content/browser-test.js:1032:14
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - SimpleTest.waitForFocus/<@chrome://mochikit/content/tests/SimpleTest/SimpleTest.js:1056:13
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - GECKO(4844) | JavaScript error: chrome://mochikit/content/browser-test.js, line 1106: TypeError: can't access property "shift", currentScope.__tasks is null
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - Console message: [JavaScript Error: "TypeError: can't access property "shift", currentScope.__tasks is null" {file: "chrome://mochikit/content/browser-test.js" line: 1106}]
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - _runTaskBasedTest@chrome://mochikit/content/browser-test.js:1118:3
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - async*Tester_execTest@chrome://mochikit/content/browser-test.js:1257:14
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - nextTest/<@chrome://mochikit/content/browser-test.js:1032:14
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - SimpleTest.waitForFocus/<@chrome://mochikit/content/tests/SimpleTest/SimpleTest.js:1056:13
[task 2023-04-15T22:26:42.839Z] 22:26:42     INFO - 
[task 2023-04-15T22:26:42.855Z] 22:26:42     INFO - Extension loaded
[task 2023-04-15T22:26:42.894Z] 22:26:42     INFO - TEST-PASS | browser/components/search/test/browser/browser_search_telemetry_sources_navigation.js | Search provider extension should be running - "running" == "running" - 
[task 2023-04-15T22:26:42.894Z] 22:26:42     INFO - TEST-PASS | browser/components/search/test/browser/browser_search_telemetry_sources_navigation.js | Extension ID of search provider should be set - "[e-mail]" == true - 
[task 2023-04-15T22:26:43.222Z] 22:26:43     INFO - Not taking screenshot here: see the one that was previously logged

Comment 1

[Iulian Moraru]

First occurrence, so far: backfill range and retriggers.

Comment 2

[Intermittent Failures Robot]

2 failures in 3206 pushes (0.001 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 2

Platform and build breakdown:

• windows7-32-qr: 2
  • opt: 2

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-04-10&endday=2023-04-16&tree=all

Comment 3

[Intermittent Failures Robot]

3 failures in 4004 pushes (0.001 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 3

Platform and build breakdown:

• macosx1015-64-qr: 2
  • opt: 2
• windows7-32-qr: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-04-17&endday=2023-04-23&tree=all

Comment 4

[Intermittent Failures Robot]

1 failures in 3177 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 1

Platform and build breakdown:

• macosx1015-64-qr: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-04-24&endday=2023-04-30&tree=all

Comment 5

[Intermittent Failures Robot]

1 failures in 3578 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 1

Platform and build breakdown:

• windows7-32-qr: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-05-15&endday=2023-05-21&tree=all

Comment 6

[Intermittent Failures Robot]

4 failures in 3471 pushes (0.001 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 4

Platform and build breakdown:

• windows7-32-qr: 4
  • opt: 4

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-05-29&endday=2023-06-04&tree=all

Comment 7

[Intermittent Failures Robot]

1 failures in 4079 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• mozilla-central: 1

Platform and build breakdown:

• windows7-32-shippable-qr: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-06-12&endday=2023-06-18&tree=all

Comment 8

[Intermittent Failures Robot]

2 failures in 3880 pushes (0.001 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• mozilla-central: 1
• autoland: 1

Platform and build breakdown:

• windows11-64-2009-ccov-qr: 1
  • opt: 1
• windows7-32-qr: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-06-19&endday=2023-06-25&tree=all

Comment 9

[Intermittent Failures Robot]

3 failures in 3309 pushes (0.001 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 1
• mozilla-central: 2

Platform and build breakdown:

• macosx1015-64-qr: 2
  • opt: 1
  • debug: 1
• windows11-64-2009-ccov-qr: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-07-10&endday=2023-07-16&tree=all

Comment 10

[BugBot [:suhaib / :marco/ :calixte]]

https://wiki.mozilla.org/Bug_Triage#Intermittent_Test_Failure_Cleanup
For more information, please visit BugBot documentation.

Comment 11

[Stephanie Cunnane [:scunnane]]

Per bug 1829671, the directory containing this test is now browser/components/search/test/browser/telemetry.

Comment 12

[Treeherder Bug Filer]

New failure instance: https://treeherder.mozilla.org/logviewer?job_id=429421904&repo=mozilla-central

Comment 13

[Intermittent Failures Robot]

2 failures in 3337 pushes (0.001 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• mozilla-central: 2

Platform and build breakdown:

• windows11-64-2009-ccov-qr: 2
  • opt: 2

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2023-09-11&endday=2023-09-17&tree=all

Comment 14

[Stephanie Cunnane [:scunnane]]

Attachment: Bug 1828308 - Split browser_search_telemetry_sources_ads.js to prevent timeouts. r?#search-reviewers.

Comment 15

[Pulsebot]

Pushed by [e-mail]:
https://hg.mozilla.org/integration/autoland/rev/0ed6609c8d77
Split browser_search_telemetry_sources_ads.js to prevent timeouts. r=jteow.

Comment 16

[Norisz Fay [:noriszfay]]

https://hg.mozilla.org/mozilla-central/rev/0ed6609c8d77

Comment 17

[Intermittent Failures Robot]

1 failures in 4547 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• mozilla-esr115: 1

Platform and build breakdown:

• windows7-32-shippable-qr: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1828308&startday=2024-05-13&endday=2024-05-19&tree=all