Closed Bug 1798031 Opened 3 years ago Closed 3 years ago

Intermittent position-dynamic-changes/vertical/topN-heightA-bottomA.html?border_abspos == position-dynamic-changes/vertical/topN-heightA-bottomA-ref.html?border_abspos | load failed: timed out waiting for test to complete (trying to get into WaitForTes

Categories

(Core :: Layout: Positioned, defect, P5)

Product:
Core
Component:
Layout: Positioned
Type:
defect

Tracking

()

Status:
RESOLVED INCOMPLETE

People

(Reporter: intermittent-bug-filer, Unassigned)

Details

(Keywords: intermittent-failure)

Filed by: smolnar [at] mozilla.com
Parsed log: https://treeherder.mozilla.org/logviewer?job_id=394693548&repo=autoland
Full log: https://firefox-ci-tc.services.mozilla.com/api/queue/v1/task/SiMPpltvQR63otf3lmTigQ/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/SiMPpltvQR63otf3lmTigQ/runs/0/artifacts/public/logs/live_backing.log&only_show_unexpected=1

INFO - REFTEST TEST-LOAD | file:///Z:/task_166695362093388/build/tests/reftest/tests/layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomA.html?border_abspos | 0 / 18 (0%)
[task 2022-10-28T11:53:14.409Z] 11:53:14     INFO - [Parent 2956, Main Thread] WARNING: WebProgress Ignored: no longer current window global: file /builds/worker/checkouts/gecko/dom/ipc/BrowserParent.cpp:3085
[task 2022-10-28T11:53:14.421Z] 11:53:14     INFO - ### XPCOM_MEM_BLOAT_LOG defined -- logging bloat/leaks to C:\Users\task_166695362093388\AppData\Local\Temp\tmp9i_9agtq.mozrunner\runreftest_leaks_tab_pid5348.log
[task 2022-10-28T11:53:14.422Z] 11:53:14     INFO - [5348, Main Thread] WARNING: XPCOM_MEM_BLOAT_LOG is set, disabling native allocations.: file /builds/worker/checkouts/gecko/tools/profiler/core/platform.cpp:339
[task 2022-10-28T11:53:14.459Z] 11:53:14     INFO - [Child 5556, Main Thread] WARNING: Extra shutdown CC: 'i < NORMAL_SHUTDOWN_COLLECTIONS', file /builds/worker/checkouts/gecko/xpcom/base/nsCycleCollector.cpp:3387
[task 2022-10-28T11:53:14.461Z] 11:53:14     INFO - [Child 5556, Main Thread] WARNING: NS_ENSURE_TRUE(InitStaticMembers()) failed: file /builds/worker/workspace/obj-build/dist/include/mozilla/Preferences.h:129
[task 2022-10-28T11:53:14.468Z] 11:53:14     INFO - [Child 5556, Main Thread] WARNING: NS_ENSURE_TRUE(Preferences::InitStaticMembers()) failed: file /builds/worker/checkouts/gecko/modules/libpref/Preferences.cpp:4634
[task 2022-10-28T11:53:14.515Z] 11:53:14     INFO - [Child 5348, Main Thread] WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0x80520012 (NS_ERROR_FILE_NOT_FOUND): file /builds/worker/checkouts/gecko/layout/style/Loader.cpp:2049
[task 2022-10-28T11:53:14.532Z] 11:53:14     INFO - [2022-10-28T11:53:14Z WARN  webrender::device::gl] Cropping texture upload Box2D((0, 0), (0, 1)) to None
[task 2022-10-28T11:53:14.532Z] 11:53:14     INFO - [2022-10-28T11:53:14Z WARN  webrender::device::gl] Cropping texture upload Box2D((0, 0), (0, 1)) to None
[task 2022-10-28T11:53:14.632Z] 11:53:14     INFO - REFTEST INFO | drawWindow flags = DRAWWINDOW_DRAW_CARET | DRAWWINDOW_DRAW_VIEW | DRAWWINDOW_USE_WIDGET_LAYERS; window size = 816,1039; test browser size = 800,1000
[task 2022-10-28T11:53:14.860Z] 11:53:14     INFO - ### XPCOM_MEM_BLOAT_LOG defined -- logging bloat/leaks to C:\Users\task_166695362093388\AppData\Local\Temp\tmp9i_9agtq.mozrunner\runreftest_leaks_tab_pid8060.log
[task 2022-10-28T11:53:14.861Z] 11:53:14     INFO - [8060, Main Thread] WARNING: XPCOM_MEM_BLOAT_LOG is set, disabling native allocations.: file /builds/worker/checkouts/gecko/tools/profiler/core/platform.cpp:339
[task 2022-10-28T11:53:14.872Z] 11:53:14     INFO - ### XPCOM_MEM_BLOAT_LOG defined -- logging bloat/leaks to C:\Users\task_166695362093388\AppData\Local\Temp\tmp9i_9agtq.mozrunner\runreftest_leaks_tab_pid9308.log
[task 2022-10-28T11:53:14.873Z] 11:53:14     INFO - [9308, Main Thread] WARNING: XPCOM_MEM_BLOAT_LOG is set, disabling native allocations.: file /builds/worker/checkouts/gecko/tools/profiler/core/platform.cpp:339
[task 2022-10-28T11:53:20.878Z] 11:53:20     INFO - [Parent 2956, Main Thread] WARNING: NS_ENSURE_TRUE(!mHasOrHasHadOwnerWindow || mOwnerWindow) failed: file /builds/worker/checkouts/gecko/dom/events/DOMEventTargetHelper.cpp:302
[task 2022-10-28T11:53:21.878Z] 11:53:21     INFO - [Child 5604, Main Thread] WARNING: early callback, or time went backwards: '!aAllowIdleDispatch', file /builds/worker/checkouts/gecko/xpcom/threads/IdleTaskRunner.cpp:198
[task 2022-10-28T11:58:14.594Z] 11:58:14     INFO - REFTEST TEST-UNEXPECTED-FAIL | layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomA.html?border_abspos == layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomA-ref.html?border_abspos | load failed: timed out waiting for test to complete (trying to get into WaitForTestEnd)
[task 2022-10-28T11:58:14.595Z] 11:58:14     INFO - REFTEST INFO | Saved log: START file:///Z:/task_166695362093388/build/tests/reftest/tests/layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomA.html?border_abspos
[task 2022-10-28T11:58:14.595Z] 11:58:14     INFO - REFTEST INFO | Saved log: [CONTENT] Using browser remote=true
[task 2022-10-28T11:58:14.596Z] 11:58:14     INFO - 
[task 2022-10-28T11:58:14.596Z] 11:58:14     INFO - REFTEST INFO | Saved log: [CONTENT] OnDocumentLoad fired for previous document
[task 2022-10-28T11:58:14.596Z] 11:58:14     INFO - REFTEST INFO | Saved log: [CONTENT] OnDocumentLoad triggering WaitForTestEnd
[task 2022-10-28T11:58:14.597Z] 11:58:14     INFO - REFTEST INFO | Saved log: [CONTENT] WaitForTestEnd: Adding listeners
[task 2022-10-28T11:58:14.597Z] 11:58:14     INFO - REFTEST INFO | Saved log: Initializing canvas snapshot
[task 2022-10-28T11:58:14.598Z] 11:58:14     INFO - REFTEST INFO | Saved log: DoDrawWindow 0,0,800,1000
[task 2022-10-28T11:58:14.598Z] 11:58:14     INFO - REFTEST INFO | Saved log: [CONTENT] AfterPaintListener in file:///Z:/task_166695362093388/build/tests/reftest/tests/layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomA.html?border_abspos
[task 2022-10-28T11:58:14.599Z] 11:58:14     INFO - REFTEST INFO | Saved log: [CONTENT] AfterPaintListener in file:///Z:/task_166695362093388/build/tests/reftest/tests/layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomA.html?border_abspos
[task 2022-10-28T11:58:14.599Z] 11:58:14     INFO - REFTEST INFO | Saved log: [CONTENT] MakeProgress
[task 2022-10-28T11:58:14.600Z] 11:58:14     INFO - REFTEST TEST-END | layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomA.html?border_abspos == layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomA-ref.html?border_abspos
[task 2022-10-28T11:58:14.607Z] 11:58:14     INFO - [Parent 2956, Main Thread] WARNING: '!CanSend() || !mManager || !mManager->CanSend()', file /builds/worker/checkouts/gecko/dom/ipc/jsactor/JSWindowActorParent.cpp:42
[task 2022-10-28T11:58:14.619Z] 11:58:14     INFO - REFTEST TEST-START | layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomN.html?border_abspos == layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomN-ref.html?border_abspos
[task 2022-10-28T11:58:14.620Z] 11:58:14     INFO - REFTEST TEST-LOAD | file:///Z:/task_166695362093388/build/tests/reftest/tests/layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomN.html?border_abspos | 1 / 18 (5%)
[task 2022-10-28T12:01:39.457Z] 12:01:39     INFO - [2022-10-28T12:01:39Z WARN  rkv::backend::impl_safe::environment] `load_ratio()` is irrelevant for this storage backend.
[task 2022-10-28T12:03:14.625Z] 12:03:14     INFO - REFTEST TEST-UNEXPECTED-FAIL | layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomN.html?border_abspos == layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomN-ref.html?border_abspos | load failed: timed out waiting for test to complete (trying to get into WaitForTestEnd)
[task 2022-10-28T12:03:14.626Z] 12:03:14     INFO - REFTEST INFO | Saved log: START file:///Z:/task_166695362093388/build/tests/reftest/tests/layout/reftests/position-dynamic-changes/vertical/topN-heightA-bottomN.html?border_abspos
[task 2022-10-28T12:03:14.626Z] 12:03:14     INFO - REFTEST INFO | Saved log: Updating entire canvas for invalidation
[task 2022-10-28T12:03:14.626Z] 12:03:14     INFO - REFTEST INFO | Saved log: DoDrawWindow 0,0,800,1000
[task 2022-10-28T12:03:14.627Z] 12:03:14     INFO - REFTEST INFO | Saved log: [CONTENT] MakeProgress: STATE_COMPLETED

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

Status: NEW → RESOLVED
Closed: 3 years ago
Resolution: --- → INCOMPLETE
You need to log in before you can comment on or make changes to this bug.