Closed Bug 1758346 Opened 3 years ago Closed 3 years ago

Intermittent toolkit/components/aboutthirdparty/tests/browser/browser_aboutthirdparty.js | Test timed out -

Categories

(Firefox :: Launcher Process, defect, P5)

defect

Tracking

()

RESOLVED DUPLICATE of bug 1776048

People

(Reporter: intermittent-bug-filer, Unassigned)

References

Details

(Keywords: intermittent-failure)

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


[task 2022-03-07T10:41:10.740Z] 10:41:10     INFO - TEST-START | toolkit/components/aboutthirdparty/tests/browser/browser_aboutthirdparty.js
[task 2022-03-07T10:41:11.715Z] 10:41:11     INFO - GECKO(2156) | ### XPCOM_MEM_BLOAT_LOG defined -- logging bloat/leaks to C:\Users\task_164664223756165\AppData\Local\Temp\tmpv3eueqtn.mozrunner\runtests_leaks_tab_pid8720.log
[task 2022-03-07T10:41:11.717Z] 10:41:11     INFO - GECKO(2156) | [8720, Main Thread] WARNING: XPCOM_MEM_BLOAT_LOG is set, disabling native allocations.: file /builds/worker/checkouts/gecko/tools/profiler/core/platform.cpp:282
[task 2022-03-07T10:41:13.246Z] 10:41:13     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak ++DOCSHELL 2155b11fc00 == 7 [pid = 6072] [id = 6]
[task 2022-03-07T10:41:13.254Z] 10:41:13     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak ++DOMWINDOW == 15 (21554d07820) [pid = 6072] [serial = 15] [outer = 0]
[task 2022-03-07T10:41:13.255Z] 10:41:13     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak ++DOMWINDOW == 16 (2155b121800) [pid = 6072] [serial = 16] [outer = 21554d07820]
[task 2022-03-07T10:41:13.299Z] 10:41:13     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak ++DOMWINDOW == 17 (2155b1b1000) [pid = 6072] [serial = 17] [outer = 21554d07820]
[task 2022-03-07T10:41:13.320Z] 10:41:13     INFO - GECKO(2156) | [Parent 6072, Main Thread] WARNING: Failed to retarget HTML data delivery to the parser thread.: file /builds/worker/checkouts/gecko/parser/html/nsHtml5StreamParser.cpp:1180
[task 2022-03-07T10:41:16.603Z] 10:41:16     INFO - GECKO(2156) | [Child 1224: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 2a756707800 == 0 [pid = 1224] [id = 0] [url = about:blank]
[task 2022-03-07T10:41:16.618Z] 10:41:16     INFO - GECKO(2156) | [Child 1224: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 3 (2a751667430) [pid = 1224] [serial = 1] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:17.343Z] 10:41:17     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 215502d3000 == 6 [pid = 6072] [id = 0] [url = chrome://gfxsanity/content/sanityparent.html]
[task 2022-03-07T10:41:17.627Z] 10:41:17     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 16 (2154495b650) [pid = 6072] [serial = 1] [outer = 0] [url = chrome://gfxsanity/content/sanityparent.html]
[task 2022-03-07T10:41:17.713Z] 10:41:17     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 2718892b800 == 5 [pid = 8328] [id = 2] [url = moz-extension://92d090be-ff7f-448f-a43e-b04445d5c64a/_generated_background_page.html]
[task 2022-03-07T10:41:17.766Z] 10:41:17     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 17 (27183967d40) [pid = 8328] [serial = 5] [outer = 0] [url = moz-extension://92d090be-ff7f-448f-a43e-b04445d5c64a/_generated_background_page.html]
[task 2022-03-07T10:41:20.791Z] 10:41:20     INFO - GECKO(2156) | [Child 1224: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 2 (2a756709400) [pid = 1224] [serial = 3] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:20.794Z] 10:41:20     INFO - GECKO(2156) | [Child 1224: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 1 (2a756708000) [pid = 1224] [serial = 2] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:20.795Z] 10:41:20     INFO - GECKO(2156) | [Child 1224: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 0 (2a75670cc00) [pid = 1224] [serial = 4] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.625Z] 10:41:21     INFO - GECKO(2156) | [Child 6812: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 2 (150e4c08c00) [pid = 6812] [serial = 2] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.694Z] 10:41:21     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 15 (2155b121800) [pid = 6072] [serial = 16] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.697Z] 10:41:21     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 14 (2155567ac00) [pid = 6072] [serial = 6] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.698Z] 10:41:21     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 13 (21558e36400) [pid = 6072] [serial = 11] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.699Z] 10:41:21     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 12 (21551492800) [pid = 6072] [serial = 2] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.872Z] 10:41:21     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 16 (2718a77b000) [pid = 8328] [serial = 13] [outer = 0] [url = moz-extension://92d090be-ff7f-448f-a43e-b04445d5c64a/_generated_background_page.html]
[task 2022-03-07T10:41:21.876Z] 10:41:21     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 15 (2718a77c000) [pid = 8328] [serial = 17] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.877Z] 10:41:21     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 14 (27188929000) [pid = 8328] [serial = 2] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.877Z] 10:41:21     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 13 (2718892ec00) [pid = 8328] [serial = 10] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.878Z] 10:41:21     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 12 (2718892c400) [pid = 8328] [serial = 6] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.879Z] 10:41:21     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 11 (2718892d800) [pid = 8328] [serial = 8] [outer = 0] [url = about:blank]
[task 2022-03-07T10:41:21.879Z] 10:41:21     INFO - GECKO(2156) | [Child 8328: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 10 (2718892ac00) [pid = 8328] [serial = 4] [outer = 0] [url = about:blank]
[task 2022-03-07T10:42:41.484Z] 10:42:41     INFO - TEST-INFO | started process screenshot
[task 2022-03-07T10:42:41.559Z] 10:42:41     INFO - TEST-INFO | screenshot: exit 0
[task 2022-03-07T10:42:41.572Z] 10:42:41     INFO - Buffered messages logged at 10:41:10
[task 2022-03-07T10:42:41.572Z] 10:42:41     INFO - Entering test bound 
[task 2022-03-07T10:42:41.573Z] 10:42:41     INFO - TEST-PASS | toolkit/components/aboutthirdparty/tests/browser/browser_aboutthirdparty.js | The module file exists. - {} == true - 
[task 2022-03-07T10:42:41.573Z] 10:42:41     INFO - registerObject() done - Z:\task_164664223756165\build\tests\mochitest\browser\toolkit\components\aboutthirdparty\tests\browser\TestShellEx.dll
[task 2022-03-07T10:42:41.574Z] 10:42:41     INFO - Buffered messages logged at 10:41:13
[task 2022-03-07T10:42:41.574Z] 10:42:41     INFO - TEST-PASS | toolkit/components/aboutthirdparty/tests/browser/browser_aboutthirdparty.js | lookupModuleType() returns a correct type after system info was collected. - 4 == 4 - 
[task 2022-03-07T10:42:41.575Z] 10:42:41     INFO - Buffered messages finished
[task 2022-03-07T10:42:41.576Z] 10:42:41     INFO - TEST-UNEXPECTED-FAIL | toolkit/components/aboutthirdparty/tests/browser/browser_aboutthirdparty.js | Test timed out - 
[task 2022-03-07T10:42:41.576Z] 10:42:41     INFO - GECKO(2156) | MEMORY STAT | vsize 2104329MB | vsizeMaxContiguous 65761025MB | residentFast 291MB | heapAllocated 95MB
[task 2022-03-07T10:42:41.577Z] 10:42:41     INFO - TEST-OK | toolkit/components/aboutthirdparty/tests/browser/browser_aboutthirdparty.js | took 90763ms
[task 2022-03-07T10:42:41.578Z] 10:42:41     INFO - Not taking screenshot here: see the one that was previously logged
[task 2022-03-07T10:42:41.578Z] 10:42:41     INFO - TEST-UNEXPECTED-FAIL | toolkit/components/aboutthirdparty/tests/browser/browser_aboutthirdparty.js | Found a tab after previous test timed out: about:third-party - 
[task 2022-03-07T10:42:41.579Z] 10:42:41     INFO - GECKO(2156) | [Parent 6072, Main Thread] WARNING: '!inner', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorProtocol.cpp:184
[task 2022-03-07T10:42:41.579Z] 10:42:41     INFO - GECKO(2156) | [Parent 6072, Main Thread] WARNING: '!inner', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorProtocol.cpp:184
[task 2022-03-07T10:42:41.580Z] 10:42:41     INFO - GECKO(2156) | [Child 1224: Main Thread]: I/DocShellAndDOMWindowLeak ++DOCSHELL 2a756707800 == 1 [pid = 1224] [id = 1]
[task 2022-03-07T10:42:41.580Z] 10:42:41     INFO - GECKO(2156) | [Child 1224: Main Thread]: I/DocShellAndDOMWindowLeak ++DOMWINDOW == 1 (2a751667430) [pid = 1224] [serial = 5] [outer = 0]
[task 2022-03-07T10:42:41.581Z] 10:42:41     INFO - GECKO(2156) | [Child 1224: Main Thread]: I/DocShellAndDOMWindowLeak ++DOMWINDOW == 2 (2a756708000) [pid = 1224] [serial = 6] [outer = 2a751667430]
[task 2022-03-07T10:42:41.591Z] 10:42:41     INFO - checking window state
<...>
[task 2022-03-07T10:42:42.230Z] 10:42:42     INFO - GECKO(2156) | [Child 6736: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 0 (1cd79967430) [pid = 6736] [serial = 1] [outer = 0] [url = about:blank]
[task 2022-03-07T10:42:43.131Z] 10:42:43     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 12 (21554d07820) [pid = 6072] [serial = 15] [outer = 0] [url = about:third-party]
[task 2022-03-07T10:42:43.136Z] 10:42:43     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 11 (2155622b000) [pid = 6072] [serial = 9] [outer = 0] [url = about:blank]
[task 2022-03-07T10:42:43.137Z] 10:42:43     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 10 (2155b1b1000) [pid = 6072] [serial = 17] [outer = 0] [url = about:third-party]
[task 2022-03-07T10:42:43.265Z] 10:42:43     INFO - GECKO(2156) | Completed ShutdownLeaks collections in process 1224
[task 2022-03-07T10:42:43.284Z] 10:42:43     INFO - GECKO(2156) | Completed ShutdownLeaks collections in process 6812
[task 2022-03-07T10:42:43.285Z] 10:42:43     INFO - GECKO(2156) | Completed ShutdownLeaks collections in process 6736
[task 2022-03-07T10:42:43.483Z] 10:42:43     INFO - GECKO(2156) | Completed ShutdownLeaks collections in process 8328
[task 2022-03-07T10:42:43.498Z] 10:42:43     INFO - GECKO(2156) | [Parent 6072, IPC I/O Parent] WARNING: file /builds/worker/checkouts/gecko/ipc/chromium/src/base/process_util_win.cc:167
[task 2022-03-07T10:42:43.498Z] 10:42:43     INFO - GECKO(2156) | [Parent 6072, IPC I/O Parent] WARNING: file /builds/worker/checkouts/gecko/ipc/chromium/src/base/process_util_win.cc:167
[task 2022-03-07T10:42:43.499Z] 10:42:43     INFO - GECKO(2156) | [Parent 6072, IPC I/O Parent] WARNING: file /builds/worker/checkouts/gecko/ipc/chromium/src/base/process_util_win.cc:167
[task 2022-03-07T10:42:43.502Z] 10:42:43     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak ++DOMWINDOW == 11 (215500aa000) [pid = 6072] [serial = 19] [outer = 2154495bbc0]
[task 2022-03-07T10:42:45.415Z] 10:42:45     INFO - GECKO(2156) | [Parent 6072: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 10 (215500b0c00) [pid = 6072] [serial = 18] [outer = 0] [url = about:blank]
[task 2022-03-07T10:42:45.763Z] 10:42:45     INFO - GECKO(2156) | Completed ShutdownLeaks collections in process 6072
[task 2022-03-07T10:42:45.769Z] 10:42:45     INFO - TEST-START | Shutdown
[task 2022-03-07T10:42:45.770Z] 10:42:45     INFO - Browser Chrome Test Summary
[task 2022-03-07T10:42:45.770Z] 10:42:45     INFO - Passed:  2
[task 2022-03-07T10:42:45.771Z] 10:42:45     INFO - Failed:  2
[task 2022-03-07T10:42:45.771Z] 10:42:45     INFO - Todo:    0
[task 2022-03-07T10:42:45.772Z] 10:42:45     INFO - Mode:    e10s
[task 2022-03-07T10:42:45.772Z] 10:42:45     INFO - *** End BrowserChrome Test Results ***
Status: NEW → RESOLVED
Closed: 3 years ago
Resolution: --- → DUPLICATE
You need to log in before you can comment on or make changes to this bug.