Closed Bug 1703543 Opened 3 years ago Closed 3 years ago

Intermittent devtools/shared/commands/target-configuration/tests/browser_target_configuration_command_dppx.js | leaked 3 window(s) until shutdown [url = https://example.com/browser/devtools/shared/commands/target-configuration/tests/doc_media_queries.sjs]

Categories

(DevTools :: General, defect, P5)

defect

Tracking

(firefox-esr78 unaffected, firefox87 unaffected, firefox88 unaffected, firefox89 fixed)

RESOLVED FIXED
89 Branch
Tracking Status
firefox-esr78 --- unaffected
firefox87 --- unaffected
firefox88 --- unaffected
firefox89 --- fixed

People

(Reporter: intermittent-bug-filer, Assigned: nchevobbe)

References

(Regression)

Details

(Keywords: intermittent-failure, regression)

Attachments

(1 file)

Filed by: dluca [at] mozilla.com
Parsed log: https://treeherder.mozilla.org/logviewer?job_id=335704266&repo=autoland
Full log: https://firefox-ci-tc.services.mozilla.com/api/queue/v1/task/Kp_28amVTXaahlCR64bEoQ/runs/0/artifacts/public/logs/live_backing.log
Reftest URL: https://hg.mozilla.org/mozilla-central/raw-file/tip/layout/tools/reftest/reftest-analyzer.xhtml#logurl=https://firefox-ci-tc.services.mozilla.com/api/queue/v1/task/Kp_28amVTXaahlCR64bEoQ/runs/0/artifacts/public/logs/live_backing.log&only_show_unexpected=1


INFO - TEST-START | Shutdown
[task 2021-04-07T12:45:49.293Z] 12:45:49     INFO - Browser Chrome Test Summary
[task 2021-04-07T12:45:49.294Z] 12:45:49     INFO - Passed:  15
[task 2021-04-07T12:45:49.295Z] 12:45:49     INFO - Failed:  0
[task 2021-04-07T12:45:49.296Z] 12:45:49     INFO - Todo:    0
[task 2021-04-07T12:45:49.297Z] 12:45:49     INFO - Mode:    e10s
[task 2021-04-07T12:45:49.297Z] 12:45:49     INFO - *** End BrowserChrome Test Results ***
[task 2021-04-07T12:45:49.371Z] 12:45:49     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: '!CanSend() || !mManager || !mManager->CanSend()', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorChild.cpp:40
[task 2021-04-07T12:45:49.374Z] 12:45:49     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: '!CanSend() || !mManager || !mManager->CanSend()', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorChild.cpp:40
[task 2021-04-07T12:45:49.390Z] 12:45:49     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: '!CanSend() || !mManager || !mManager->CanSend()', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorChild.cpp:40
[task 2021-04-07T12:45:49.412Z] 12:45:49     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: '!CanSend() || !mManager || !mManager->CanSend()', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorChild.cpp:40
[task 2021-04-07T12:45:49.437Z] 12:45:49     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: '!CanSend() || !mManager || !mManager->CanSend()', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorChild.cpp:40
[task 2021-04-07T12:45:49.438Z] 12:45:49     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: '!CanSend() || !mManager || !mManager->CanSend()', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorChild.cpp:40
[task 2021-04-07T12:45:49.536Z] 12:45:49     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f6554b18800 == 4 [pid = 7262] [id = 1] [url = chrome://extensions/content/dummy.xhtml]
[task 2021-04-07T12:45:49.918Z] 12:45:49     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:49.921Z] 12:45:49     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:49.925Z] 12:45:49     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:49.926Z] 12:45:49     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f88c37ddc00 == 3 [pid = 7317] [id = 4] [url = moz-extension://17c633af-3c98-42b6-bb7f-73cc2032ee17/_generated_background_page.html]
[task 2021-04-07T12:45:49.928Z] 12:45:49     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f88c9947800 == 2 [pid = 7317] [id = 3] [url = moz-extension://c5636f36-511e-43af-b605-fd967d9d648f/_generated_background_page.html]
[task 2021-04-07T12:45:49.929Z] 12:45:49     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f88c9896000 == 1 [pid = 7317] [id = 0] [url = moz-extension://d133c1da-fcdc-4633-af78-b93d81d47312/_generated_background_page.html]
[task 2021-04-07T12:45:49.930Z] 12:45:49     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f88c989c000 == 0 [pid = 7317] [id = 1] [url = moz-extension://e03f9d36-f6ac-4b5a-9b58-68dfa1f71e30/_generated_background_page.html]
[task 2021-04-07T12:45:50.072Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f654d3acc00 == 3 [pid = 7262] [id = 6] [url = chrome://mochikit/content/browser-harness.xhtml]
[task 2021-04-07T12:45:50.073Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f6559d53000 == 2 [pid = 7262] [id = 2] [url = about:blank]
[task 2021-04-07T12:45:50.153Z] 12:45:50     INFO - GECKO(7262) | [2021-04-07T12:45:50Z WARN  xulstore::persist] tried to remove key that isn't in the store
[task 2021-04-07T12:45:50.155Z] 12:45:50     INFO - GECKO(7262) | [2021-04-07T12:45:50Z WARN  xulstore::persist] tried to remove key that isn't in the store
[task 2021-04-07T12:45:50.156Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, Main Thread] WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0x80040111 (NS_ERROR_NOT_AVAILABLE): file /builds/worker/checkouts/gecko/netwerk/cache/nsApplicationCacheService.cpp:161
[task 2021-04-07T12:45:50.212Z] 12:45:50     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 7 (7f88dfe63200) [pid = 7317] [serial = 9] [outer = 0] [url = moz-extension://17c633af-3c98-42b6-bb7f-73cc2032ee17/_generated_background_page.html]
[task 2021-04-07T12:45:50.214Z] 12:45:50     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 6 (7f88c9880e40) [pid = 7317] [serial = 7] [outer = 0] [url = moz-extension://c5636f36-511e-43af-b605-fd967d9d648f/_generated_background_page.html]
[task 2021-04-07T12:45:50.215Z] 12:45:50     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 5 (7f88c9880ac0) [pid = 7317] [serial = 3] [outer = 0] [url = moz-extension://e03f9d36-f6ac-4b5a-9b58-68dfa1f71e30/_generated_background_page.html]
[task 2021-04-07T12:45:50.216Z] 12:45:50     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 4 (7f88c9880580) [pid = 7317] [serial = 1] [outer = 0] [url = moz-extension://d133c1da-fcdc-4633-af78-b93d81d47312/_generated_background_page.html]
[task 2021-04-07T12:45:50.217Z] 12:45:50     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 3 (7f88c37e3400) [pid = 7317] [serial = 11] [outer = 0] [url = moz-extension://d133c1da-fcdc-4633-af78-b93d81d47312/_generated_background_page.html]
[task 2021-04-07T12:45:50.218Z] 12:45:50     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 2 (7f88c2c7c400) [pid = 7317] [serial = 12] [outer = 0] [url = moz-extension://e03f9d36-f6ac-4b5a-9b58-68dfa1f71e30/_generated_background_page.html]
[task 2021-04-07T12:45:50.219Z] 12:45:50     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 1 (7f88c2c82400) [pid = 7317] [serial = 14] [outer = 0] [url = moz-extension://c5636f36-511e-43af-b605-fd967d9d648f/_generated_background_page.html]
[task 2021-04-07T12:45:50.221Z] 12:45:50     INFO - GECKO(7262) | [Child 7317: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 0 (7f88c2c84c00) [pid = 7317] [serial = 15] [outer = 0] [url = moz-extension://17c633af-3c98-42b6-bb7f-73cc2032ee17/_generated_background_page.html]
[task 2021-04-07T12:45:50.222Z] 12:45:50     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: Extra shutdown CC: 'i < NORMAL_SHUTDOWN_COLLECTIONS', file /builds/worker/checkouts/gecko/xpcom/base/nsCycleCollector.cpp:3361
[task 2021-04-07T12:45:50.223Z] 12:45:50     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: '!obs', file /builds/worker/checkouts/gecko/toolkit/components/sessionstore/RestoreTabContentObserver.cpp:58
[task 2021-04-07T12:45:50.247Z] 12:45:50     INFO - GECKO(7262) | [Child 7317, Main Thread] WARNING: NS_ENSURE_TRUE(Preferences::InitStaticMembers()) failed: file /builds/worker/checkouts/gecko/modules/libpref/Preferences.cpp:4442
[task 2021-04-07T12:45:50.618Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.620Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.636Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.638Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.640Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.657Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.659Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.660Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.662Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.663Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.669Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.673Z] 12:45:50     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:50.750Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.000002s: starting', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.752Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.001088s: Live database entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.753Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.001108s: gLiveDatabaseHashtable entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.755Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.004325s: Live database entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.757Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.004347s: gLiveDatabaseHashtable entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.759Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: cache: '0.007246s: starting', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.760Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: sdb: '0.007265s: starting', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.763Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: ls: '0.007272s: starting', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.764Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.008640s: Live database entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.765Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.008660s: gLiveDatabaseHashtable entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.767Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.011688s: Live database entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.768Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.011712s: gLiveDatabaseHashtable entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.770Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.012545s: Live database entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.772Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.013446s: Live database entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.773Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.013463s: gLiveDatabaseHashtable entry removed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.775Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: idb: '0.014170s: completed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.776Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: cache: '0.016378s: completed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.778Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: sdb: '0.016401s: completed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.779Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262, IPDL Background] WARNING: ls: '0.016409s: completed', file /builds/worker/checkouts/gecko/dom/quota/ActorsParent.cpp:3686
[task 2021-04-07T12:45:50.781Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f6553396000 == 1 [pid = 7262] [id = 3] [url = resource://gre-resources/hiddenWindow.html]
[task 2021-04-07T12:45:50.789Z] 12:45:50     INFO - GECKO(7262) | [Child 7483, Main Thread] WARNING: Extra shutdown CC: 'i < NORMAL_SHUTDOWN_COLLECTIONS', file /builds/worker/checkouts/gecko/xpcom/base/nsCycleCollector.cpp:3361
[task 2021-04-07T12:45:50.826Z] 12:45:50     INFO - GECKO(7262) | [Child 7483, Main Thread] WARNING: '!obs', file /builds/worker/checkouts/gecko/toolkit/components/sessionstore/RestoreTabContentObserver.cpp:58
[task 2021-04-07T12:45:50.867Z] 12:45:50     INFO - GECKO(7262) | [Child 7483, Main Thread] WARNING: NS_ENSURE_TRUE(Preferences::InitStaticMembers()) failed: file /builds/worker/checkouts/gecko/modules/libpref/Preferences.cpp:4442
[task 2021-04-07T12:45:50.904Z] 12:45:50     INFO - GECKO(7262) | [Child 7340: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f287eeac000 == 0 [pid = 7340] [id = 3] [url = about:blank]
[task 2021-04-07T12:45:50.981Z] 12:45:50     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOCSHELL 7f65585f4800 == 0 [pid = 7262] [id = 0] [url = chrome://browser/content/browser.xhtml]
[task 2021-04-07T12:45:50.990Z] 12:45:50     INFO - GECKO(7262) | [Child 7430, Main Thread] WARNING: Extra shutdown CC: 'i < NORMAL_SHUTDOWN_COLLECTIONS', file /builds/worker/checkouts/gecko/xpcom/base/nsCycleCollector.cpp:3361
[task 2021-04-07T12:45:50.999Z] 12:45:50     INFO - GECKO(7262) | [Child 7430, Main Thread] WARNING: '!obs', file /builds/worker/checkouts/gecko/toolkit/components/sessionstore/RestoreTabContentObserver.cpp:58
[task 2021-04-07T12:45:51.035Z] 12:45:51     INFO - GECKO(7262) | [Child 7391, Main Thread] WARNING: Extra shutdown CC: 'i < NORMAL_SHUTDOWN_COLLECTIONS', file /builds/worker/checkouts/gecko/xpcom/base/nsCycleCollector.cpp:3361
[task 2021-04-07T12:45:51.048Z] 12:45:51     INFO - GECKO(7262) | [Child 7391, Main Thread] WARNING: '!obs', file /builds/worker/checkouts/gecko/toolkit/components/sessionstore/RestoreTabContentObserver.cpp:58
[task 2021-04-07T12:45:51.050Z] 12:45:51     INFO - GECKO(7262) | [Child 7430, Main Thread] WARNING: NS_ENSURE_TRUE(Preferences::InitStaticMembers()) failed: file /builds/worker/checkouts/gecko/modules/libpref/Preferences.cpp:4442
[task 2021-04-07T12:45:51.112Z] 12:45:51     INFO - GECKO(7262) | [Child 7391, Main Thread] WARNING: NS_ENSURE_TRUE(Preferences::InitStaticMembers()) failed: file /builds/worker/checkouts/gecko/modules/libpref/Preferences.cpp:4442
[task 2021-04-07T12:45:51.154Z] 12:45:51     INFO - GECKO(7262) | [Child 7340: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 1 (7f287ee37040) [pid = 7340] [serial = 11] [outer = 0] [url = about:blank]
[task 2021-04-07T12:45:51.158Z] 12:45:51     INFO - GECKO(7262) | [Child 7340: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 0 (7f287eeadc00) [pid = 7340] [serial = 12] [outer = 0] [url = about:blank]
[task 2021-04-07T12:45:51.159Z] 12:45:51     INFO - GECKO(7262) | [Child 7340, Main Thread] WARNING: Extra shutdown CC: 'i < NORMAL_SHUTDOWN_COLLECTIONS', file /builds/worker/checkouts/gecko/xpcom/base/nsCycleCollector.cpp:3361
[task 2021-04-07T12:45:51.161Z] 12:45:51     INFO - GECKO(7262) | [Child 7340, Main Thread] WARNING: '!obs', file /builds/worker/checkouts/gecko/toolkit/components/sessionstore/RestoreTabContentObserver.cpp:58
[task 2021-04-07T12:45:51.203Z] 12:45:51     INFO - GECKO(7262) | [Child 7340, Main Thread] WARNING: NS_ENSURE_TRUE(Preferences::InitStaticMembers()) failed: file /builds/worker/checkouts/gecko/modules/libpref/Preferences.cpp:4442
[task 2021-04-07T12:45:51.281Z] 12:45:51     INFO - GECKO(7262) | [Child 7450: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 4 (7f96d7307040) [pid = 7450] [serial = 4] [outer = 0] [url = https://example.org/document-builder.sjs?html=%0A%20%20%20%20%3C!doctype%20html%3E%0A%20%20%3Chtml%3E%0A%20%20%20%20%3Chead%3E%0A%20%20%20%20%20%20%3Cmeta%20charset=utf8%3E%0A%20%20%20%20%20%20%3Cscript%3E%0A%20%20%20%20%20%20%20%20globalThis.initialMatchesPrefersDarkColorScheme%20=%0A%20%20%20%20%20%20%20%20%20%20window.matchMedia(%22(prefers-color-scheme:%20dark)%22).matches;%0A%20%20%20%20%20%20%20%20globalThis.initialDevicePixelRatio%20=%20window.devicePixelRatio;%0A%20%20%20%20%20%20%3C/script%3E%0A%20%20%20%20%20%20%3Cstyle%3E%0A%20%20%20%20%20%20%20%20html%20%7B%20background:%20cyan;%7D%0A%20%20%20%20%20%20%20%20@media%20(prefers-color-scheme:%20dark)%20%7B%0A%20%20%20%20%20%20%20%20%20%20html%20%7Bbackground:%20darkred;%7D%0A%20%20%20%20%20%20%20%20%7D%0A%20%20%20%20%20%20%3C/style%3E%0A%20%20%20%20%3C/head%3E%0A%20%20%20%20%3Cbody%3EIframe%3C/body%3E%0A%20%20%3C/html%3E]
[task 2021-04-07T12:45:51.283Z] 12:45:51     INFO - GECKO(7262) | [Child 7450: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 3 (7f96f4463200) [pid = 7450] [serial = 1] [outer = 0] [url = https://example.com/browser/devtools/shared/commands/target-configuration/tests/doc_media_queries.sjs]
[task 2021-04-07T12:45:51.286Z] 12:45:51     INFO - GECKO(7262) | [Child 7450: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 2 (7f96d7cc7000) [pid = 7450] [serial = 3] [outer = 0] [url = https://example.com/browser/devtools/shared/commands/target-configuration/tests/doc_media_queries.sjs]
[task 2021-04-07T12:45:51.287Z] 12:45:51     INFO - GECKO(7262) | [Child 7450: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 1 (7f96d738e000) [pid = 7450] [serial = 5] [outer = 0] [url = https://example.org/document-builder.sjs?html=%0A%20%20%20%20%3C!doctype%20html%3E%0A%20%20%3Chtml%3E%0A%20%20%20%20%3Chead%3E%0A%20%20%20%20%20%20%3Cmeta%20charset=utf8%3E%0A%20%20%20%20%20%20%3Cscript%3E%0A%20%20%20%20%20%20%20%20globalThis.initialMatchesPrefersDarkColorScheme%20=%0A%20%20%20%20%20%20%20%20%20%20window.matchMedia(%22(prefers-color-scheme:%20dark)%22).matches;%0A%20%20%20%20%20%20%20%20globalThis.initialDevicePixelRatio%20=%20window.devicePixelRatio;%0A%20%20%20%20%20%20%3C/script%3E%0A%20%20%20%20%20%20%3Cstyle%3E%0A%20%20%20%20%20%20%20%20html%20%7B%20background:%20cyan;%7D%0A%20%20%20%20%20%20%20%20@media%20(prefers-color-scheme:%20dark)%20%7B%0A%20%20%20%20%20%20%20%20%20%20html%20%7Bbackground:%20darkred;%7D%0A%20%20%20%20%20%20%20%20%7D%0A%20%20%20%20%20%20%3C/style%3E%0A%20%20%20%20%3C/head%3E%0A%20%20%20%20%3Cbody%3EIframe%3C/body%3E%0A%20%20%3C/html%3E]
[task 2021-04-07T12:45:51.289Z] 12:45:51     INFO - GECKO(7262) | [Child 7450: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 0 (7f96d7397c00) [pid = 7450] [serial = 6] [outer = 0] [url = https://example.com/browser/devtools/shared/commands/target-configuration/tests/doc_media_queries.sjs]
[task 2021-04-07T12:45:51.290Z] 12:45:51     INFO - GECKO(7262) | [Child 7450, Main Thread] WARNING: Extra shutdown CC: 'i < NORMAL_SHUTDOWN_COLLECTIONS', file /builds/worker/checkouts/gecko/xpcom/base/nsCycleCollector.cpp:3361
[task 2021-04-07T12:45:51.292Z] 12:45:51     INFO - GECKO(7262) | [Child 7450, Main Thread] WARNING: '!obs', file /builds/worker/checkouts/gecko/toolkit/components/sessionstore/RestoreTabContentObserver.cpp:58
[task 2021-04-07T12:45:51.308Z] 12:45:51     INFO - GECKO(7262) | [Child 7450, Main Thread] WARNING: NS_ENSURE_TRUE(Preferences::InitStaticMembers()) failed: file /builds/worker/checkouts/gecko/modules/libpref/Preferences.cpp:4442
[task 2021-04-07T12:45:51.337Z] 12:45:51     INFO - GECKO(7262) | 1617799551331	Marionette	TRACE	Received observer notification xpcom-will-shutdown
[task 2021-04-07T12:45:51.338Z] 12:45:51     INFO - GECKO(7262) | 1617799551332	Marionette	INFO	Stopped listening on port 2828
[task 2021-04-07T12:45:51.339Z] 12:45:51     INFO - GECKO(7262) | 1617799551332	Marionette	DEBUG	Marionette stopped listening
[task 2021-04-07T12:45:51.420Z] 12:45:51     INFO - GECKO(7262) | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2021-04-07T12:45:52.412Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 9 (7f65585f4000) [pid = 7262] [serial = 2] [outer = 0] [url = about:blank]
[task 2021-04-07T12:45:52.414Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 8 (7f655854dac0) [pid = 7262] [serial = 1] [outer = 0] [url = chrome://browser/content/browser.xhtml]
[task 2021-04-07T12:45:52.415Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 7 (7f654e243e40) [pid = 7262] [serial = 14] [outer = 0] [url = chrome://mochikit/content/browser-harness.xhtml]
[task 2021-04-07T12:45:52.416Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 6 (7f654d3b8c00) [pid = 7262] [serial = 15] [outer = 0] [url = about:blank]
[task 2021-04-07T12:45:52.419Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 5 (7f6555f7d900) [pid = 7262] [serial = 5] [outer = 0] [url = about:blank]
[task 2021-04-07T12:45:52.420Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 4 (7f654d3b0000) [pid = 7262] [serial = 17] [outer = 0] [url = about:blank]
[task 2021-04-07T12:45:52.421Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 3 (7f6555f7d3c0) [pid = 7262] [serial = 3] [outer = 0] [url = chrome://extensions/content/dummy.xhtml]
[task 2021-04-07T12:45:52.423Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 2 (7f6554949400) [pid = 7262] [serial = 4] [outer = 0] [url = chrome://extensions/content/dummy.xhtml]
[task 2021-04-07T12:45:52.423Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 1 (7f657926d040) [pid = 7262] [serial = 7] [outer = 0] [url = resource://gre-resources/hiddenWindow.html]
[task 2021-04-07T12:45:52.424Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262: Main Thread]: I/DocShellAndDOMWindowLeak --DOMWINDOW == 0 (7f6554aa9c00) [pid = 7262] [serial = 9] [outer = 0] [url = resource://gre-resources/hiddenWindow.html]
[task 2021-04-07T12:45:52.440Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262, Main Thread] WARNING: Extra shutdown CC: 'i < NORMAL_SHUTDOWN_COLLECTIONS', file /builds/worker/checkouts/gecko/xpcom/base/nsCycleCollector.cpp:3361
[task 2021-04-07T12:45:52.459Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262, Main Thread] WARNING: '!obs', file /builds/worker/checkouts/gecko/toolkit/components/sessionstore/RestoreTabContentObserver.cpp:58
[task 2021-04-07T12:45:52.480Z] 12:45:52     INFO - GECKO(7262) | [Parent 7262, Main Thread] WARNING: NS_ENSURE_TRUE(Preferences::InitStaticMembers()) failed: file /builds/worker/checkouts/gecko/modules/libpref/Preferences.cpp:4442
[task 2021-04-07T12:45:52.548Z] 12:45:52     INFO - TEST-INFO | Main app process: exit 0
[task 2021-04-07T12:45:52.548Z] 12:45:52     INFO - TEST-INFO | Confirming we saw 21 DOCSHELL created and 21 destroyed log strings.
[task 2021-04-07T12:45:52.550Z] 12:45:52     INFO - TEST-INFO | Confirming we saw 58 DOMWINDOW created and 58 destroyed log strings.
[task 2021-04-07T12:45:52.550Z] 12:45:52    ERROR - TEST-UNEXPECTED-FAIL | devtools/shared/commands/target-configuration/tests/browser_target_configuration_command_dppx.js | leaked 3 window(s) until shutdown [url = https://example.com/browser/devtools/shared/commands/target-configuration/tests/doc_media_queries.sjs]
[task 2021-04-07T12:45:52.551Z] 12:45:52    ERROR - TEST-UNEXPECTED-FAIL | devtools/shared/commands/target-configuration/tests/browser_target_configuration_command_dppx.js | leaked 2 window(s) until shutdown [url = https://example.org/document-builder.sjs?html=%0A%20%20%20%20%3C!doctype%20html%3E%0A%20%20%3Chtml%3E%0A%20%20%20%20%3Chead%3E%0A%20%20%20%20%20%20%3Cmeta%20charset=utf8%3E%0A%20%20%20%20%20%20%3Cscript%3E%0A%20%20%20%20%20%20%20%20globalThis.initialMatchesPrefersDarkColorScheme%20=%0A%20%20%20%20%20%20%20%20%20%20window.matchMedia(%22(prefers-color-scheme:%20dark)%22).matches;%0A%20%20%20%20%20%20%20%20globalThis.initialDevicePixelRatio%20=%20window.devicePixelRatio;%0A%20%20%20%20%20%20%3C/script%3E%0A%20%20%20%20%20%20%3Cstyle%3E%0A%20%20%20%20%20%20%20%20html%20%7B%20background:%20cyan;%7D%0A%20%20%20%20%20%20%20%20@media%20(prefers-color-scheme:%20dark)%20%7B%0A%20%20%20%20%20%20%20%20%20%20html%20%7Bbackground:%20darkred;%7D%0A%20%20%20%20%20%20%20%20%7D%0A%20%20%20%20%20%20%3C/style%3E%0A%20%20%20%20%3C/head%3E%0A%20%20%20%20%3Cbody%3EIframe%3C/body%3E%0A%20%20%3C/html%3E]
[task 2021-04-07T12:45:52.551Z] 12:45:52     INFO - TEST-INFO | devtools/shared/commands/target-configuration/tests/browser_target_configuration_command_dppx.js | windows(s) leaked: [pid = 7450] [serial = 3], [pid = 7450] [serial = 4], [pid = 7450] [serial = 5], [pid = 7450] [serial = 6], [pid = 7450] [serial = 1]
[task 2021-04-07T12:45:52.552Z] 12:45:52     INFO - TEST-INFO | devtools/shared/commands/target-configuration/tests/browser_target_configuration_command_dppx.js | This test created 1 hidden window(s)
[task 2021-04-07T12:45:52.553Z] 12:45:52     INFO - TEST-INFO | devtools/shared/commands/target-configuration/tests/browser_target_configuration_command_dppx.js | This test created 1 hidden docshell(s)
[task 2021-04-07T12:45:52.553Z] 12:45:52     INFO - runtests.py | Application ran for: 0:00:30.323624
[task 2021-04-07T12:45:52.554Z] 12:45:52     INFO - zombiecheck | Reading PID log: /tmp/tmpxt_xWJpidlog
[task 2021-04-07T12:45:52.554Z] 12:45:52     INFO - ==> process 7262 launched child process 7282
[task 2021-04-07T12:45:52.556Z] 12:45:52     INFO - ==> process 7262 launched child process 7317
[task 2021-04-07T12:45:52.556Z] 12:45:52     INFO - ==> process 7262 launched child process 7340
[task 2021-04-07T12:45:52.557Z] 12:45:52     INFO - ==> process 7262 launched child process 7391
[task 2021-04-07T12:45:52.557Z] 12:45:52     INFO - ==> process 7262 launched child process 7430
[task 2021-04-07T12:45:52.557Z] 12:45:52     INFO - ==> process 7262 launched child process 7450
[task 2021-04-07T12:45:52.558Z] 12:45:52     INFO - ==> process 7262 launched child process 7483
[task 2021-04-07T12:45:52.558Z] 12:45:52     INFO - zombiecheck | Checking for orphan process with PID: 7430
[task 2021-04-07T12:45:52.559Z] 12:45:52     INFO - zombiecheck | Checking for orphan process with PID: 7340
[task 2021-04-07T12:45:52.559Z] 12:45:52     INFO - zombiecheck | Checking for orphan process with PID: 7282
[task 2021-04-07T12:45:52.560Z] 12:45:52     INFO - zombiecheck | Checking for orphan process with PID: 7317
[task 2021-04-07T12:45:52.560Z] 12:45:52     INFO - zombiecheck | Checking for orphan process with PID: 7450
[task 2021-04-07T12:45:52.561Z] 12:45:52     INFO - zombiecheck | Checking for orphan process with PID: 7483
[task 2021-04-07T12:45:52.562Z] 12:45:52     INFO - zombiecheck | Checking for orphan process with PID: 7391
[task 2021-04-07T12:45:52.562Z] 12:45:52     INFO - Stopping web server
[task 2021-04-07T12:45:52.564Z] 12:45:52     INFO - Server shut down.
[task 2021-04-07T12:45:52.585Z] 12:45:52     INFO - Web server killed.
[task 2021-04-07T12:45:52.585Z] 12:45:52     INFO - Stopping web socket server
[task 2021-04-07T12:45:52.605Z] 12:45:52     INFO - Stopping ssltunnel
[task 2021-04-07T12:45:52.627Z] 12:45:52     INFO - leakcheck | Processing log file /tmp/tmpaTp0gU.mozrunner/runtests_leaks.log
[task 2021-04-07T12:45:52.628Z] 12:45:52     INFO - TEST-INFO | leakcheck | default process: leak threshold set at 0 bytes
[task 2021-04-07T12:45:52.628Z] 12:45:52     INFO - TEST-INFO | leakcheck | forkserver process: leak threshold set at 0 bytes
[task 2021-04-07T12:45:52.629Z] 12:45:52     INFO - TEST-INFO | leakcheck | gmplugin process: leak threshold set at 20000 bytes
[task 2021-04-07T12:45:52.630Z] 12:45:52     INFO - TEST-INFO | leakcheck | gpu process: leak threshold set at 0 bytes
[task 2021-04-07T12:45:52.630Z] 12:45:52     INFO - TEST-INFO | leakcheck | plugin process: leak threshold set at 0 bytes
[task 2021-04-07T12:45:52.631Z] 12:45:52     INFO - TEST-INFO | leakcheck | rdd process: leak threshold set at 0 bytes
[task 2021-04-07T12:45:52.631Z] 12:45:52     INFO - TEST-INFO | leakcheck | socket process: leak threshold set at 0 bytes
[task 2021-04-07T12:45:52.632Z] 12:45:52     INFO - TEST-INFO | leakcheck | tab process: leak threshold set at 0 bytes
[task 2021-04-07T12:45:52.632Z] 12:45:52     INFO - TEST-INFO | leakcheck | vr process: leak threshold set at 0 bytes
[task 2021-04-07T12:45:52.633Z] 12:45:52     INFO - leakcheck | Processing leak log file /tmp/tmpaTp0gU.mozrunner/runtests_leaks_tab_pid7450.log
[task 2021-04-07T12:45:52.633Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.634Z] 12:45:52     INFO - == BloatView: ALL (cumulative) LEAK AND BLOAT STATISTICS, tab process 7450
[task 2021-04-07T12:45:52.634Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.635Z] 12:45:52     INFO -      |<----------------Class--------------->|<-----Bytes------>|<----Objects---->|
[task 2021-04-07T12:45:52.636Z] 12:45:52     INFO -      |                                      | Per-Inst   Leaked|   Total      Rem|
[task 2021-04-07T12:45:52.636Z] 12:45:52     INFO -    0 |TOTAL                                 |       40        0|   80892        0|
[task 2021-04-07T12:45:52.639Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.639Z] 12:45:52     INFO - nsTraceRefcnt::DumpStatistics: 887 entries
[task 2021-04-07T12:45:52.640Z] 12:45:52     INFO - TEST-PASS | leakcheck | tab no leaks detected!
[task 2021-04-07T12:45:52.641Z] 12:45:52     INFO - leakcheck | Processing leak log file /tmp/tmpaTp0gU.mozrunner/runtests_leaks_tab_pid7391.log
[task 2021-04-07T12:45:52.642Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.642Z] 12:45:52     INFO - == BloatView: ALL (cumulative) LEAK AND BLOAT STATISTICS, tab process 7391
[task 2021-04-07T12:45:52.643Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.644Z] 12:45:52     INFO -      |<----------------Class--------------->|<-----Bytes------>|<----Objects---->|
[task 2021-04-07T12:45:52.644Z] 12:45:52     INFO -      |                                      | Per-Inst   Leaked|   Total      Rem|
[task 2021-04-07T12:45:52.646Z] 12:45:52     INFO -    0 |TOTAL                                 |       31        0|  203248        0|
[task 2021-04-07T12:45:52.647Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.647Z] 12:45:52     INFO - nsTraceRefcnt::DumpStatistics: 975 entries
[task 2021-04-07T12:45:52.648Z] 12:45:52     INFO - TEST-PASS | leakcheck | tab no leaks detected!
[task 2021-04-07T12:45:52.648Z] 12:45:52     INFO - leakcheck | Processing leak log file /tmp/tmpaTp0gU.mozrunner/runtests_leaks.log
[task 2021-04-07T12:45:52.649Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.649Z] 12:45:52     INFO - == BloatView: ALL (cumulative) LEAK AND BLOAT STATISTICS, default process 7262
[task 2021-04-07T12:45:52.650Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.650Z] 12:45:52     INFO -      |<----------------Class--------------->|<-----Bytes------>|<----Objects---->|
[task 2021-04-07T12:45:52.650Z] 12:45:52     INFO -      |                                      | Per-Inst   Leaked|   Total      Rem|
[task 2021-04-07T12:45:52.651Z] 12:45:52     INFO -    0 |TOTAL                                 |       37        0| 2178901        0|
[task 2021-04-07T12:45:52.658Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.659Z] 12:45:52     INFO - nsTraceRefcnt::DumpStatistics: 1995 entries
[task 2021-04-07T12:45:52.660Z] 12:45:52     INFO - TEST-PASS | leakcheck | default no leaks detected!
[task 2021-04-07T12:45:52.662Z] 12:45:52     INFO - leakcheck | Processing leak log file /tmp/tmpaTp0gU.mozrunner/runtests_leaks_tab_pid7340.log
[task 2021-04-07T12:45:52.662Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.663Z] 12:45:52     INFO - == BloatView: ALL (cumulative) LEAK AND BLOAT STATISTICS, tab process 7340
[task 2021-04-07T12:45:52.663Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.664Z] 12:45:52     INFO -      |<----------------Class--------------->|<-----Bytes------>|<----Objects---->|
[task 2021-04-07T12:45:52.665Z] 12:45:52     INFO -      |                                      | Per-Inst   Leaked|   Total      Rem|
[task 2021-04-07T12:45:52.665Z] 12:45:52     INFO -    0 |TOTAL                                 |       38        0|  102699        0|
[task 2021-04-07T12:45:52.666Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.666Z] 12:45:52     INFO - nsTraceRefcnt::DumpStatistics: 913 entries
[task 2021-04-07T12:45:52.668Z] 12:45:52     INFO - TEST-PASS | leakcheck | tab no leaks detected!
[task 2021-04-07T12:45:52.668Z] 12:45:52     INFO - leakcheck | Processing leak log file /tmp/tmpaTp0gU.mozrunner/runtests_leaks_tab_pid7317.log
[task 2021-04-07T12:45:52.668Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.668Z] 12:45:52     INFO - == BloatView: ALL (cumulative) LEAK AND BLOAT STATISTICS, tab process 7317
[task 2021-04-07T12:45:52.668Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.669Z] 12:45:52     INFO -      |<----------------Class--------------->|<-----Bytes------>|<----Objects---->|
[task 2021-04-07T12:45:52.669Z] 12:45:52     INFO -      |                                      | Per-Inst   Leaked|   Total      Rem|
[task 2021-04-07T12:45:52.669Z] 12:45:52     INFO -    0 |TOTAL                                 |       42        0|  108223        0|
[task 2021-04-07T12:45:52.671Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.672Z] 12:45:52     INFO - nsTraceRefcnt::DumpStatistics: 824 entries
[task 2021-04-07T12:45:52.673Z] 12:45:52     INFO - TEST-PASS | leakcheck | tab no leaks detected!
[task 2021-04-07T12:45:52.673Z] 12:45:52     INFO - leakcheck | Processing leak log file /tmp/tmpaTp0gU.mozrunner/runtests_leaks_tab_pid7430.log
[task 2021-04-07T12:45:52.674Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.676Z] 12:45:52     INFO - == BloatView: ALL (cumulative) LEAK AND BLOAT STATISTICS, tab process 7430
[task 2021-04-07T12:45:52.676Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.677Z] 12:45:52     INFO -      |<----------------Class--------------->|<-----Bytes------>|<----Objects---->|
[task 2021-04-07T12:45:52.678Z] 12:45:52     INFO -      |                                      | Per-Inst   Leaked|   Total      Rem|
[task 2021-04-07T12:45:52.679Z] 12:45:52     INFO -    0 |TOTAL                                 |       41        0|   27774        0|
[task 2021-04-07T12:45:52.679Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.680Z] 12:45:52     INFO - nsTraceRefcnt::DumpStatistics: 657 entries
[task 2021-04-07T12:45:52.680Z] 12:45:52     INFO - TEST-PASS | leakcheck | tab no leaks detected!
[task 2021-04-07T12:45:52.681Z] 12:45:52     INFO - leakcheck | Processing leak log file /tmp/tmpaTp0gU.mozrunner/runtests_leaks_tab_pid7483.log
[task 2021-04-07T12:45:52.682Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.683Z] 12:45:52     INFO - == BloatView: ALL (cumulative) LEAK AND BLOAT STATISTICS, tab process 7483
[task 2021-04-07T12:45:52.683Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.684Z] 12:45:52     INFO -      |<----------------Class--------------->|<-----Bytes------>|<----Objects---->|
[task 2021-04-07T12:45:52.684Z] 12:45:52     INFO -      |                                      | Per-Inst   Leaked|   Total      Rem|
[task 2021-04-07T12:45:52.685Z] 12:45:52     INFO -    0 |TOTAL                                 |       35        0|   15333        0|
[task 2021-04-07T12:45:52.685Z] 12:45:52     INFO - 
[task 2021-04-07T12:45:52.686Z] 12:45:52     INFO - nsTraceRefcnt::DumpStatistics: 370 entries
[task 2021-04-07T12:45:52.686Z] 12:45:52     INFO - TEST-PASS | leakcheck | tab no leaks detected!
[task 2021-04-07T12:45:52.687Z] 12:45:52     INFO - runtests.py | Running tests: end.
[task 2021-04-07T12:45:52.708Z] 12:45:52     INFO - Buffered messages finished
[task 2021-04-07T12:45:52.708Z] 12:45:52     INFO -  TEST-INFO | checking window state
[task 2021-04-07T12:45:52.709Z] 12:45:52     INFO -  Browser Chrome Test Summary
[task 2021-04-07T12:45:52.709Z] 12:45:52     INFO -  	Passed: 390
[task 2021-04-07T12:45:52.710Z] 12:45:52     INFO -  	Failed: 2
[task 2021-04-07T12:45:52.710Z] 12:45:52     INFO -  	Todo: 0
[task 2021-04-07T12:45:52.711Z] 12:45:52     INFO -  	Mode: e10s
[task 2021-04-07T12:45:52.711Z] 12:45:52     INFO -  *** End BrowserChrome Test Results ***
[task 2021-04-07T12:45:52.712Z] 12:45:52     INFO - Buffered messages finished
[task 2021-04-07T12:45:52.712Z] 12:45:52     INFO - SUITE-END | took 31s
[task 2021-04-07T12:45:52.713Z] 12:45:52     INFO - SUITE-START | Running 1 tests
[task 2021-04-07T12:45:52.713Z] 12:45:52     INFO - :::
[task 2021-04-07T12:45:52.713Z] 12:45:52     INFO - ::: Test verification summary for:
[task 2021-04-07T12:45:52.714Z] 12:45:52     INFO - :::
[task 2021-04-07T12:45:52.714Z] 12:45:52     INFO - ::: devtools/shared/commands/target-configuration/tests/browser_target_configuration_command_dppx.js
[task 2021-04-07T12:45:52.715Z] 12:45:52     INFO - :::
[task 2021-04-07T12:45:52.715Z] 12:45:52     INFO - ::: 1. Run each test 10 times in one browser. : Pass
[task 2021-04-07T12:45:52.716Z] 12:45:52     INFO - ::: 2. Run each test 5 times in a new browser each time. : Pass
[task 2021-04-07T12:45:52.716Z] 12:45:52     INFO - ::: 3. Run each test 10 times in one browser, in chaos mode. : Pass
[task 2021-04-07T12:45:52.717Z] 12:45:52     INFO - ::: 4. Run each test 5 times in a new browser each time, in chaos mode. : FAIL
[task 2021-04-07T12:45:52.717Z] 12:45:52     INFO - :::
[task 2021-04-07T12:45:52.718Z] 12:45:52     INFO - ::: Test verification FAILED!
[task 2021-04-07T12:45:52.718Z] 12:45:52     INFO - :::
[task 2021-04-07T12:45:52.718Z] 12:45:52     INFO - Buffered messages finished
[task 2021-04-07T12:45:52.719Z] 12:45:52     INFO - SUITE-END | took 0s
[task 2021-04-07T12:45:52.758Z] 12:45:52     INFO - Return code: 0
[task 2021-04-07T12:45:52.760Z] 12:45:52     INFO - TinderboxPrint: mochitest-mochitest-devtools-chrome<br/>26/0/0
[task 2021-04-07T12:45:52.760Z] 12:45:52    ERROR - # TBPL FAILURE #
[task 2021-04-07T12:45:52.761Z] 12:45:52  WARNING - setting return code to 2
[task 2021-04-07T12:45:52.761Z] 12:45:52    ERROR - TinderboxPrint: Per-test run of .../browser_target_configuration_command_dppx.js<br/>: FAILURE
[task 2021-04-07T12:45:52.761Z] 12:45:52     INFO - Per-test suites: {}
[task 2021-04-07T12:45:52.762Z] 12:45:52     INFO - Per-test suites: {}
[task 2021-04-07T12:45:52.763Z] 12:45:52     INFO - Running post-action listener: _package_coverage_data
[task 2021-04-07T12:45:52.763Z] 12:45:52     INFO - Running post-action listener: _resource_record_post_action
[task 2021-04-07T12:45:52.763Z] 12:45:52     INFO - Running post-action listener: process_java_coverage_data
[task 2021-04-07T12:45:52.763Z] 12:45:52     INFO - [mozharness: 2021-04-07 12:45:52.761158Z] Finished run-tests step (success)
[task 2021-04-07T12:45:52.764Z] 12:45:52     INFO - Running post-run listener: _resource_record_post_run
[task 2021-04-07T12:45:52.840Z] 12:45:52     INFO - Validating Perfherder data against /builds/worker/workspace/mozharness/external_tools/performance-artifact-schema.json
[task 2021-04-07T12:45:52.844Z] 12:45:52     INFO - PERFHERDER_DATA: {"framework": {"name": "job_resource_usage"}, "suites": [{"subtests": [{"name": "cpu_percent", "value": 63.897239263803705}, {"name": "io_write_bytes", "value": 2209456128}, {"name": "io.read_bytes", "value": 49152}, {"name": "io_write_time", "value": 193524}, {"name": "io_read_time", "value": 16}], "extraOptions": ["e10s", "taskcluster-m5.large"], "name": ".overall"}, {"subtests": [{"name": "time", "value": 0.03258109092712402}], "name": ".start-pulseaudio"}, {"subtests": [{"name": "time", "value": 13.544907093048096}, {"name": "cpu_percent", "value": 50.25}], "name": ".install"}, {"subtests": [{"name": "time", "value": 0.001628875732421875}], "name": ".stage-files"}, {"subtests": [{"name": "time", "value": 639.2476778030396}, {"name": "cpu_percent", "value": 64.19208463949845}], "name": ".run-tests"}]}
[task 2021-04-07T12:45:52.845Z] 12:45:52     INFO - Total resource usage - Wall time: 653s; CPU: 64.0%; Read bytes: 49152; Write bytes: 2209456128; Read time: 16; Write time: 193524
[task 2021-04-07T12:45:52.845Z] 12:45:52     INFO - TinderboxPrint: CPU usage<br/>64.2%
[task 2021-04-07T12:45:52.846Z] 12:45:52     INFO - TinderboxPrint: I/O read bytes / time<br/>49,152 / 16
[task 2021-04-07T12:45:52.846Z] 12:45:52     INFO - TinderboxPrint: I/O write bytes / time<br/>2,209,456,128 / 193,524
[task 2021-04-07T12:45:52.846Z] 12:45:52     INFO - TinderboxPrint: CPU idle<br/>455.7 (35.2%)
[task 2021-04-07T12:45:52.846Z] 12:45:52     INFO - TinderboxPrint: CPU nice<br/>250.2 (19.3%)
[task 2021-04-07T12:45:52.847Z] 12:45:52     INFO - TinderboxPrint: CPU system<br/>75.1 (5.8%)
[task 2021-04-07T12:45:52.847Z] 12:45:52     INFO - TinderboxPrint: CPU user<br/>503.9 (38.9%)
[task 2021-04-07T12:45:52.847Z] 12:45:52     INFO - TinderboxPrint: Swap in / out<br/>0 / 0
[task 2021-04-07T12:45:52.848Z] 12:45:52     INFO - start-pulseaudio - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0
[task 2021-04-07T12:45:52.848Z] 12:45:52     INFO - install - Wall time: 14s; CPU: 50.0%; Read bytes: 0; Write bytes: 9355264; Read time: 0; Write time: 4472
[task 2021-04-07T12:45:52.849Z] 12:45:52     INFO - stage-files - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0
[task 2021-04-07T12:45:52.851Z] 12:45:52     INFO - run-tests - Wall time: 639s; CPU: 64.0%; Read bytes: 49152; Write bytes: 2198773760; Read time: 16; Write time: 188816
[task 2021-04-07T12:45:52.935Z] 12:45:52  WARNING - returning nonzero exit status 2```
Severity: -- → S4
Priority: -- → P5

It looks like the test was leaking because we were using loadUri to reload, or the fact
that we were using browserLoaded after calling loadUri.
So here we do create a promise from browserLoaded before initiating the navigation,
and we use the more straightforward gBrowser.reloadTab to reload.

Assignee: nobody → nchevobbe
Status: NEW → ASSIGNED
Pushed by nchevobbe@mozilla.com:
https://hg.mozilla.org/integration/autoland/rev/0a1b71880463
[devtools] Fix intermittent leak on browser_target_configuration_command_dppx.js. r=bomsy
Flags: needinfo?(nchevobbe)
Status: ASSIGNED → RESOLVED
Closed: 3 years ago
Resolution: --- → FIXED
Target Milestone: --- → 89 Branch
Has Regression Range: --- → yes
You need to log in before you can comment on or make changes to this bug.

Attachment

General

Created:
Updated:
Size: