Closed Bug 631442 Opened 13 years ago Closed 13 years ago

Intermittent test_redirect-caching_passing_wrap.js | test failed (with xpcshell return code: 1) followed by "crash" from "ASSERTION: Wrong thread!: 'NS_IsMainThread()'"

Categories

(Core :: Networking: HTTP, defect)

Product:
Core
Component:
Networking: HTTP
Platform:
x86
Linux
Type:
defect
Priority:
Not set
Severity:
normal

Tracking

()

Status:
RESOLVED FIXED

People

(Reporter: philor, Unassigned)

References

Details

(Keywords: intermittent-failure) 

http://tinderbox.mozilla.org/showlog.cgi?log=Firefox/1296782073.1296783600.27904.gz
Rev3 Fedora 12 mozilla-central debug test xpcshell on 2011/02/03 17:14:33
s: talos-r3-fed-030

TEST-INFO | /home/cltbld/talos-slave/test/build/xpcshell/tests/netwerk/test/unit_ipc/test_redirect-caching_passing_wrap.js | running test ...
TEST-UNEXPECTED-FAIL | /home/cltbld/talos-slave/test/build/xpcshell/tests/netwerk/test/unit_ipc/test_redirect-caching_passing_wrap.js | test failed (with xpcshell return code: 1), see following log:
>>>>>>>
### XPCOM_MEM_LEAK_LOG defined -- logging leaks to /tmp/tmpLUNZST/runxpcshelltests_leaks.log
pldhash: for the table at address 0x917aeb0, the given entrySize of 48 probably favors chaining over double hashing.
nsNativeModuleLoader::LoadModule("/home/cltbld/talos-slave/test/build/firefox/components/libxpcomsample.so") - load FAILED, rv: 80004005, error:
	/home/cltbld/talos-slave/test/build/firefox/components/libxpcomsample.so: cannot open shared object file: No such file or directory
TEST-INFO | (xpcshell/head.js) | test 1 pending
### XPCOM_MEM_LEAK_LOG defined -- logging leaks to /tmp/tmpLUNZST/runxpcshelltests_leaks_tab_pid5988.log
parent: TEST-INFO | (xpcshell/head.js) | test 2 pending
parent: TEST-INFO | (xpcshell/head.js) | test 2 finished
parent: TEST-INFO | (xpcshell/head.js) | running event loop
WARNING: NS_ENSURE_TRUE(mMainThread) failed: file ../../../xpcom/threads/nsThreadManager.cpp, line 284
WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0xC1F30001: file nsThreadUtils.cpp, line 173
WARNING: NS_ENSURE_TRUE(mMainThread) failed: file ../../../xpcom/threads/nsThreadManager.cpp, line 284
WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0xC1F30001: file nsThreadUtils.cpp, line 173
WARNING: NS_ENSURE_TRUE(mMainThread) failed: file ../../../xpcom/threads/nsThreadManager.cpp, line 284
WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0xC1F30001: file nsThreadUtils.cpp, line 173
WARNING: NS_ENSURE_TRUE(mMainThread) failed: file ../../../xpcom/threads/nsThreadManager.cpp, line 284
WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0xC1F30001: file nsThreadUtils.cpp, line 173
WARNING: NS_ENSURE_TRUE(mMainThread) failed: file ../../../xpcom/threads/nsThreadManager.cpp, line 284
WARNING: NS_ENSURE_SUCCESS(rv, rv) failed with result 0xC1F30001: file nsThreadUtils.cpp, line 173
nsNativeModuleLoader::LoadModule("/home/cltbld/talos-slave/test/build/firefox/components/libxpcomsample.so") - load FAILED, rv: 80004005, error:
	/home/cltbld/talos-slave/test/build/firefox/components/libxpcomsample.so: cannot open shared object file: No such file or directory
pldhash: for the table at address 0x87448e0, the given entrySize of 48 probably favors chaining over double hashing.
child: TEST-INFO | (xpcshell/head.js) | test 1 pending\nchild: TEST-INFO | (xpcshell/head.js) | test 2 pending\nchild: TEST-INFO | (xpcshell/head.js) | test 2 finished\nchild: TEST-INFO | (xpcshell/head.js) | running event loop\nWARNING: SQLite returned error code 1 , Storage will convert it to NS_ERROR_FAILURE: file ../../../storage/src/mozStoragePrivateHelpers.cpp, line 108
WARNING: SQLite returned error code 1 , Storage will convert it to NS_ERROR_FAILURE: file ../../../storage/src/mozStoragePrivateHelpers.cpp, line 108
pldhash: for the table at address 0x91fe998, the given entrySize of 48 probably favors chaining over double hashing.
WARNING: NS_ENSURE_TRUE(aOriginalURI) failed: file ../../../../netwerk/protocol/http/HttpBaseChannel.cpp, line 250
child: TEST-PASS | ../unit/head_channels.js | [null : 144] 13 == 13\nchild: TEST-PASS | /home/cltbld/talos-slave/test/build/xpcshell/tests/netwerk/test/unit/test_redirect-caching_passing.js | [firstTimeThrough : 31] response body == response body\nWARNING: NS_ENSURE_TRUE(aOriginalURI) failed: file ../../../../netwerk/protocol/http/HttpBaseChannel.cpp, line 250
child: TEST-PASS | ../unit/head_channels.js | [null : 144] 13 == 13\nchild: TEST-PASS | /home/cltbld/talos-slave/test/build/xpcshell/tests/netwerk/test/unit/test_redirect-caching_passing.js | [finish_test : 39] response body == response body\nchild: TEST-INFO | (xpcshell/head.js) | test 1 finished\nchild: TEST-INFO | (xpcshell/head.js) | exiting test\nchild: TEST-PASS | (xpcshell/head.js) | 4 (+ 0) check(s) passed\nparent: TEST-INFO | (xpcshell/head.js) | test 1 finished
parent: TEST-INFO | (xpcshell/head.js) | exiting test
parent: TEST-INFO | (xpcshell/head.js) | No (+ 0) checks actually run
WARNING: nsExceptionService ignoring thread destruction after shutdown: file ../../../xpcom/base/nsExceptionService.cpp, line 197
###!!! ASSERTION: Wrong thread!: 'NS_IsMainThread()', file ../../../dom/ipc/ContentParent.cpp, line 278
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01860FAC]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x018609EA]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01862D94]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AD7766]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AD8FF3]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AAC788]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AA8788]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AA9C13]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AA9C8A]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AACE14]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AACF66]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01ADCC78]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AD7BD6]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01A5F020]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libxul.so +0x01AD87D9]
UNKNOWN [/home/cltbld/talos-slave/test/build/firefox/libnspr4.so +0x00030AEC]
UNKNOWN [/lib/libpthread.so.0 +0x00005AB5]
###!!! ASSERTION: Wrong thread!: 'NS_IsMainThread()', file ../../../dom/ipc/ContentParent.cpp, line 278
NOTE: child process received `Goodbye', closing down

###!!! [Child][RPCChannel] Error: Channel closing: too late to send/recv, messages will be lost

WARNING: content process _exit()ing: file ../../../dom/ipc/ContentChild.cpp, line 471
<<<<<<<
PROCESS-CRASH | /home/cltbld/talos-slave/test/build/xpcshell/tests/netwerk/test/unit_ipc/test_redirect-caching_passing_wrap.js | application crashed (minidump found)
Operating system: Linux
                  0.0.0 Linux 2.6.31.5-127.fc12.i686.PAE #1 SMP Sat Nov 7 21:25:57 EST 2009 i686
CPU: x86
     GenuineIntel family 6 model 23 stepping 10
     2 CPUs

Crash reason:  SIGABRT
Crash address: 0x175c

Thread 7 (crashed)
 0  linux-gate.so + 0x424
    eip = 0x00bb5424   esp = 0xb0cfb828   ebp = 0xb0cfb840   ebx = 0x0000175c
    esi = 0x0927d404   edi = 0x002c1ff4   eax = 0x00000000   ecx = 0x0000176f
    edx = 0x00000006   efl = 0x00200206
    Found by: given as instruction pointer in context
 1  libc-2.11.so + 0x2c349
    eip = 0x0017d34a   esp = 0xb0cfb848   ebp = 0xb0cfb968
    Found by: previous frame's frame pointer
 2  libmozalloc.so!mozalloc_abort [mozalloc_abort.cpp : 75 + 0x4]
    eip = 0x00eed048   esp = 0xb0cfb970   ebp = 0xb0cfb988
    Found by: previous frame's frame pointer
 3  0x29d831b
    eip = 0x029d831c   esp = 0xb0cfb990   ebp = 0xb0cfb998   ebx = 0x03764c94
    Found by: call frame info
(more useless stack)
20  libnspr4.so!_pt_root [ptthread.c : 187 + 0x10]
    eip = 0x00140aec   esp = 0xb0cfc2a0   ebp = 0xb0cfc2c8
    Found by: previous frame's frame pointer
From these logs, this orange appeared the day after bug 621386 landed, which made ContentParent destroy itself a bit more thoroughly than it used to.  It's probably a safe bet that that cleanup started tickling this.
Blocks: 621386
Looks like there are no more reports of this.  Did anything around bug 621386 changed?
I can't imagine that bug 621386 affected anything, since it landed more than two weeks before the last orange.
(In reply to comment #9)
> From these logs, this orange appeared the day after bug 621386 landed..

As the bug probably caused this orange, something around the code that bug was touching might have been changed and fixed the orange.  That was what my comment meant.
Looks like this is fixed.
Status: NEW → RESOLVED
Closed: 13 years ago
Resolution: --- → FIXED
Whiteboard: [orange]
You need to log in before you can comment on or make changes to this bug.