Closed Bug 1488942 Opened 8 years ago Closed 8 years ago

Intermittent dom/performance/tests/test_worker_user_timing.html | application timed out after 370 seconds with no output

Categories

(Core :: DOM: Core & HTML, defect, P5)

Product:
Core
Component:
DOM: Core & HTML
Type:
defect

Tracking

()

Status:
RESOLVED INCOMPLETE

People

(Reporter: intermittent-bug-filer, Unassigned)

Details

(Keywords: crash, intermittent-failure)

Crash Data

Filed by: toros [at] mozilla.com https://treeherder.mozilla.org/logviewer.html#?job_id=197647107&repo=mozilla-central https://queue.taskcluster.net/v1/task/dVn-PPqGT_Ws4_8u_xPDjg/runs/0/artifacts/public/logs/live_backing.log [task 2018-09-05T17:22:47.497Z] 17:22:47 INFO - 155 INFO TEST-START | dom/performance/tests/test_worker_user_timing.html [task 2018-09-05T17:22:47.501Z] 17:22:47 INFO - 156 INFO TEST-OK | dom/performance/tests/test_worker_user_timing.html | took 10347ms [task 2018-09-05T17:22:47.503Z] 17:22:47 INFO - 157 INFO TEST-START | Shutdown [task 2018-09-05T17:22:47.504Z] 17:22:47 INFO - 158 INFO Passed: 569 [task 2018-09-05T17:22:47.505Z] 17:22:47 INFO - 159 INFO Failed: 0 [task 2018-09-05T17:22:47.505Z] 17:22:47 INFO - 160 INFO Todo: 1 [task 2018-09-05T17:22:47.506Z] 17:22:47 INFO - 161 INFO Mode: non-e10s [task 2018-09-05T17:22:47.506Z] 17:22:47 INFO - 162 INFO Slowest: 37423ms - /tests/dom/performance/tests/test_performance_navigation_timing.html [task 2018-09-05T17:22:47.508Z] 17:22:47 INFO - 163 INFO SimpleTest FINISHED [task 2018-09-05T17:40:54.281Z] 17:40:54 INFO - wait for org.mozilla.fennec_aurora complete; top activity=org.mozilla.fennec_aurora [task 2018-09-05T17:40:54.687Z] 17:40:54 INFO - Browser unexpectedly found running. Killing... [task 2018-09-05T17:40:54.688Z] 17:40:54 INFO - TEST-INFO | started process screentopng [task 2018-09-05T17:40:55.159Z] 17:40:55 INFO - TEST-INFO | screentopng: exit 0 [task 2018-09-05T17:41:09.812Z] 17:41:09 WARNING - TEST-UNEXPECTED-FAIL | dom/performance/tests/test_worker_user_timing.html | application timed out after 370 seconds with no output [task 2018-09-05T17:41:09.813Z] 17:41:09 INFO - INFO | automation.py | Application ran for: 0:18:34.231677 [task 2018-09-05T17:41:09.813Z] 17:41:09 INFO - INFO | zombiecheck | Reading PID log: /tmp/tmpfb_Amypidlog [task 2018-09-05T17:41:10.127Z] 17:41:10 INFO - Contents of /data/anr/traces.txt: [task 2018-09-05T17:41:10.127Z] 17:41:10 INFO - ----- pid 5002 at 2018-09-05 10:40:55 ----- [task 2018-09-05T17:41:10.127Z] 17:41:10 INFO - Cmd line: org.mozilla.fennec_aurora [task 2018-09-05T17:41:10.128Z] 17:41:10 INFO - JNI: CheckJNI is on; workarounds are off; pins=0; globals=279 [task 2018-09-05T17:41:10.128Z] 17:41:10 INFO - DALVIK THREADS: [task 2018-09-05T17:41:10.128Z] 17:41:10 INFO - (mutexes: tll=0 tsl=0 tscl=0 ghl=0) [task 2018-09-05T17:41:10.129Z] 17:41:10 INFO - "main" prio=5 tid=1 NATIVE [task 2018-09-05T17:41:10.130Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x414c9578 self=0x2a00d090 [task 2018-09-05T17:41:10.130Z] 17:41:10 INFO - | sysTid=5002 nice=0 sched=0/0 cgrp=apps handle=1073811452 [task 2018-09-05T17:41:10.133Z] 17:41:10 INFO - | state=S schedstat=( 97642011221 50567998083 108370 ) utm=7237 stm=2527 core=0 [task 2018-09-05T17:41:10.133Z] 17:41:10 INFO - #00 pc 0001c5a4 /system/lib/libc.so (__futex_syscall3+8) [task 2018-09-05T17:41:10.133Z] 17:41:10 INFO - #01 pc 0000e688 /system/lib/libc.so (__pthread_cond_timedwait_relative+48) [task 2018-09-05T17:41:10.133Z] 17:41:10 INFO - #02 pc 0000e6e8 /system/lib/libc.so (__pthread_cond_timedwait+64) [task 2018-09-05T17:41:10.133Z] 17:41:10 INFO - #03 pc 00052e97 /system/lib/libdvm.so [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #04 pc 00053461 /system/lib/libdvm.so (dvmChangeStatus(Thread*, ThreadStatus)+30) [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #05 pc 00048d29 /system/lib/libdvm.so [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #06 pc 00039afd /system/lib/libdvm.so [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #07 pc 0004b7a9 /system/lib/libandroid_runtime.so (android::AndroidRuntime::getJNIEnv()+16) [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #08 pc 0005eed5 /system/lib/libandroid_runtime.so (android::NativeDisplayEventReceiver::dispatchVsync(long long, int, unsigned int)+20) [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #09 pc 0005f0b9 /system/lib/libandroid_runtime.so (android::NativeDisplayEventReceiver::handleEvent(int, int, void*)+80) [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #10 pc 00015129 /system/lib/libutils.so (android::Looper::pollInner(int)+468) [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #11 pc 000151d5 /system/lib/libutils.so (android::Looper::pollOnce(int, int*, int*, void**)+92) [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #12 pc 00067b69 /system/lib/libandroid_runtime.so (android::NativeMessageQueue::pollOnce(_JNIEnv*, int)+22) [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #13 pc 0001dc4c /system/lib/libdvm.so (dvmPlatformInvoke+112) [task 2018-09-05T17:41:10.134Z] 17:41:10 INFO - #14 pc 0004dcab /system/lib/libdvm.so (dvmCallJNIMethod(unsigned int const*, JValue*, Method const*, Thread*)+394) [task 2018-09-05T17:41:10.135Z] 17:41:10 INFO - #15 pc 000385e1 /system/lib/libdvm.so (dvmCheckCallJNIMethod(unsigned int const*, JValue*, Method const*, Thread*)+8) [task 2018-09-05T17:41:10.135Z] 17:41:10 INFO - #16 pc 00027060 /system/lib/libdvm.so [task 2018-09-05T17:41:10.135Z] 17:41:10 INFO - #17 pc 0002b580 /system/lib/libdvm.so (dvmInterpret(Thread*, Method const*, JValue*)+184) [task 2018-09-05T17:41:10.136Z] 17:41:10 INFO - #18 pc 0005ff7b /system/lib/libdvm.so (dvmInvokeMethod(Object*, Method const*, ArrayObject*, ArrayObject*, ClassObject*, bool)+350) [task 2018-09-05T17:41:10.136Z] 17:41:10 INFO - #19 pc 00067a9f /system/lib/libdvm.so [task 2018-09-05T17:41:10.137Z] 17:41:10 INFO - #20 pc 00027060 /system/lib/libdvm.so [task 2018-09-05T17:41:10.137Z] 17:41:10 INFO - #21 pc 0002b580 /system/lib/libdvm.so (dvmInterpret(Thread*, Method const*, JValue*)+184) [task 2018-09-05T17:41:10.138Z] 17:41:10 INFO - #22 pc 0005fcbd /system/lib/libdvm.so (dvmCallMethodV(Thread*, Method const*, Object*, bool, JValue*, std::__va_list)+292) [task 2018-09-05T17:41:10.138Z] 17:41:10 INFO - #23 pc 000499ab /system/lib/libdvm.so [task 2018-09-05T17:41:10.139Z] 17:41:10 INFO - #24 pc 0003cb3d /system/lib/libdvm.so [task 2018-09-05T17:41:10.139Z] 17:41:10 INFO - #25 pc 0004b68f /system/lib/libandroid_runtime.so [task 2018-09-05T17:41:10.139Z] 17:41:10 INFO - #26 pc 0004c30f /system/lib/libandroid_runtime.so (android::AndroidRuntime::start(char const*, char const*)+378) [task 2018-09-05T17:41:10.140Z] 17:41:10 INFO - #27 pc 0000105b /system/bin/app_process [task 2018-09-05T17:41:10.140Z] 17:41:10 INFO - #28 pc 0000db4f /system/lib/libc.so (__libc_init+50) [task 2018-09-05T17:41:10.141Z] 17:41:10 INFO - #29 pc 00000d7c /system/bin/app_process [task 2018-09-05T17:41:10.141Z] 17:41:10 INFO - at android.os.MessageQueue.nativePollOnce(Native Method) [task 2018-09-05T17:41:10.142Z] 17:41:10 INFO - at android.os.MessageQueue.next(MessageQueue.java:132) [task 2018-09-05T17:41:10.142Z] 17:41:10 INFO - at android.os.Looper.loop(Looper.java:124) [task 2018-09-05T17:41:10.142Z] 17:41:10 INFO - at android.app.ActivityThread.main(ActivityThread.java:5103) [task 2018-09-05T17:41:10.143Z] 17:41:10 INFO - at java.lang.reflect.Method.invokeNative(Native Method) [task 2018-09-05T17:41:10.143Z] 17:41:10 INFO - at java.lang.reflect.Method.invoke(Method.java:525) [task 2018-09-05T17:41:10.144Z] 17:41:10 INFO - at com.android.internal.os.ZygoteInit$MethodAndArgsCaller.run(ZygoteInit.java:737) [task 2018-09-05T17:41:10.144Z] 17:41:10 INFO - at com.android.internal.os.ZygoteInit.main(ZygoteInit.java:553) [task 2018-09-05T17:41:10.145Z] 17:41:10 INFO - at dalvik.system.NativeStart.main(Native Method) [task 2018-09-05T17:41:10.145Z] 17:41:10 INFO - "GeckoIconTask" prio=5 tid=18 WAIT [task 2018-09-05T17:41:10.146Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x41bdb158 self=0x2a2e0dc8 [task 2018-09-05T17:41:10.146Z] 17:41:10 INFO - | sysTid=6150 nice=0 sched=0/0 cgrp=apps handle=707672736 [task 2018-09-05T17:41:10.146Z] 17:41:10 INFO - | state=S schedstat=( 871294872 3413064469 704 ) utm=75 stm=12 core=0 [task 2018-09-05T17:41:10.147Z] 17:41:10 INFO - at java.lang.Object.wait(Native Method) [task 2018-09-05T17:41:10.147Z] 17:41:10 INFO - - waiting on <0x41bdb280> (a java.lang.VMThread) held by tid=18 (GeckoIconTask) [task 2018-09-05T17:41:10.148Z] 17:41:10 INFO - at java.lang.Thread.parkFor(Thread.java:1205) [task 2018-09-05T17:41:10.148Z] 17:41:10 INFO - at sun.misc.Unsafe.park(Unsafe.java:325) [task 2018-09-05T17:41:10.148Z] 17:41:10 INFO - at java.util.concurrent.locks.LockSupport.park(LockSupport.java:159) [task 2018-09-05T17:41:10.149Z] 17:41:10 INFO - at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2019) [task 2018-09-05T17:41:10.149Z] 17:41:10 INFO - at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:413) [task 2018-09-05T17:41:10.150Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1013) [task 2018-09-05T17:41:10.150Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1073) [task 2018-09-05T17:41:10.151Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:573) [task 2018-09-05T17:41:10.151Z] 17:41:10 INFO - at java.lang.Thread.run(Thread.java:841) [task 2018-09-05T17:41:10.152Z] 17:41:10 INFO - "AsyncTask #1" prio=5 tid=17 WAIT [task 2018-09-05T17:41:10.152Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x41a6fb58 self=0x2a2d8070 [task 2018-09-05T17:41:10.152Z] 17:41:10 INFO - | sysTid=5697 nice=10 sched=0/0 cgrp=apps/bg_non_interactive handle=707626176 [task 2018-09-05T17:41:10.153Z] 17:41:10 INFO - | state=S schedstat=( 11059454 23280823 7 ) utm=1 stm=0 core=0 [task 2018-09-05T17:41:10.153Z] 17:41:10 INFO - at java.lang.Object.wait(Native Method) [task 2018-09-05T17:41:10.154Z] 17:41:10 INFO - - waiting on <0x41ad3630> (a java.lang.VMThread) held by tid=17 (AsyncTask #1) [task 2018-09-05T17:41:10.154Z] 17:41:10 INFO - at java.lang.Thread.parkFor(Thread.java:1205) [task 2018-09-05T17:41:10.154Z] 17:41:10 INFO - at sun.misc.Unsafe.park(Unsafe.java:325) [task 2018-09-05T17:41:10.155Z] 17:41:10 INFO - at java.util.concurrent.locks.LockSupport.park(LockSupport.java:159) [task 2018-09-05T17:41:10.155Z] 17:41:10 INFO - at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2019) [task 2018-09-05T17:41:10.156Z] 17:41:10 INFO - at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:413) [task 2018-09-05T17:41:10.156Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1013) [task 2018-09-05T17:41:10.157Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1073) [task 2018-09-05T17:41:10.157Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:573) [task 2018-09-05T17:41:10.158Z] 17:41:10 INFO - at java.lang.Thread.run(Thread.java:841) [task 2018-09-05T17:41:10.158Z] 17:41:10 INFO - "WifiManager" prio=5 tid=16 NATIVE [task 2018-09-05T17:41:10.158Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x41abc518 self=0x2a2d5430 [task 2018-09-05T17:41:10.159Z] 17:41:10 INFO - | sysTid=5696 nice=0 sched=0/0 cgrp=apps handle=707614848 [task 2018-09-05T17:41:10.159Z] 17:41:10 INFO - | state=S schedstat=( 4549525 21424656 10 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.160Z] 17:41:10 INFO - #00 pc 0001c3dc /system/lib/libc.so (epoll_wait+12) [task 2018-09-05T17:41:10.160Z] 17:41:10 INFO - #01 pc 00014fb1 /system/lib/libutils.so (android::Looper::pollInner(int)+92) [task 2018-09-05T17:41:10.161Z] 17:41:10 INFO - #02 pc 000151d5 /system/lib/libutils.so (android::Looper::pollOnce(int, int*, int*, void**)+92) [task 2018-09-05T17:41:10.161Z] 17:41:10 INFO - #03 pc 00067b69 /system/lib/libandroid_runtime.so (android::NativeMessageQueue::pollOnce(_JNIEnv*, int)+22) [task 2018-09-05T17:41:10.162Z] 17:41:10 INFO - #04 pc 0001dc4c /system/lib/libdvm.so (dvmPlatformInvoke+112) [task 2018-09-05T17:41:10.162Z] 17:41:10 INFO - #05 pc 0004dcab /system/lib/libdvm.so (dvmCallJNIMethod(unsigned int const*, JValue*, Method const*, Thread*)+394) [task 2018-09-05T17:41:10.163Z] 17:41:10 INFO - #06 pc 000385e1 /system/lib/libdvm.so (dvmCheckCallJNIMethod(unsigned int const*, JValue*, Method const*, Thread*)+8) [task 2018-09-05T17:41:10.163Z] 17:41:10 INFO - #07 pc 00027060 /system/lib/libdvm.so [task 2018-09-05T17:41:10.164Z] 17:41:10 INFO - #08 pc 0002b580 /system/lib/libdvm.so (dvmInterpret(Thread*, Method const*, JValue*)+184) [task 2018-09-05T17:41:10.164Z] 17:41:10 INFO - #09 pc 0005fcbd /system/lib/libdvm.so (dvmCallMethodV(Thread*, Method const*, Object*, bool, JValue*, std::__va_list)+292) [task 2018-09-05T17:41:10.165Z] 17:41:10 INFO - #10 pc 0005fce7 /system/lib/libdvm.so (dvmCallMethod(Thread*, Method const*, Object*, JValue*, ...)+20) [task 2018-09-05T17:41:10.165Z] 17:41:10 INFO - #11 pc 00054a6f /system/lib/libdvm.so [task 2018-09-05T17:41:10.166Z] 17:41:10 INFO - #12 pc 0000ca58 /system/lib/libc.so (__thread_entry+72) [task 2018-09-05T17:41:10.166Z] 17:41:10 INFO - #13 pc 0000cbd4 /system/lib/libc.so (pthread_create+208) [task 2018-09-05T17:41:10.167Z] 17:41:10 INFO - at android.os.MessageQueue.nativePollOnce(Native Method) [task 2018-09-05T17:41:10.167Z] 17:41:10 INFO - at android.os.MessageQueue.next(MessageQueue.java:132) [task 2018-09-05T17:41:10.168Z] 17:41:10 INFO - at android.os.Looper.loop(Looper.java:124) [task 2018-09-05T17:41:10.168Z] 17:41:10 INFO - at android.os.HandlerThread.run(HandlerThread.java:61) [task 2018-09-05T17:41:10.169Z] 17:41:10 INFO - "Thread-77" prio=5 tid=15 NATIVE [task 2018-09-05T17:41:10.169Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x41a88e20 self=0x2a2d63e0 [task 2018-09-05T17:41:10.170Z] 17:41:10 INFO - | sysTid=5633 nice=0 sched=0/0 cgrp=apps handle=707343544 [task 2018-09-05T17:41:10.170Z] 17:41:10 INFO - | state=S schedstat=( 571878243 1491498355 619 ) utm=43 stm=14 core=0 [task 2018-09-05T17:41:10.171Z] 17:41:10 INFO - #00 pc 0001c5a4 /system/lib/libc.so (__futex_syscall3+8) [task 2018-09-05T17:41:10.171Z] 17:41:10 INFO - #01 pc 0000e688 /system/lib/libc.so (__pthread_cond_timedwait_relative+48) [task 2018-09-05T17:41:10.172Z] 17:41:10 INFO - #02 pc 0000e6e8 /system/lib/libc.so (__pthread_cond_timedwait+64) [task 2018-09-05T17:41:10.172Z] 17:41:10 INFO - #03 pc 003d3f2b /data/data/org.mozilla.fennec_aurora/cache/libxul.so [task 2018-09-05T17:41:10.173Z] 17:41:10 INFO - at dalvik.system.NativeStart.run(Native Method) [task 2018-09-05T17:41:10.173Z] 17:41:10 INFO - "pool-1-thread-1" prio=5 tid=14 WAIT [task 2018-09-05T17:41:10.174Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x41abc038 self=0x2a202368 [task 2018-09-05T17:41:10.174Z] 17:41:10 INFO - | sysTid=5029 nice=0 sched=0/0 cgrp=apps handle=706750392 [task 2018-09-05T17:41:10.174Z] 17:41:10 INFO - | state=S schedstat=( 33051868 75686212 48 ) utm=1 stm=2 core=0 [task 2018-09-05T17:41:10.175Z] 17:41:10 INFO - at java.lang.Object.wait(Native Method) [task 2018-09-05T17:41:10.175Z] 17:41:10 INFO - - waiting on <0x41abc180> (a java.lang.VMThread) held by tid=14 (pool-1-thread-1) [task 2018-09-05T17:41:10.176Z] 17:41:10 INFO - at java.lang.Thread.parkFor(Thread.java:1205) [task 2018-09-05T17:41:10.176Z] 17:41:10 INFO - at sun.misc.Unsafe.park(Unsafe.java:325) [task 2018-09-05T17:41:10.177Z] 17:41:10 INFO - at java.util.concurrent.locks.LockSupport.park(LockSupport.java:159) [task 2018-09-05T17:41:10.177Z] 17:41:10 INFO - at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2019) [task 2018-09-05T17:41:10.178Z] 17:41:10 INFO - at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:413) [task 2018-09-05T17:41:10.178Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1013) [task 2018-09-05T17:41:10.179Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1073) [task 2018-09-05T17:41:10.179Z] 17:41:10 INFO - at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:573) [task 2018-09-05T17:41:10.180Z] 17:41:10 INFO - at java.lang.Thread.run(Thread.java:841) [task 2018-09-05T17:41:10.180Z] 17:41:10 INFO - "actionMode" prio=5 tid=13 WAIT [task 2018-09-05T17:41:10.181Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x41a8bf60 self=0x2a1fb408 [task 2018-09-05T17:41:10.181Z] 17:41:10 INFO - | sysTid=5027 nice=0 sched=0/0 cgrp=apps handle=706719656 [task 2018-09-05T17:41:10.182Z] 17:41:10 INFO - | state=S schedstat=( 599241 25796009 2 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.182Z] 17:41:10 INFO - at java.lang.Object.wait(Native Method) [task 2018-09-05T17:41:10.183Z] 17:41:10 INFO - - waiting on <0x41a8bf60> (a java.util.Timer$TimerImpl) [task 2018-09-05T17:41:10.183Z] 17:41:10 INFO - at java.lang.Object.wait(Object.java:364) [task 2018-09-05T17:41:10.184Z] 17:41:10 INFO - at java.util.Timer$TimerImpl.run(Timer.java:214) [task 2018-09-05T17:41:10.184Z] 17:41:10 INFO - "Gecko" prio=5 tid=12 NATIVE [task 2018-09-05T17:41:10.185Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x41788900 self=0x2a1ee8e0 [task 2018-09-05T17:41:10.185Z] 17:41:10 INFO - | sysTid=5019 nice=0 sched=0/0 cgrp=apps handle=706650776 [task 2018-09-05T17:41:10.186Z] 17:41:10 INFO - | state=S schedstat=( 141169579455 193094654300 27833 ) utm=13535 stm=581 core=0 [task 2018-09-05T17:41:10.186Z] 17:41:10 INFO - #00 pc 0001c5a4 /system/lib/libc.so (__futex_syscall3+8) [task 2018-09-05T17:41:10.186Z] 17:41:10 INFO - #01 pc 0000e688 /system/lib/libc.so (__pthread_cond_timedwait_relative+48) [task 2018-09-05T17:41:10.187Z] 17:41:10 INFO - #02 pc 0000e6e8 /system/lib/libc.so (__pthread_cond_timedwait+64) [task 2018-09-05T17:41:10.188Z] 17:41:10 INFO - #03 pc 0005a269 /data/app-lib/org.mozilla.fennec_aurora-1/libmozglue.so (mozilla::detail::ConditionVariableImpl::wait(mozilla::detail::MutexImpl&)+4294696976) [task 2018-09-05T17:41:10.188Z] 17:41:10 INFO - #04 pc 0005a2a5 /data/app-lib/org.mozilla.fennec_aurora-1/libmozglue.so (mozilla::detail::ConditionVariableImpl::wait_for(mozilla::detail::MutexImpl&, mozilla::BaseTimeDuration<mozilla::TimeDurationValueCalculator> const&)+4294696988) [task 2018-09-05T17:41:10.189Z] 17:41:10 INFO - #05 pc 000b14cf /data/data/org.mozilla.fennec_aurora/cache/libxul.so [task 2018-09-05T17:41:10.189Z] 17:41:10 INFO - at org.mozilla.gecko.mozglue.GeckoLoader.nativeRun(Native Method) [task 2018-09-05T17:41:10.190Z] 17:41:10 INFO - at org.mozilla.gecko.GeckoThread.run(GeckoThread.java:504) [task 2018-09-05T17:41:10.190Z] 17:41:10 INFO - "GeckoBackgroundThread" daemon prio=5 tid=11 NATIVE [task 2018-09-05T17:41:10.191Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x417a5bb8 self=0x2a1c6c20 [task 2018-09-05T17:41:10.191Z] 17:41:10 INFO - | sysTid=5016 nice=0 sched=0/0 cgrp=apps handle=706497416 [task 2018-09-05T17:41:10.192Z] 17:41:10 INFO - | state=S schedstat=( 1252856283 4043994739 747 ) utm=107 stm=18 core=0 [task 2018-09-05T17:41:10.192Z] 17:41:10 INFO - #00 pc 0001c3dc /system/lib/libc.so (epoll_wait+12) [task 2018-09-05T17:41:10.193Z] 17:41:10 INFO - #01 pc 00014fb1 /system/lib/libutils.so (android::Looper::pollInner(int)+92) [task 2018-09-05T17:41:10.193Z] 17:41:10 INFO - #02 pc 000151d5 /system/lib/libutils.so (android::Looper::pollOnce(int, int*, int*, void**)+92) [task 2018-09-05T17:41:10.194Z] 17:41:10 INFO - #03 pc 00067b69 /system/lib/libandroid_runtime.so (android::NativeMessageQueue::pollOnce(_JNIEnv*, int)+22) [task 2018-09-05T17:41:10.194Z] 17:41:10 INFO - #04 pc 0001dc4c /system/lib/libdvm.so (dvmPlatformInvoke+112) [task 2018-09-05T17:41:10.195Z] 17:41:10 INFO - #05 pc 0004dcab /system/lib/libdvm.so (dvmCallJNIMethod(unsigned int const*, JValue*, Method const*, Thread*)+394) [task 2018-09-05T17:41:10.195Z] 17:41:10 INFO - #06 pc 000385e1 /system/lib/libdvm.so (dvmCheckCallJNIMethod(unsigned int const*, JValue*, Method const*, Thread*)+8) [task 2018-09-05T17:41:10.196Z] 17:41:10 INFO - #07 pc 00027060 /system/lib/libdvm.so [task 2018-09-05T17:41:10.196Z] 17:41:10 INFO - #08 pc 0002b580 /system/lib/libdvm.so (dvmInterpret(Thread*, Method const*, JValue*)+184) [task 2018-09-05T17:41:10.197Z] 17:41:10 INFO - #09 pc 0005fcbd /system/lib/libdvm.so (dvmCallMethodV(Thread*, Method const*, Object*, bool, JValue*, std::__va_list)+292) [task 2018-09-05T17:41:10.198Z] 17:41:10 INFO - #10 pc 0005fce7 /system/lib/libdvm.so (dvmCallMethod(Thread*, Method const*, Object*, JValue*, ...)+20) [task 2018-09-05T17:41:10.198Z] 17:41:10 INFO - #11 pc 00054a6f /system/lib/libdvm.so [task 2018-09-05T17:41:10.198Z] 17:41:10 INFO - #12 pc 0000ca58 /system/lib/libc.so (__thread_entry+72) [task 2018-09-05T17:41:10.199Z] 17:41:10 INFO - #13 pc 0000cbd4 /system/lib/libc.so (pthread_create+208) [task 2018-09-05T17:41:10.199Z] 17:41:10 INFO - at android.os.MessageQueue.nativePollOnce(Native Method) [task 2018-09-05T17:41:10.200Z] 17:41:10 INFO - at android.os.MessageQueue.next(MessageQueue.java:132) [task 2018-09-05T17:41:10.200Z] 17:41:10 INFO - at android.os.Looper.loop(Looper.java:124) [task 2018-09-05T17:41:10.201Z] 17:41:10 INFO - at org.mozilla.gecko.util.GeckoBackgroundThread.run(GeckoBackgroundThread.java:43) [task 2018-09-05T17:41:10.201Z] 17:41:10 INFO - "Binder_2" prio=5 tid=10 NATIVE [task 2018-09-05T17:41:10.202Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x41745578 self=0x2a04ebb8 [task 2018-09-05T17:41:10.202Z] 17:41:10 INFO - | sysTid=5014 nice=0 sched=0/0 cgrp=apps handle=704964976 [task 2018-09-05T17:41:10.203Z] 17:41:10 INFO - | state=S schedstat=( 15591160 32005564 16 ) utm=1 stm=0 core=0 [task 2018-09-05T17:41:10.203Z] 17:41:10 INFO - #00 pc 0001b2d4 /system/lib/libc.so (__ioctl+8) [task 2018-09-05T17:41:10.204Z] 17:41:10 INFO - #01 pc 0002b94b /system/lib/libc.so (ioctl+14) [task 2018-09-05T17:41:10.204Z] 17:41:10 INFO - #02 pc 0001b539 /system/lib/libbinder.so (android::IPCThreadState::talkWithDriver(bool)+140) [task 2018-09-05T17:41:10.205Z] 17:41:10 INFO - #03 pc 0001bcd7 /system/lib/libbinder.so (android::IPCThreadState::joinThreadPool(bool)+154) [task 2018-09-05T17:41:10.205Z] 17:41:10 INFO - #04 pc 0001faa5 /system/lib/libbinder.so [task 2018-09-05T17:41:10.206Z] 17:41:10 INFO - #05 pc 00011a75 /system/lib/libutils.so (android::Thread::_threadLoop(void*)+216) [task 2018-09-05T17:41:10.207Z] 17:41:10 INFO - #06 pc 0004b629 /system/lib/libandroid_runtime.so (android::AndroidRuntime::javaThreadShell(void*)+68) [task 2018-09-05T17:41:10.207Z] 17:41:10 INFO - #07 pc 00011569 /system/lib/libutils.so [task 2018-09-05T17:41:10.207Z] 17:41:10 INFO - #08 pc 0000ca58 /system/lib/libc.so (__thread_entry+72) [task 2018-09-05T17:41:10.208Z] 17:41:10 INFO - #09 pc 0000cbd4 /system/lib/libc.so (pthread_create+208) [task 2018-09-05T17:41:10.208Z] 17:41:10 INFO - at dalvik.system.NativeStart.run(Native Method) [task 2018-09-05T17:41:10.209Z] 17:41:10 INFO - "Binder_1" prio=5 tid=9 NATIVE [task 2018-09-05T17:41:10.209Z] 17:41:10 INFO - | group="main" sCount=1 dsCount=0 obj=0x417442e8 self=0x2a04e188 [task 2018-09-05T17:41:10.210Z] 17:41:10 INFO - | sysTid=5013 nice=0 sched=0/0 cgrp=apps handle=704800896 [task 2018-09-05T17:41:10.210Z] 17:41:10 INFO - | state=S schedstat=( 20324636 26812853 20 ) utm=1 stm=1 core=0 [task 2018-09-05T17:41:10.211Z] 17:41:10 INFO - #00 pc 0001b2d4 /system/lib/libc.so (__ioctl+8) [task 2018-09-05T17:41:10.211Z] 17:41:10 INFO - #01 pc 0002b94b /system/lib/libc.so (ioctl+14) [task 2018-09-05T17:41:10.212Z] 17:41:10 INFO - #02 pc 0001b539 /system/lib/libbinder.so (android::IPCThreadState::talkWithDriver(bool)+140) [task 2018-09-05T17:41:10.212Z] 17:41:10 INFO - #03 pc 0001bcd7 /system/lib/libbinder.so (android::IPCThreadState::joinThreadPool(bool)+154) [task 2018-09-05T17:41:10.213Z] 17:41:10 INFO - #04 pc 0001faa5 /system/lib/libbinder.so [task 2018-09-05T17:41:10.213Z] 17:41:10 INFO - #05 pc 00011a75 /system/lib/libutils.so (android::Thread::_threadLoop(void*)+216) [task 2018-09-05T17:41:10.214Z] 17:41:10 INFO - #06 pc 0004b629 /system/lib/libandroid_runtime.so (android::AndroidRuntime::javaThreadShell(void*)+68) [task 2018-09-05T17:41:10.214Z] 17:41:10 INFO - #07 pc 00011569 /system/lib/libutils.so [task 2018-09-05T17:41:10.215Z] 17:41:10 INFO - #08 pc 0000ca58 /system/lib/libc.so (__thread_entry+72) [task 2018-09-05T17:41:10.215Z] 17:41:10 INFO - #09 pc 0000cbd4 /system/lib/libc.so (pthread_create+208) [task 2018-09-05T17:41:10.216Z] 17:41:10 INFO - at dalvik.system.NativeStart.run(Native Method) [task 2018-09-05T17:41:10.217Z] 17:41:10 INFO - "FinalizerWatchdogDaemon" daemon prio=5 tid=8 WAIT [task 2018-09-05T17:41:10.217Z] 17:41:10 INFO - | group="system" sCount=1 dsCount=0 obj=0x41741260 self=0x2a025ed8 [task 2018-09-05T17:41:10.218Z] 17:41:10 INFO - | sysTid=5012 nice=0 sched=0/0 cgrp=apps handle=704799528 [task 2018-09-05T17:41:10.218Z] 17:41:10 INFO - | state=S schedstat=( 1594621 51653371 9 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.219Z] 17:41:10 INFO - at java.lang.Object.wait(Native Method) [task 2018-09-05T17:41:10.219Z] 17:41:10 INFO - - waiting on <0x414d16d8> (a java.lang.Daemons$FinalizerWatchdogDaemon) [task 2018-09-05T17:41:10.220Z] 17:41:10 INFO - at java.lang.Object.wait(Object.java:364) [task 2018-09-05T17:41:10.220Z] 17:41:10 INFO - at java.lang.Daemons$FinalizerWatchdogDaemon.waitForObject(Daemons.java:230) [task 2018-09-05T17:41:10.221Z] 17:41:10 INFO - at java.lang.Daemons$FinalizerWatchdogDaemon.run(Daemons.java:207) [task 2018-09-05T17:41:10.222Z] 17:41:10 INFO - at java.lang.Thread.run(Thread.java:841) [task 2018-09-05T17:41:10.222Z] 17:41:10 INFO - "FinalizerDaemon" daemon prio=5 tid=7 WAIT [task 2018-09-05T17:41:10.223Z] 17:41:10 INFO - | group="system" sCount=1 dsCount=0 obj=0x417410b0 self=0x2a025638 [task 2018-09-05T17:41:10.223Z] 17:41:10 INFO - | sysTid=5011 nice=0 sched=0/0 cgrp=apps handle=704797320 [task 2018-09-05T17:41:10.224Z] 17:41:10 INFO - | state=S schedstat=( 135480951 234281312 72 ) utm=11 stm=2 core=0 [task 2018-09-05T17:41:10.224Z] 17:41:10 INFO - at java.lang.Object.wait(Native Method) [task 2018-09-05T17:41:10.225Z] 17:41:10 INFO - - waiting on <0x414ba568> (a java.lang.ref.ReferenceQueue) [task 2018-09-05T17:41:10.225Z] 17:41:10 INFO - at java.lang.Object.wait(Object.java:401) [task 2018-09-05T17:41:10.226Z] 17:41:10 INFO - at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:102) [task 2018-09-05T17:41:10.226Z] 17:41:10 INFO - at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:73) [task 2018-09-05T17:41:10.227Z] 17:41:10 INFO - at java.lang.Daemons$FinalizerDaemon.run(Daemons.java:170) [task 2018-09-05T17:41:10.227Z] 17:41:10 INFO - at java.lang.Thread.run(Thread.java:841) [task 2018-09-05T17:41:10.228Z] 17:41:10 INFO - "ReferenceQueueDaemon" daemon prio=5 tid=6 WAIT [task 2018-09-05T17:41:10.228Z] 17:41:10 INFO - | group="system" sCount=1 dsCount=0 obj=0x41740f48 self=0x2a045a70 [task 2018-09-05T17:41:10.229Z] 17:41:10 INFO - | sysTid=5010 nice=0 sched=0/0 cgrp=apps handle=704929472 [task 2018-09-05T17:41:10.229Z] 17:41:10 INFO - | state=S schedstat=( 15253852 2079222 45 ) utm=1 stm=0 core=0 [task 2018-09-05T17:41:10.230Z] 17:41:10 INFO - at java.lang.Object.wait(Native Method) [task 2018-09-05T17:41:10.230Z] 17:41:10 INFO - - waiting on <0x414ba490> [task 2018-09-05T17:41:10.231Z] 17:41:10 INFO - at java.lang.Object.wait(Object.java:364) [task 2018-09-05T17:41:10.231Z] 17:41:10 INFO - at java.lang.Daemons$ReferenceQueueDaemon.run(Daemons.java:130) [task 2018-09-05T17:41:10.232Z] 17:41:10 INFO - at java.lang.Thread.run(Thread.java:841) [task 2018-09-05T17:41:10.232Z] 17:41:10 INFO - "Compiler" daemon prio=5 tid=5 VMWAIT [task 2018-09-05T17:41:10.233Z] 17:41:10 INFO - | group="system" sCount=1 dsCount=0 obj=0x41740e58 self=0x2a045418 [task 2018-09-05T17:41:10.233Z] 17:41:10 INFO - | sysTid=5009 nice=0 sched=0/0 cgrp=apps handle=704926160 [task 2018-09-05T17:41:10.234Z] 17:41:10 INFO - | state=S schedstat=( 1814295672 1457116303 3706 ) utm=103 stm=78 core=0 [task 2018-09-05T17:41:10.234Z] 17:41:10 INFO - #00 pc 0001c5a4 /system/lib/libc.so (__futex_syscall3+8) [task 2018-09-05T17:41:10.235Z] 17:41:10 INFO - #01 pc 0000e688 /system/lib/libc.so (__pthread_cond_timedwait_relative+48) [task 2018-09-05T17:41:10.236Z] 17:41:10 INFO - #02 pc 0000e6e8 /system/lib/libc.so (__pthread_cond_timedwait+64) [task 2018-09-05T17:41:10.236Z] 17:41:10 INFO - #03 pc 00072c9b /system/lib/libdvm.so [task 2018-09-05T17:41:10.237Z] 17:41:10 INFO - #04 pc 00054151 /system/lib/libdvm.so [task 2018-09-05T17:41:10.237Z] 17:41:10 INFO - #05 pc 0000ca58 /system/lib/libc.so (__thread_entry+72) [task 2018-09-05T17:41:10.238Z] 17:41:10 INFO - #06 pc 0000cbd4 /system/lib/libc.so (pthread_create+208) [task 2018-09-05T17:41:10.238Z] 17:41:10 INFO - at dalvik.system.NativeStart.run(Native Method) [task 2018-09-05T17:41:10.239Z] 17:41:10 INFO - "JDWP" daemon prio=5 tid=4 VMWAIT [task 2018-09-05T17:41:10.239Z] 17:41:10 INFO - | group="system" sCount=1 dsCount=0 obj=0x41740d70 self=0x2a044d80 [task 2018-09-05T17:41:10.240Z] 17:41:10 INFO - | sysTid=5008 nice=0 sched=0/0 cgrp=apps handle=704910640 [task 2018-09-05T17:41:10.240Z] 17:41:10 INFO - | state=S schedstat=( 1353814 34840769 7 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.241Z] 17:41:10 INFO - #00 pc 0001c078 /system/lib/libc.so (recvmsg+8) [task 2018-09-05T17:41:10.241Z] 17:41:10 INFO - #01 pc 00060797 /system/lib/libdvm.so [task 2018-09-05T17:41:10.242Z] 17:41:10 INFO - #02 pc 000609cb /system/lib/libdvm.so [task 2018-09-05T17:41:10.242Z] 17:41:10 INFO - #03 pc 00063687 /system/lib/libdvm.so [task 2018-09-05T17:41:10.243Z] 17:41:10 INFO - #04 pc 00054151 /system/lib/libdvm.so [task 2018-09-05T17:41:10.243Z] 17:41:10 INFO - #05 pc 0000ca58 /system/lib/libc.so (__thread_entry+72) [task 2018-09-05T17:41:10.244Z] 17:41:10 INFO - #06 pc 0000cbd4 /system/lib/libc.so (pthread_create+208) [task 2018-09-05T17:41:10.244Z] 17:41:10 INFO - at dalvik.system.NativeStart.run(Native Method) [task 2018-09-05T17:41:10.244Z] 17:41:10 INFO - "Signal Catcher" daemon prio=5 tid=3 RUNNABLE [task 2018-09-05T17:41:10.245Z] 17:41:10 INFO - | group="system" sCount=0 dsCount=0 obj=0x41740838 self=0x2a044930 [task 2018-09-05T17:41:10.245Z] 17:41:10 INFO - | sysTid=5007 nice=0 sched=0/0 cgrp=apps handle=704716120 [task 2018-09-05T17:41:10.246Z] 17:41:10 INFO - | state=R schedstat=( 68218010 75673691 19 ) utm=3 stm=3 core=0 [task 2018-09-05T17:41:10.246Z] 17:41:10 INFO - at dalvik.system.NativeStart.run(Native Method) [task 2018-09-05T17:41:10.246Z] 17:41:10 INFO - "GC" daemon prio=5 tid=2 VMWAIT [task 2018-09-05T17:41:10.247Z] 17:41:10 INFO - | group="system" sCount=1 dsCount=0 obj=0x41740758 self=0x2a0466c8 [task 2018-09-05T17:41:10.247Z] 17:41:10 INFO - | sysTid=5006 nice=0 sched=0/0 cgrp=apps handle=704923312 [task 2018-09-05T17:41:10.247Z] 17:41:10 INFO - | state=S schedstat=( 297173798 633382884 106 ) utm=22 stm=7 core=0 [task 2018-09-05T17:41:10.248Z] 17:41:10 INFO - #00 pc 0001c5a4 /system/lib/libc.so (__futex_syscall3+8) [task 2018-09-05T17:41:10.248Z] 17:41:10 INFO - #01 pc 0000e688 /system/lib/libc.so (__pthread_cond_timedwait_relative+48) [task 2018-09-05T17:41:10.249Z] 17:41:10 INFO - #02 pc 0000e6e8 /system/lib/libc.so (__pthread_cond_timedwait+64) [task 2018-09-05T17:41:10.249Z] 17:41:10 INFO - #03 pc 0007197f /system/lib/libdvm.so [task 2018-09-05T17:41:10.250Z] 17:41:10 INFO - #04 pc 00054151 /system/lib/libdvm.so [task 2018-09-05T17:41:10.250Z] 17:41:10 INFO - #05 pc 0000ca58 /system/lib/libc.so (__thread_entry+72) [task 2018-09-05T17:41:10.250Z] 17:41:10 INFO - #06 pc 0000cbd4 /system/lib/libc.so (pthread_create+208) [task 2018-09-05T17:41:10.251Z] 17:41:10 INFO - at dalvik.system.NativeStart.run(Native Method) [task 2018-09-05T17:41:10.251Z] 17:41:10 INFO - NATIVE THREADS: [task 2018-09-05T17:41:10.251Z] 17:41:10 INFO - "<no name>" sysTid=5022 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.252Z] 17:41:10 INFO - | state=S schedstat=( 6533224 35121058 4 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.252Z] 17:41:10 INFO - "<no name>" sysTid=5023 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.253Z] 17:41:10 INFO - | state=S schedstat=( 2536572878 7856118671 597 ) utm=227 stm=26 core=0 [task 2018-09-05T17:41:10.253Z] 17:41:10 INFO - "<no name>" sysTid=5024 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.253Z] 17:41:10 INFO - | state=S schedstat=( 112921981 318813816 359 ) utm=3 stm=8 core=0 [task 2018-09-05T17:41:10.254Z] 17:41:10 INFO - "<no name>" sysTid=5025 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.254Z] 17:41:10 INFO - | state=S schedstat=( 4634222564 15527151002 1010 ) utm=434 stm=29 core=0 [task 2018-09-05T17:41:10.255Z] 17:41:10 INFO - "<no name>" sysTid=5026 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.255Z] 17:41:10 INFO - | state=S schedstat=( 2778720884 7546613938 673 ) utm=255 stm=22 core=0 [task 2018-09-05T17:41:10.255Z] 17:41:10 INFO - "<no name>" sysTid=5048 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.256Z] 17:41:10 INFO - | state=S schedstat=( 1185957091 2041184021 5522 ) utm=45 stm=73 core=0 [task 2018-09-05T17:41:10.256Z] 17:41:10 INFO - "<no name>" sysTid=5082 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.256Z] 17:41:10 INFO - | state=S schedstat=( 574416211 705992882 902 ) utm=35 stm=22 core=0 [task 2018-09-05T17:41:10.257Z] 17:41:10 INFO - "<no name>" sysTid=5083 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.257Z] 17:41:10 INFO - | state=S schedstat=( 191524618 538761685 55 ) utm=14 stm=5 core=0 [task 2018-09-05T17:41:10.258Z] 17:41:10 INFO - "<no name>" sysTid=5192 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.258Z] 17:41:10 INFO - | state=S schedstat=( 10793814 21493115 4 ) utm=1 stm=0 core=0 [task 2018-09-05T17:41:10.259Z] 17:41:10 INFO - "<no name>" sysTid=5197 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.259Z] 17:41:10 INFO - | state=S schedstat=( 219389939 172949386 299 ) utm=14 stm=7 core=0 [task 2018-09-05T17:41:10.259Z] 17:41:10 INFO - "<no name>" sysTid=5565 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.260Z] 17:41:10 INFO - | state=S schedstat=( 25001171 32614689 6 ) utm=1 stm=1 core=0 [task 2018-09-05T17:41:10.260Z] 17:41:10 INFO - "<no name>" sysTid=5577 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.260Z] 17:41:10 INFO - | state=S schedstat=( 8380932 29005831 7 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.261Z] 17:41:10 INFO - "<no name>" sysTid=5581 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.261Z] 17:41:10 INFO - | state=S schedstat=( 3221745101 11683615921 713 ) utm=306 stm=16 core=0 [task 2018-09-05T17:41:10.261Z] 17:41:10 INFO - "<no name>" sysTid=5632 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.262Z] 17:41:10 INFO - | state=S schedstat=( 6246300350 7089937153 6896 ) utm=297 stm=327 core=0 [task 2018-09-05T17:41:10.262Z] 17:41:10 INFO - "<no name>" sysTid=5634 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.263Z] 17:41:10 INFO - | state=S schedstat=( 59746578 129398850 169 ) utm=1 stm=4 core=0 [task 2018-09-05T17:41:10.263Z] 17:41:10 INFO - "<no name>" sysTid=5638 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.263Z] 17:41:10 INFO - | state=S schedstat=( 4909929 5870498 7 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.264Z] 17:41:10 INFO - "<no name>" sysTid=5641 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.264Z] 17:41:10 INFO - | state=S schedstat=( 3918937 5315991 2 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.265Z] 17:41:10 INFO - "<no name>" sysTid=5684 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.265Z] 17:41:10 INFO - | state=S schedstat=( 4914775 5711577 6 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.266Z] 17:41:10 INFO - "<no name>" sysTid=5708 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.266Z] 17:41:10 INFO - | state=S schedstat=( 65438111 88584415 42 ) utm=5 stm=1 core=0 [task 2018-09-05T17:41:10.266Z] 17:41:10 INFO - "<no name>" sysTid=5745 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.267Z] 17:41:10 INFO - | state=S schedstat=( 5841590208 16883314871 1656 ) utm=553 stm=31 core=0 [task 2018-09-05T17:41:10.267Z] 17:41:10 INFO - "<no name>" sysTid=5875 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.268Z] 17:41:10 INFO - | state=S schedstat=( 41323631 115871350 18 ) utm=4 stm=0 core=0 [task 2018-09-05T17:41:10.268Z] 17:41:10 INFO - "<no name>" sysTid=6001 nice=1 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.268Z] 17:41:10 INFO - | state=S schedstat=( 119099528 334285675 42 ) utm=8 stm=3 core=0 [task 2018-09-05T17:41:10.269Z] 17:41:10 INFO - "<no name>" sysTid=6002 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.269Z] 17:41:10 INFO - | state=S schedstat=( 301728257 396059809 183 ) utm=24 stm=6 core=0 [task 2018-09-05T17:41:10.269Z] 17:41:10 INFO - "<no name>" sysTid=6003 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.270Z] 17:41:10 INFO - | state=S schedstat=( 260971931 1015306457 150 ) utm=15 stm=11 core=0 [task 2018-09-05T17:41:10.270Z] 17:41:10 INFO - "<no name>" sysTid=6021 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.270Z] 17:41:10 INFO - | state=S schedstat=( 149285559 540229811 48 ) utm=11 stm=3 core=0 [task 2018-09-05T17:41:10.271Z] 17:41:10 INFO - "<no name>" sysTid=6199 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.271Z] 17:41:10 INFO - | state=S schedstat=( 9799542 14083693 4 ) utm=0 stm=0 core=0 [task 2018-09-05T17:41:10.272Z] 17:41:10 INFO - "<no name>" sysTid=6280 nice=0 sched=0/0 cgrp=apps [task 2018-09-05T17:41:10.272Z] 17:41:10 INFO - | state=S schedstat=( 113047353 185396540 45 ) utm=2 stm=9 core=0 [task 2018-09-05T17:41:10.272Z] 17:41:10 INFO - ----- end 5002 ----- [task 2018-09-05T17:41:10.856Z] 17:41:10 INFO - /data/tombstones does not exist; tombstone check skipped [task 2018-09-05T17:41:11.681Z] 17:41:11 INFO - mozcrash Copy/paste: /usr/local/bin/linux64-minidump_stackwalk /tmp/tmpC5soPz/619656e2-cb99-621e-946a-e92ba4ea490e.dmp /builds/worker/workspace/build/symbols [task 2018-09-05T17:41:26.010Z] 17:41:26 INFO - mozcrash Saved minidump as /builds/worker/workspace/build/blobber_upload_dir/619656e2-cb99-621e-946a-e92ba4ea490e.dmp [task 2018-09-05T17:41:26.010Z] 17:41:26 INFO - mozcrash Saved app info as /builds/worker/workspace/build/blobber_upload_dir/619656e2-cb99-621e-946a-e92ba4ea490e.extra [task 2018-09-05T17:41:26.013Z] 17:41:26 WARNING - PROCESS-CRASH | dom/performance/tests/test_worker_user_timing.html | application crashed [@ libc.so + 0x1c3dc] [task 2018-09-05T17:41:26.014Z] 17:41:26 INFO - Crash dump filename: /tmp/tmpC5soPz/619656e2-cb99-621e-946a-e92ba4ea490e.dmp [task 2018-09-05T17:41:26.014Z] 17:41:26 INFO - Operating system: Android [task 2018-09-05T17:41:26.014Z] 17:41:26 INFO - 0.0.0 Linux 2.6.29-gea477bb #1 Wed Sep 26 11:04:45 PDT 2012 armv7l [task 2018-09-05T17:41:26.015Z] 17:41:26 INFO - CPU: arm [task 2018-09-05T17:41:26.015Z] 17:41:26 INFO - ARMv7 ARM Cortex-A8 features: swp,half,thumb,fastmult,vfpv2,edsp,neon,vfpv3 [task 2018-09-05T17:41:26.015Z] 17:41:26 INFO - 1 CPU [task 2018-09-05T17:41:26.016Z] 17:41:26 INFO - GPU: UNKNOWN [task 2018-09-05T17:41:26.016Z] 17:41:26 INFO - Crash reason: SIGABRT [task 2018-09-05T17:41:26.016Z] 17:41:26 INFO - Crash address: 0x30d4 [task 2018-09-05T17:41:26.016Z] 17:41:26 INFO - Process uptime: not available [task 2018-09-05T17:41:26.017Z] 17:41:26 INFO - Thread 0 (crashed) [task 2018-09-05T17:41:26.017Z] 17:41:26 INFO - 0 libc.so + 0x1c3dc [task 2018-09-05T17:41:26.018Z] 17:41:26 INFO - r0 = 0xfffffffc r1 = 0xbead14a8 r2 = 0x00000010 r3 = 0xffffffff [task 2018-09-05T17:41:26.018Z] 17:41:26 INFO - r4 = 0x2a040ba8 r5 = 0x00000000 r6 = 0x2a040bbc r7 = 0x000000fc [task 2018-09-05T17:41:26.018Z] 17:41:26 INFO - r8 = 0x2a040bf0 r9 = 0x00000014 r10 = 0x2a00d0a0 r12 = 0xbead14a8 [task 2018-09-05T17:41:26.019Z] 17:41:26 INFO - fp = 0xbead161c sp = 0xbead1488 lr = 0x400b1fb5 pc = 0x400433dc [task 2018-09-05T17:41:26.019Z] 17:41:26 INFO - Found by: given as instruction pointer in context [task 2018-09-05T17:41:26.020Z] 17:41:26 INFO - 1 libutils.so + 0x1785c [task 2018-09-05T17:41:26.020Z] 17:41:26 INFO - sp = 0xbead14a0 pc = 0x400b485e [task 2018-09-05T17:41:26.021Z] 17:41:26 INFO - Found by: stack scanning [task 2018-09-05T17:41:26.021Z] 17:41:26 INFO - 2 libbinder.so + 0x1bc2d [task 2018-09-05T17:41:26.022Z] 17:41:26 INFO - sp = 0xbead14d8 pc = 0x400f7c2f [task 2018-09-05T17:41:26.022Z] 17:41:26 INFO - Found by: stack scanning [task 2018-09-05T17:41:26.022Z] 17:41:26 INFO - 3 libbinder.so + 0x18603 [task 2018-09-05T17:41:26.023Z] 17:41:26 INFO - sp = 0xbead14f8 pc = 0x400f4605 [task 2018-09-05T17:41:26.023Z] 17:41:26 INFO - Found by: stack scanning [task 2018-09-05T17:41:26.024Z] 17:41:26 INFO - 4 libbinder.so + 0x2032d
Summary: Intermittent dom/performance/tests/test_worker_user_timing.html | application crashed [@ libc.so + 0x1c3dc] after TEST-UNEXPECTED-FAIL | dom/performance/tests/test_worker_user_timing.html | application timed out after 370 seconds with no output → Intermittent dom/performance/tests/test_worker_user_timing.html | application timed out after 370 seconds with no output
https://wiki.mozilla.org/Bug_Triage#Intermittent_Test_Failure_Cleanup
Status: NEW → RESOLVED
Closed: 8 years ago
Resolution: --- → INCOMPLETE
Component: DOM → DOM: Core & HTML
You need to log in before you can comment on or make changes to this bug.