Closed Bug 1583000 Opened 5 years ago Closed 5 years ago

High Occurrence TEST-UNEXPECTED-TIMEOUT | /service-workers/service-worker/postmessage-blob-url.https.html | postMessage Blob URL to a ServiceWorker - Test timed out

Categories

(Core :: DOM: Service Workers, defect)

defect
Not set
normal

Tracking

()

RESOLVED FIXED
mozilla73
Tracking Status
firefox-esr68 --- unaffected
firefox71 --- unaffected
firefox72 --- unaffected
firefox73 --- fixed

People

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

References

(Regression)

Details

(Keywords: intermittent-failure, regression, Whiteboard: [stockwell fixed:backout][retriggered])

Filed by: cbrindusan [at] mozilla.com
Parsed log: https://treeherder.mozilla.org/logviewer.html#?job_id=267834599&repo=mozilla-central
Full log: https://queue.taskcluster.net/v1/task/YYvYReZ1SO2yN7-QYtKWIw/runs/0/artifacts/public/logs/live_backing.log


[task 2019-09-21T22:32:55.247Z] 22:32:55 INFO - TEST-START | /service-workers/service-worker/postmessage-blob-url.https.html
[task 2019-09-21T22:32:55.251Z] 22:32:55 INFO - Closing window 239
[task 2019-09-21T22:32:55.361Z] 22:32:55 INFO - PID 16739 | --DOMWINDOW == 5 (0x7f6c3f9152e0) [pid = 20970] [serial = 4] [outer = (nil)] [url = https://web-platform.test:8443/service-workers/service-worker/resources/opaque-response-being-preloaded-xhr.html]
[task 2019-09-21T22:32:55.379Z] 22:32:55 INFO - PID 16739 | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2019-09-21T22:32:55.395Z] 22:32:55 INFO - PID 16739 | ++DOCSHELL 0x7f5d0cab9000 == 1 [pid = 21009] [id = {3958bf7b-a86f-4f9c-99d4-7ed1423fb497}]
[task 2019-09-21T22:32:55.477Z] 22:32:55 INFO - PID 16739 | --DOCSHELL 0x7f6c3f5b7800 == 1 [pid = 20970] [id = {0fadbaf7-13ca-4990-84e9-eb8973300a98}] [url = https://web-platform.test:8443/service-workers/service-worker/resources/opaque-response-preloaded-xhr.html]
[task 2019-09-21T22:32:55.477Z] 22:32:55 INFO - PID 16739 | --DOMWINDOW == 4 (0x7f6c3ffad000) [pid = 20970] [serial = 5] [outer = (nil)] [url = https://web-platform.test:8443/service-workers/service-worker/resources/opaque-response-being-preloaded-xhr.html]
[task 2019-09-21T22:32:55.477Z] 22:32:55 INFO - PID 16739 | --DOCSHELL 0x7f6c3f9ba000 == 0 [pid = 20970] [id = {a12a4995-2380-467c-b4ed-06aed53e2503}] [url = https://web-platform.test:8443/service-workers/service-worker/opaque-response-preloaded.https.html]
[task 2019-09-21T22:32:55.485Z] 22:32:55 INFO - PID 16739 | ++DOMWINDOW == 1 (0x7f5d0c907f20) [pid = 21009] [serial = 1] [outer = (nil)]
[task 2019-09-21T22:32:55.485Z] 22:32:55 INFO - PID 16739 | ++DOMWINDOW == 2 (0x7f5d0ca24800) [pid = 21009] [serial = 2] [outer = 0x7f5d0c907f20]
[task 2019-09-21T22:32:55.563Z] 22:32:55 INFO - PID 16739 | --DOMWINDOW == 3 (0x7f6c3f9154c0) [pid = 20970] [serial = 6] [outer = (nil)] [url = https://web-platform.test:8443/service-workers/service-worker/resources/opaque-response-preloaded-xhr.html]
[task 2019-09-21T22:32:55.563Z] 22:32:55 INFO - PID 16739 | --DOMWINDOW == 2 (0x7f6c3f914f20) [pid = 20970] [serial = 1] [outer = (nil)] [url = https://web-platform.test:8443/service-workers/service-worker/opaque-response-preloaded.https.html]
[task 2019-09-21T22:32:55.563Z] 22:32:55 INFO - PID 16739 | --DOMWINDOW == 1 (0x7f6c40d62800) [pid = 20970] [serial = 7] [outer = (nil)] [url = https://web-platform.test:8443/service-workers/service-worker/resources/opaque-response-preloaded-xhr.html]
[task 2019-09-21T22:32:55.563Z] 22:32:55 INFO - PID 16739 | --DOMWINDOW == 0 (0x7f6c3ffadc00) [pid = 20970] [serial = 3] [outer = (nil)] [url = https://web-platform.test:8443/service-workers/service-worker/opaque-response-preloaded.https.html]
[task 2019-09-21T22:32:55.605Z] 22:32:55 INFO - PID 16739 | nsStringStats
[task 2019-09-21T22:32:55.606Z] 22:32:55 INFO - PID 16739 | => mAllocCount: 9858
[task 2019-09-21T22:32:55.606Z] 22:32:55 INFO - PID 16739 | => mReallocCount: 0
[task 2019-09-21T22:32:55.606Z] 22:32:55 INFO - PID 16739 | => mFreeCount: 9858
[task 2019-09-21T22:32:55.606Z] 22:32:55 INFO - PID 16739 | => mShareCount: 11168
[task 2019-09-21T22:32:55.606Z] 22:32:55 INFO - PID 16739 | => mAdoptCount: 708
[task 2019-09-21T22:32:55.608Z] 22:32:55 INFO - PID 16739 | => mAdoptFreeCount: 728
[task 2019-09-21T22:32:55.608Z] 22:32:55 INFO - PID 16739 | => Process ID: 20970, Thread ID: 140103356340032
[task 2019-09-21T22:32:55.664Z] 22:32:55 INFO - PID 16739 | ### XPCOM_MEM_BLOAT_LOG defined -- logging bloat/leaks to /tmp/tmpTyCotx.mozrunner/runtests_leaks_870_tab_pid21049.log
[task 2019-09-21T22:32:55.802Z] 22:32:55 INFO - PID 16739 | ++DOMWINDOW == 3 (0x7f5d0d4f6800) [pid = 21009] [serial = 3] [outer = 0x7f5d0c907f20]
[task 2019-09-21T22:32:55.818Z] 22:32:55 INFO - PID 16739 | Couldn't convert chrome URL: chrome://branding/locale/brand.properties
[task 2019-09-21T22:32:55.942Z] 22:32:55 INFO - PID 16739 | [2019-09-21T22:32:55Z WARN audio_thread_priority::rt_linux] Could not make thread real-time.
[task 2019-09-21T22:32:55.943Z] 22:32:55 INFO - PID 16739 | [2019-09-21T22:32:55Z WARN audioipc_client] Could not promote audio threads to real-time during initialization.
[task 2019-09-21T22:32:56.108Z] 22:32:56 INFO - PID 16739 | ++DOMWINDOW == 4 (0x7f5d0d4f8400) [pid = 21009] [serial = 4] [outer = 0x7f5d0c907f20]
[task 2019-09-21T22:32:56.351Z] 22:32:56 INFO - PID 16739 | [Parent 16739, Main Thread] WARNING: '!window', file /builds/worker/workspace/build/src/dom/cache/CacheStorage.cpp, line 575
[task 2019-09-21T22:32:56.359Z] 22:32:56 INFO - PID 16739 | [Child 16821, Main Thread] WARNING: '!window', file /builds/worker/workspace/build/src/dom/cache/CacheStorage.cpp, line 575
[task 2019-09-21T22:32:56.381Z] 22:32:56 INFO - PID 16739 | [Child 16821, DOM Worker] WARNING: '!rv', file /builds/worker/workspace/build/src/dom/serviceworkers/ServiceWorkerOp.cpp, line 277
[task 2019-09-21T22:32:56.385Z] 22:32:56 INFO - PID 16739 | [Child 16821, DOM Worker] WARNING: '!rv', file /builds/worker/workspace/build/src/dom/serviceworkers/ServiceWorkerOp.cpp, line 277
[task 2019-09-21T22:32:56.385Z] 22:32:56 INFO - PID 16739 | [Child 16821, DOM Worker] WARNING: '!rv', file /builds/worker/workspace/build/src/dom/serviceworkers/ServiceWorkerOp.cpp, line 277
[task 2019-09-21T22:32:56.387Z] 22:32:56 INFO - PID 16739 | [Child 16821, Main Thread] WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0x805303F4: file /builds/worker/workspace/build/src/netwerk/protocol/http/nsCORSListenerProxy.cpp, line 911
[task 2019-09-21T22:32:56.388Z] 22:32:56 INFO - PID 16739 | [Child 16821, Main Thread] WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0x805303F4: file /builds/worker/workspace/build/src/dom/security/nsContentSecurityManager.cpp, line 359[task 2019-09-21T22:32:56.389Z] 22:32:56 INFO - PID 16739 | [Child 16821, Main Thread] WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0x805303F4: file /builds/worker/workspace/build/src/dom/security/nsContentSecurityManager.cpp, line 887
[task 2019-09-21T22:33:02.975Z] 22:33:02 INFO - PID 16739 | --DOCSHELL 0x7f9cb6bbb800 == 0 [pid = 20929] [id = {667e6228-c2ea-4c64-a43b-fd1c08d19477}] [url = https://web-platform.test:8443/service-workers/service-worker/oninstall-script-error.https.html]
[task 2019-09-21T22:33:07.046Z] 22:33:07 INFO - PID 16739 | --DOMWINDOW == 2 (0x7f9cb6b56c00) [pid = 20929] [serial = 2] [outer = (nil)] [url = about:blank]
[task 2019-09-21T22:33:07.087Z] 22:33:07 INFO - PID 16739 | --DOMWINDOW == 1 (0x7f9cb6b19f20) [pid = 20929] [serial = 1] [outer = (nil)] [url = https://web-platform.test:8443/service-workers/service-worker/oninstall-script-error.https.html]
[task 2019-09-21T22:33:09.973Z] 22:33:09 INFO - PID 16739 | --DOMWINDOW == 3 (0x7f5d0d4f6800) [pid = 21009] [serial = 3] [outer = (nil)] [url = about:blank]
[task 2019-09-21T22:33:09.973Z] 22:33:09 INFO - PID 16739 | --DOMWINDOW == 2 (0x7f5d0ca24800) [pid = 21009] [serial = 2] [outer = (nil)] [url = about:blank]
[task 2019-09-21T22:33:10.392Z] 22:33:10 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerController.cpp, line 444
[task 2019-09-21T22:33:10.394Z] 22:33:10 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerControllerParent.cpp, line 108
[task 2019-09-21T22:33:11.122Z] 22:33:11 INFO - PID 16739 | --DOMWINDOW == 0 (0x7f9cb6b61c00) [pid = 20929] [serial = 3] [outer = (nil)] [url = https://web-platform.test:8443/service-workers/service-worker/oninstall-script-error.https.html]
[task 2019-09-21T22:33:23.261Z] 22:33:23 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerController.cpp, line 444
[task 2019-09-21T22:33:23.261Z] 22:33:23 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerControllerParent.cpp, line 108
[task 2019-09-21T22:33:23.309Z] 22:33:23 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerController.cpp, line 444
[task 2019-09-21T22:33:23.309Z] 22:33:23 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerControllerParent.cpp, line 108
[task 2019-09-21T22:33:23.467Z] 22:33:23 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerController.cpp, line 444
[task 2019-09-21T22:33:23.467Z] 22:33:23 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerControllerParent.cpp, line 108
[task 2019-09-21T22:33:23.475Z] 22:33:23 INFO - PID 16739 | [Child 20929, Main Thread] WARNING: A runnable was posted to a worker that is already shutting down!: file /builds/worker/workspace/build/src/dom/workers/WorkerPrivate.cpp, line 1418
[task 2019-09-21T22:33:23.476Z] 22:33:23 INFO - PID 16739 | [Child 20929, Main Thread] WARNING: Failed to dispatch offline status change event!: file /builds/worker/workspace/build/src/dom/workers/WorkerPrivate.cpp, line 1895
[task 2019-09-21T22:33:23.476Z] 22:33:23 INFO - PID 16739 | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2019-09-21T22:33:23.512Z] 22:33:23 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerController.cpp, line 444
[task 2019-09-21T22:33:23.512Z] 22:33:23 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerControllerParent.cpp, line 108
[task 2019-09-21T22:33:23.554Z] 22:33:23 INFO - PID 16739 | nsStringStats
[task 2019-09-21T22:33:23.554Z] 22:33:23 INFO - PID 16739 | => mAllocCount: 9806
[task 2019-09-21T22:33:23.555Z] 22:33:23 INFO - PID 16739 | => mReallocCount: 0
[task 2019-09-21T22:33:23.555Z] 22:33:23 INFO - PID 16739 | => mFreeCount: 9806
[task 2019-09-21T22:33:23.555Z] 22:33:23 INFO - PID 16739 | => mShareCount: 10300
[task 2019-09-21T22:33:23.556Z] 22:33:23 INFO - PID 16739 | => mAdoptCount: 569
[task 2019-09-21T22:33:23.556Z] 22:33:23 INFO - PID 16739 | => mAdoptFreeCount: 599
[task 2019-09-21T22:33:23.556Z] 22:33:23 INFO - PID 16739 | => Process ID: 20929, Thread ID: 140311513896768
[task 2019-09-21T22:33:26.257Z] 22:33:26 INFO - PID 16739 | [Parent 16739, Main Thread] WARNING: '!window', file /builds/worker/workspace/build/src/dom/cache/CacheStorage.cpp, line 575
[task 2019-09-21T22:33:26.257Z] 22:33:26 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerController.cpp, line 444
[task 2019-09-21T22:33:26.259Z] 22:33:26 INFO - PID 16739 | [Parent 16739, IPDL Background] WARNING: 'aResult.IsReject()', file /builds/worker/workspace/build/src/dom/workers/remoteworkers/RemoteWorkerControllerParent.cpp, line 108
[task 2019-09-21T22:33:26.261Z] 22:33:26 INFO - PID 16739 | JavaScript error: , line 0: TypeError: NetworkError when attempting to fetch resource.
[task 2019-09-21T22:33:26.314Z] 22:33:26 INFO -
[task 2019-09-21T22:33:26.314Z] 22:33:26 INFO - TEST-UNEXPECTED-TIMEOUT | /service-workers/service-worker/postmessage-blob-url.https.html | postMessage Blob URL to a ServiceWorker - Test timed out

Flags: needinfo?(btara)
Summary: Intermittent TEST-UNEXPECTED-TIMEOUT | /service-workers/service-worker/postmessage-blob-url.https.html | postMessage Blob URL to a ServiceWorker - Test timed out → High Occurrence Central Tier 1 TEST-UNEXPECTED-TIMEOUT | /service-workers/service-worker/postmessage-blob-url.https.html | postMessage Blob URL to a ServiceWorker - Test timed out
Flags: needinfo?(amarchesini)
Regressed by: 1472158
Summary: High Occurrence Central Tier 1 TEST-UNEXPECTED-TIMEOUT | /service-workers/service-worker/postmessage-blob-url.https.html | postMessage Blob URL to a ServiceWorker - Test timed out → High Occurrence TEST-UNEXPECTED-TIMEOUT | /service-workers/service-worker/postmessage-blob-url.https.html | postMessage Blob URL to a ServiceWorker - Test timed out
Whiteboard: [stockwell needswork:owner] → [stockwell needswork:owner][retriggered]

fixed by backout of bug 1472158

Status: NEW → RESOLVED
Closed: 5 years ago
Flags: needinfo?(btara)
Flags: needinfo?(amarchesini)
Resolution: --- → FIXED
Whiteboard: [stockwell needswork:owner][retriggered] → [stockwell fixed:backout][retriggered]
Assignee: nobody → amarchesini
Target Milestone: --- → mozilla73
Has Regression Range: --- → yes
You need to log in before you can comment on or make changes to this bug.