Closed Bug 1630432 Opened 5 years ago Closed 5 years ago

Intermittent /css/css-grid/alignment/<test_name> | application crashed [@ mozalloc_abort + 0x54] | ProfilingStack::ensureCapacitySlow | ProfilingStack::pushLabelFrame

Categories

(Core :: Layout: Grid, defect)

defect
Not set
normal

Tracking

()

RESOLVED INCOMPLETE

People

(Reporter: intermittent-bug-filer, Unassigned)

Details

(Keywords: crash, intermittent-failure)

Crash Data

Filed by: nerli [at] mozilla.com
Parsed log: https://treeherder.mozilla.org/logviewer.html#?job_id=297784203&repo=mozilla-central
Full log: https://firefox-ci-tc.services.mozilla.com/api/queue/v1/task/etZn56nrTxG09Ei7ZaNj1A/runs/0/artifacts/public/logs/live_backing.log


[task 2020-04-15T17:55:28.619Z] 17:55:28 INFO - TEST-START | /css/css-layout-api/layout-child/inlines-dynamic.https.html
[task 2020-04-15T17:55:28.624Z] 17:55:28 INFO - Clearing pref dom.animations-api.compositing.enabled
[task 2020-04-15T17:55:28.645Z] 17:55:28 INFO - Clearing pref layout.css.comparison-functions.enabled
[task 2020-04-15T17:55:28.683Z] 17:55:28 INFO - Setting pref dom.animations-api.compositing.enabled (true)
[task 2020-04-15T17:55:28.704Z] 17:55:28 INFO - Setting pref layout.css.comparison-functions.enabled (true)
[task 2020-04-15T17:55:28.730Z] 17:55:28 INFO - Closing window 30
[task 2020-04-15T17:55:28.809Z] 17:55:28 INFO - PID 12604 | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2020-04-15T17:55:31.348Z] 17:55:31 INFO - .
[task 2020-04-15T17:55:31.348Z] 17:55:31 INFO - TEST-OK | /css/css-layout-api/layout-child/inlines-dynamic.https.html | took 2723ms
[task 2020-04-15T17:55:31.540Z] 17:55:31 INFO - PID 12604 | 1586973331538 Marionette INFO Stopped listening on port 52969
[task 2020-04-15T17:55:32.822Z] 17:55:32 INFO - mozcrash Copy/paste: Z:\task_1586971818\fetches\minidump_stackwalk\minidump_stackwalk.exe c:\users\task_1586971818\appdata\local\temp\tmp1s5hcj\minidumps\04fd8c9c-753a-4b74-b022-9911a4aa4a1b.dmp c:\users\task_1586971818\appdata\local\temp\tmp69wtyh
[task 2020-04-15T17:55:33.616Z] 17:55:33 INFO - PID 12604 | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2020-04-15T17:55:33.634Z] 17:55:33 INFO - PID 12604 | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2020-04-15T17:55:33.634Z] 17:55:33 INFO - PID 12604 | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2020-04-15T17:55:33.672Z] 17:55:33 INFO - PID 12604 | JavaScript error: , line 0: uncaught exception: 2147500036
[task 2020-04-15T17:55:33.672Z] 17:55:33 INFO - PID 12604 | JavaScript error: , line 0: uncaught exception: 2147500036
[task 2020-04-15T17:55:33.672Z] 17:55:33 INFO - PID 12604 | JavaScript error: , line 0: uncaught exception: 2147500036
[task 2020-04-15T17:55:37.549Z] 17:55:37 INFO - PID 12604 | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2020-04-15T17:55:37.568Z] 17:55:37 INFO - PID 12604 | ###!!! [Parent][RunMessage] Error: Channel closing: too late to send/recv, messages will be lost
[task 2020-04-15T17:55:46.533Z] 17:55:46 INFO - mozcrash Saved minidump as Z:\task_1586971818\build\blobber_upload_dir\04fd8c9c-753a-4b74-b022-9911a4aa4a1b.dmp
[task 2020-04-15T17:55:46.538Z] 17:55:46 INFO - mozcrash Saved app info as Z:\task_1586971818\build\blobber_upload_dir\04fd8c9c-753a-4b74-b022-9911a4aa4a1b.extra
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - PROCESS-CRASH | /css/css-grid/alignment/grid-self-alignment-positioned-items-with-margin-border-padding-012.html | application crashed [@ mozalloc_abort + 0x54]
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - Mozilla crash reason: MOZ_CRASH()
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - Crash dump filename: c:\users\task_1586971818\appdata\local\temp\tmp1s5hcj\minidumps\04fd8c9c-753a-4b74-b022-9911a4aa4a1b.dmp
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - Operating system: Windows NT
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - 10.0.17134
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - CPU: amd64
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - family 6 model 85 stepping 4
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - 8 CPUs
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO -
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - GPU: UNKNOWN
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO -
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - Crash reason: EXCEPTION_BREAKPOINT
[task 2020-04-15T17:55:46.560Z] 17:55:46 INFO - Crash address: 0x26394774
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - Assertion: Unknown assertion type 0x00000000
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - Process uptime: 3 seconds
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO -
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - Thread 4 (crashed)
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - 0 mozglue.dll!mozalloc_abort + 0x54
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - rax = 0x00007ffd2651b304 rdx = 0x00007ffd3a06a640
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - rcx = 0x00000000ffffffff rbx = 0x000000000000001e
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - rsi = 0x000000a67afff650 rdi = 0x00007ffd39f907b0
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - rbp = 0x0000000000001000 rsp = 0x000000a67afff5f0
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - r8 = 0x000000a67affdfa8 r9 = 0x000000a67afff581
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - r10 = 0x0000000000000000 r11 = 0x000000a67afff4d0
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - r12 = 0x00007ffcfaeb1710 r13 = 0x0000021d4a2470c0
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - r14 = 0x0000000000001000 r15 = 0x0000000000001000
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - rip = 0x00007ffd26394774
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - Found by: given as instruction pointer in context
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - 1 mozglue.dll!void mozalloc_handle_oom(uint64_t) + 0x148
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - rbx = 0x000000000000001e rbp = 0x0000000000001000
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - rsp = 0x000000a67afff630 r12 = 0x00007ffcfaeb1710
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - r13 = 0x0000021d4a2470c0 r14 = 0x0000000000001000
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - r15 = 0x0000000000001000 rip = 0x00007ffd26394eb8
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - Found by: call frame info
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - 2 mozglue.dll!moz_xmalloc + 0x72
[task 2020-04-15T17:55:46.561Z] 17:55:46 INFO - rbx = 0x000000000000001e rbp = 0x0000000000001000
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - rsp = 0x000000a67afff6a0 r12 = 0x00007ffcfaeb1710
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - r13 = 0x0000021d4a2470c0 r14 = 0x0000000000001000
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - r15 = 0x0000000000001000 rip = 0x00007ffd26394d52
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - Found by: call frame info
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - 3 xul.dll!char * mozilla::BufferList<class InfallibleAllocPolicy>::AllocateSegment(uint64_t,uint64_t) + 0xaa
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - rbx = 0x000000000000001e rbp = 0x0000000000001000
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - rsp = 0x000000a67afff6d0 r12 = 0x00007ffcfaeb1710
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - r13 = 0x0000021d4a2470c0 r14 = 0x0000000000001000
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - r15 = 0x0000000000001000 rip = 0x00007ffce436948a
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - Found by: call frame info
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - 4 xul.dll!char * mozilla::BufferList<class InfallibleAllocPolicy>::AllocateBytes(uint64_t,uint64_t *) + 0x1de
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - rbx = 0x000000000000001e rbp = 0x0000000000001000
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - rsp = 0x000000a67afff740 r12 = 0x00007ffcfaeb1710
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - r13 = 0x0000021d4a2470c0 r14 = 0x0000000000001000
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - r15 = 0x0000000000001000 rip = 0x00007ffce436ab4e
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - Found by: call frame info
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - 5 xul.dll!bool mozilla::BufferList<class InfallibleAllocPolicy>::WriteBytes(char const *,uint64_t) + 0xe9
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - rbx = 0x000000000000001e rbp = 0x0000000000001000
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - rsp = 0x000000a67afff790 r12 = 0x00007ffcfaeb1710
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - r13 = 0x0000021d4a2470c0 r14 = 0x0000000000001000
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - r15 = 0x0000000000001000 rip = 0x00007ffce434eb69
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - Found by: call frame info
[task 2020-04-15T17:55:46.562Z] 17:55:46 INFO - 6 xul.dll!void Pickle::InputBytes(char const *,unsigned int) + 0x2a
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - rbx = 0x000000000000001e rbp = 0x0000000000001000
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - rsp = 0x000000a67afff800 r12 = 0x00007ffcfaeb1710
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - r13 = 0x0000021d4a2470c0 r14 = 0x0000000000001000
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - r15 = 0x0000000000001000 rip = 0x00007ffce434fada
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - Found by: call frame info
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - 7 xul.dll!bool IPC::Channel::ChannelImpl::ProcessIncomingMessages(struct base::MessagePumpForIO::IOContext *,unsigned long) + 0x399
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - rbx = 0x000000000000001e rbp = 0x0000000000001000
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - rsp = 0x000000a67afff840 r12 = 0x00007ffcfaeb1710
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - r13 = 0x0000021d4a2470c0 r14 = 0x0000000000001000
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - r15 = 0x0000000000001000 rip = 0x00007ffce4330f59
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - Found by: call frame info
[task 2020-04-15T17:55:46.563Z] 17:55:46 INFO - 8 xul.dll!virtual void IPC::Channel::ChannelImpl::OnIOCompleted(struct base::MessagePumpForIO::IOContext *,unsigned long,unsigned long) + 0x1b9

Status: NEW → RESOLVED
Closed: 5 years ago
Resolution: --- → DUPLICATE
Status: RESOLVED → REOPENED
Resolution: DUPLICATE → ---
Summary: Intermittent /css/css-grid/alignment/<test_name> | application crashed [@ mozalloc_abort + 0x54] → Intermittent /css/css-grid/alignment/<test_name> | application crashed [@ mozalloc_abort + 0x54] | ProfilingStack::ensureCapacitySlow | ProfilingStack::pushLabelFrame

The allocation seems to come from some buffer write operation in Pickle::InputBytes called from IPC code, so I doubt it has anything to do with the layout test at that time.

Component: Layout: Grid → General
Component: General → IPC

This looks like the CI version of an OOM | small crash signature. I don't think this is actionable without evidence of what subsystem is actually causing the memory exhaustion. (As it is, I don't think we can even determine the name of the IPC message that was in the process of being received.)

Status: REOPENED → RESOLVED
Closed: 5 years ago5 years ago
Resolution: --- → INCOMPLETE

The most recent crash, in comment 4, is happening when we're trying to allocate a nsNodeInfoManager, which is tiny, and there's also a very early startup OOM crash, so it is way more likely to be some kind of issue in this test directory. I don't know how actionable this really is, though. Maybe the test suite is leaking windows.

Component: IPC → Layout: Grid
You need to log in before you can comment on or make changes to this bug.