1146679 - Intermittent test_2d.composite.canvas.destination-atop.html | application terminated with exit code 1

Status: RESOLVED WORKSFORME

(Core :: Memory Allocator, defect)

Description

[Wes Kocher (:KWierso) (Not reading bugmail; email directly if needed)]

06:42:50 INFO - 1641 INFO TEST-START | dom/canvas/test/test_2d.composite.canvas.color-dodge.html
06:42:50 INFO - ++DOMWINDOW == 33 (0D932400) [pid = 4076] [serial = 5542] [outer = 154E1C00]
06:42:50 INFO - [Parent 4076] WARNING: Performance Entry buffer size maximum reached!: file c:\builds\moz2_slave\fx-team-w32-d-0000000000000000\build\src\dom\base\nsPerformance.cpp, line 562
06:42:50 INFO - 1642 INFO TEST-OK | dom/canvas/test/test_2d.composite.canvas.color-dodge.html | took 138ms
06:42:50 INFO - ++DOMWINDOW == 34 (10153C00) [pid = 4076] [serial = 5543] [outer = 154E1C00]
06:42:50 INFO - [Parent 4076] WARNING: Performance Entry buffer size maximum reached!: file c:\builds\moz2_slave\fx-team-w32-d-0000000000000000\build\src\dom\base\nsPerformance.cpp, line 562
06:42:50 INFO - 1643 INFO TEST-START | dom/canvas/test/test_2d.composite.canvas.color.html
06:42:50 INFO - ++DOMWINDOW == 35 (10B43000) [pid = 4076] [serial = 5544] [outer = 154E1C00]
06:42:50 INFO - [Parent 4076] WARNING: Performance Entry buffer size maximum reached!: file c:\builds\moz2_slave\fx-team-w32-d-0000000000000000\build\src\dom\base\nsPerformance.cpp, line 562
06:42:50 INFO - 1644 INFO TEST-OK | dom/canvas/test/test_2d.composite.canvas.color.html | took 142ms
06:42:50 INFO - ++DOMWINDOW == 36 (0F80AC00) [pid = 4076] [serial = 5545] [outer = 154E1C00]
06:42:50 INFO - [Parent 4076] WARNING: Performance Entry buffer size maximum reached!: file c:\builds\moz2_slave\fx-team-w32-d-0000000000000000\build\src\dom\base\nsPerformance.cpp, line 562
06:42:50 INFO - 1645 INFO TEST-START | dom/canvas/test/test_2d.composite.canvas.darken.html
06:42:50 INFO - ++DOMWINDOW == 37 (10B4CC00) [pid = 4076] [serial = 5546] [outer = 154E1C00]
06:42:50 INFO - [Parent 4076] WARNING: Performance Entry buffer size maximum reached!: file c:\builds\moz2_slave\fx-team-w32-d-0000000000000000\build\src\dom\base\nsPerformance.cpp, line 562
06:42:50 INFO - 1646 INFO TEST-OK | dom/canvas/test/test_2d.composite.canvas.darken.html | took 133ms
06:42:50 INFO - ++DOMWINDOW == 38 (10C8D800) [pid = 4076] [serial = 5547] [outer = 154E1C00]
06:42:50 INFO - [Parent 4076] WARNING: Performance Entry buffer size maximum reached!: file c:\builds\moz2_slave\fx-team-w32-d-0000000000000000\build\src\dom\base\nsPerformance.cpp, line 562
06:42:50 INFO - 1647 INFO TEST-START | dom/canvas/test/test_2d.composite.canvas.destination-atop.html
06:42:50 INFO - Hit MOZ_CRASH() at c:/builds/moz2_slave/fx-team-w32-d-0000000000000000/build/src/memory/mozjemalloc/jemalloc.c:1610
06:42:51 INFO - TEST-INFO | Main app process: exit status 1
06:42:51 WARNING - TEST-UNEXPECTED-FAIL | dom/canvas/test/test_2d.composite.canvas.destination-atop.html | application terminated with exit code 1
06:42:51 INFO - runtests.py | Application ran for: 0:18:55.577000
06:42:51 INFO - zombiecheck | Reading PID log: c:\docume~1\cltbld~1.t-x\locals~1\temp\tmpcjuebrpidlog
06:42:51 INFO - ==> process 4076 launched child process 3336 ("C:\slave\test\build\application\firefox\plugin-container.exe" --channel=4076.adbba80.582738754 "c:\docume~1\cltbld~1.t-x\locals~1\temp\tmplujrkm.mozrunner\plugins\nptest.dll" -greomni "C:\slave\test\build\application\firefox\omni.ja" -appomni "C:\slave\test\build\application\firefox\browser\omni.ja" -appdir "C:\slave\test\build\application\firefox\browser" - 4076 "\\.\pipe\gecko-crash-server-pipe.4076" plugin)
06:42:51 INFO - ==> process 4076 launched child process 3600 ("C:\slave\test\build\application\firefox\plugin-container.exe" --channel=4076.db21c80.2110271441 "c:\docume~1\cltbld~1.t-x\locals~1\temp\tmplujrkm.mozrunner\plugins\nptest.dll" -greomni "C:\slave\test\build\application\firefox\omni.ja" -appomni "C:\slave\test\build\application\firefox\browser\omni.ja" -appdir "C:\slave\test\build\application\firefox\browser" - 4076 "\\.\pipe\gecko-crash-server-pipe.4076" plugin)
06:42:51 INFO - ==> process 4076 launched child process 3520 ("C:\slave\test\build\application\firefox\plugin-container.exe" --channel=4076.db21a00.1706016285 "c:\docume~1\cltbld~1.t-x\locals~1\temp\tmplujrkm.mozrunner\plugins\nptest.dll" -greomni "C:\slave\test\build\application\firefox\omni.ja" -appomni "C:\slave\test\build\application\firefox\browser\omni.ja" -appdir "C:\slave\test\build\application\firefox\browser" - 4076 "\\.\pipe\gecko-crash-server-pipe.4076" plugin)
06:59:31 INFO - Automation Error: mozprocess timed out after 1000 seconds running ['C:\\slave\\test\\build\\venv\\Scripts\\python', '-u', 'C:\\slave\\test\\build\\tests\\mochitest\\runtests.py', '--total-chunks', '5', '--this-chunk', '1', '--appname=C:\\slave\\test\\build\\application\\firefox\\firefox.exe', '--utility-path=tests/bin', '--extra-profile-file=tests/bin/plugins', '--symbols-path=C:\\slave\\test\\build\\symbols', '--certificate-path=tests/certs', '--autorun', '--close-when-done', '--console-level=INFO', '--quiet', '--log-raw=C:\\slave\\test\\build\\blobber_upload_dir\\plain-chunked_raw.log', '--chunk-by-dir=4']
06:59:31 ERROR - timed out after 1000 seconds of no output
06:59:31 ERROR - Return code: 572
06:59:31 ERROR - No tests run or test summary not found
06:59:31 INFO - TinderboxPrint: mochitest-plain-chunked<br/><em class="testfail">T-FAIL</em>
06:59:31 WARNING - # TBPL FAILURE #
06:59:31 WARNING - The mochitest suite: plain-chunked ran with return status: FAILURE
06:59:31 INFO - Running post-action listener: _resource_record_post_action
06:59:31 INFO - Running post-run listener: _resource_record_post_run
06:59:32 INFO - Total resource usage - Wall time: 2147s; CPU: 5.0%; Read bytes: 330306560; Write bytes: 720066560; Read time: 16185540; Write time: 2614178
06:59:32 INFO - install - Wall time: 4s; CPU: 9.0%; Read bytes: 0; Write bytes: 111839744; Read time: 0; Write time: 169065
06:59:32 INFO - run-tests - Wall time: 2144s; CPU: 5.0%; Read bytes: 330306560; Write bytes: 596867584; Read time: 16185540; Write time: 2430060
06:59:32 INFO - Running post-run listener: _upload_blobber_files
06:59:32 INFO - Blob upload gear active.

Comment 1

[Legacy TBPL/Treeherder Robot]

log: https://treeherder.mozilla.org/logviewer.html#?repo=fx-team&job_id=2365253
repository: fx-team
start_time: 2015-03-23T07:20:39
who: wkocher[at]mozilla[dot]com
machine: t-xp32-ix-080
buildname: Windows XP 32-bit fx-team debug test mochitest-1
revision: 337e3aa22117

TEST-UNEXPECTED-FAIL | dom/canvas/test/test_2d.composite.canvas.destination-atop.html | application terminated with exit code 1
Automation Error: mozprocess timed out after 1000 seconds running ['C:\\slave\\test\\build\\venv\\Scripts\\python', '-u', 'C:\\slave\\test\\build\\tests\\mochitest\\runtests.py', '--total-chunks', '5', '--this-chunk', '1', '--appname=C:\\slave\\test\\build\\application\\firefox\\firefox.exe', '--utility-path=tests/bin', '--extra-profile-file=tests/bin/plugins', '--symbols-path=C:\\slave\\test\\build\\symbols', '--certificate-path=tests/certs', '--autorun', '--close-when-done'
timed out after 1000 seconds of no output
Return code: 572
No tests run or test summary not found
command timed out: 1800 seconds without output, attempting to kill
remoteFailed: [Failure instance: Traceback from remote host -- Traceback (most recent call last):

Comment 2

[Mike Hommey [:glandium]]

Why is there no crash dump in that log?

Comment 3

[(not currently active) Ted Mielczarek]

Something happened and the Mochitest harness itself hung, the log line:
06:59:31 ERROR - timed out after 1000 seconds of no output

is buildbot killing the harness.

Comment 4

[(not currently active) Ted Mielczarek]

Possibly related, minidump_stackwalk is currently completely broken on Win32 test machines: bug 1146855.

Comment 5

[Ed Morley [:emorley]]

Inactive; closing (see bug 1180138).