1823583 - assertion on browser_sandbox_test.js while running on MSIX build/installer for win11/debug

Status: RESOLVED FIXED

(Core :: Security: Process Sandboxing, defect, P2)

Description

[Joel Maher ( :jmaher ) (UTC -8)]

here is a log file:
https://firefoxci.taskcluster-artifacts.net/QQ5AsvL_RfmAFczL5sWgdQ/0/public/logs/live_backing.log

[task 2023-03-15T14:06:54.313Z] 14:06:54     INFO - GECKO(5916) | #01: mozilla::MozPromise<mozilla::SandboxTestingParent *,nsresult,1>::ThenValue<`lambda at /builds/worker/checkouts/gecko/security/sandbox/common/test/SandboxTest.cpp:290:9',`lambda at /builds/worker/checkouts/gecko/security/sandbox/common/test/SandboxTest.cpp:294:9'>::DoResolveOrRejectInternal(mozilla::MozPromise<mozilla::SandboxTestingParent *,nsresult,1>::ResolveOrRejectValue&) [xpcom/threads/MozPromise.h:863]
[task 2023-03-15T14:06:54.324Z] 14:06:54     INFO - GECKO(5916) | #02: mozilla::MozPromise<mozilla::SandboxTestingParent *,nsresult,1>::ThenValueBase::ResolveOrRejectRunnable::Run() [xpcom/threads/MozPromise.h:490]
[task 2023-03-15T14:06:54.325Z] 14:06:54     INFO - GECKO(5916) | #03: mozilla::RunnableTask::Run() [xpcom/threads/TaskController.cpp:554]
[task 2023-03-15T14:06:54.326Z] 14:06:54     INFO - GECKO(5916) | #04: mozilla::TaskController::DoExecuteNextTaskOnlyMainThreadInternal(mozilla::detail::BaseAutoLock<mozilla::Mutex &> const&) [xpcom/threads/TaskController.cpp:867]
[task 2023-03-15T14:06:54.326Z] 14:06:54     INFO - GECKO(5916) | #05: mozilla::TaskController::ExecuteNextTaskOnlyMainThreadInternal(mozilla::detail::BaseAutoLock<mozilla::Mutex &> const&) [xpcom/threads/TaskController.cpp:698]
[task 2023-03-15T14:06:54.327Z] 14:06:54     INFO - GECKO(5916) | #06: mozilla::TaskController::ProcessPendingMTTask(bool) [xpcom/threads/TaskController.cpp:464]
[task 2023-03-15T14:06:54.327Z] 14:06:54     INFO - GECKO(5916) | #07: mozilla::detail::RunnableFunction<`lambda at /builds/worker/checkouts/gecko/xpcom/threads/TaskController.cpp:188:7'>::Run() [xpcom/threads/nsThreadUtils.h:548]
[task 2023-03-15T14:06:54.328Z] 14:06:54     INFO - GECKO(5916) | #08: nsThread::ProcessNextEvent(bool, bool*) [xpcom/threads/nsThread.cpp:1243]
[task 2023-03-15T14:06:54.328Z] 14:06:54     INFO - GECKO(5916) | #09: NS_ProcessNextEvent(nsIThread*, bool) [xpcom/threads/nsThreadUtils.cpp:477]
[task 2023-03-15T14:06:54.329Z] 14:06:54     INFO - GECKO(5916) | #10: mozilla::ipc::MessagePump::Run(base::MessagePump::Delegate*) [ipc/glue/MessagePump.cpp:86]
[task 2023-03-15T14:06:54.329Z] 14:06:54     INFO - GECKO(5916) | #11: MessageLoop::RunHandler() [ipc/chromium/src/base/message_loop.cc:375]
[task 2023-03-15T14:06:54.330Z] 14:06:54     INFO - GECKO(5916) | #12: MessageLoop::Run() [ipc/chromium/src/base/message_loop.cc:357]
[task 2023-03-15T14:06:54.330Z] 14:06:54     INFO - GECKO(5916) | #13: nsBaseAppShell::Run() [widget/nsBaseAppShell.cpp:150]
[task 2023-03-15T14:06:54.331Z] 14:06:54     INFO - GECKO(5916) | #14: nsAppShell::Run() [widget/windows/nsAppShell.cpp:614]
[task 2023-03-15T14:06:54.331Z] 14:06:54     INFO - GECKO(5916) | #15: nsAppStartup::Run() [toolkit/components/startup/nsAppStartup.cpp:296]
[task 2023-03-15T14:06:54.332Z] 14:06:54     INFO - GECKO(5916) | #16: XREMain::XRE_mainRun() [toolkit/xre/nsAppRunner.cpp:5651]
[task 2023-03-15T14:06:54.333Z] 14:06:54     INFO - GECKO(5916) | #17: XREMain::XRE_main(int, char**, mozilla::BootstrapConfig const&) [toolkit/xre/nsAppRunner.cpp:5851]
[task 2023-03-15T14:06:54.333Z] 14:06:54     INFO - GECKO(5916) | #18: XRE_main(int, char**, mozilla::BootstrapConfig const&) [toolkit/xre/nsAppRunner.cpp:5907]
[task 2023-03-15T14:06:54.407Z] 14:06:54     INFO - GECKO(5916) | #19: NS_internal_main(int, char**, char**) [browser/app/nsBrowserApp.cpp:423]
[task 2023-03-15T14:06:54.409Z] 14:06:54     INFO - GECKO(5916) | #20: wmain(int, wchar_t**) [toolkit/xre/nsWindowsWMain.cpp:167]
[task 2023-03-15T14:06:54.409Z] 14:06:54     INFO - GECKO(5916) | #21: __scrt_common_main_seh() [/builds/worker/workspace/obj-build/browser/app/d:/agent/_work/2/s/src/vctools/crt/vcstartup/src/startup/exe_common.inl:288]
[task 2023-03-15T14:06:54.410Z] 14:06:54     INFO - GECKO(5916) | #22: BaseThreadInitThunk [C:\Windows\System32\KERNEL32.DLL + 0x126bd]
[task 2023-03-15T14:06:54.410Z] 14:06:54     INFO - GECKO(5916) | #23: RtlUserThreadStart [C:\Windows\SYSTEM32\ntdll.dll + 0x5dfb8]

Comment 1

[:gerard-majax]

[task 2023-03-15T13:55:15.738Z] 13:55:15     INFO - GECKO(3600) | [GPU 6552, Compositor] ###!!! ASSERTION: Tried to delete invalid animation: 'Error', file /builds/worker/checkouts/gecko/gfx/layers/wr/OMTASampler.cpp:204
[task 2023-03-15T13:55:15.738Z] 13:55:15     INFO - GECKO(3600) | #01: NS_DebugBreak(unsigned int, char const*, char const*, char const*, int) [xpcom/base/nsDebugImpl.cpp:492]
[task 2023-03-15T13:55:15.739Z] 13:55:15     INFO - GECKO(3600) | #02: mozilla::layers::OMTASampler::RemoveEpochDataPriorTo(std::queue<mozilla::layers::CompositorAnimationIdsForEpoch,std::deque<mozilla::layers::CompositorAnimationIdsForEpoch,std::allocator<mozilla::layers::CompositorAnimationIdsForEpoch> > >&, std::unordered_map<unsigned long long,mozilla::wr::Epoch,std::hash<unsigned long long>,std::equal_to<unsigned long long>,std::allocator<std::pair<const unsigned long long,mozilla::wr::Epoch> > >&, mozilla::wr::Epoch const&) [gfx/layers/wr/OMTASampler.cpp:201]
[task 2023-03-15T13:55:15.741Z] 13:55:15     INFO - GECKO(3600) | #03: mozilla::layers::WebRenderBridgeParent::RemoveEpochDataPriorTo(mozilla::wr::Epoch const&) [gfx/layers/wr/WebRenderBridgeParent.cpp:953]
[task 2023-03-15T13:55:15.744Z] 13:55:15     INFO - GECKO(3600) | #04: mozilla::layers::CompositorBridgeParent::NotifyPipelineRendered(mozilla::wr::PipelineId const&, mozilla::wr::Epoch const&, mozilla::layers::BaseTransactionId<mozilla::VsyncIdType> const&, mozilla::TimeStamp&, mozilla::TimeStamp&, mozilla::TimeStamp&, mozilla::wr::RendererStats*) [gfx/layers/ipc/CompositorBridgeParent.cpp:1587]
[task 2023-03-15T13:55:15.744Z] 13:55:15     INFO - GECKO(3600) | #05: mozilla::wr::NotifyDidRender(mozilla::layers::CompositorBridgeParent*, RefPtr<const mozilla::wr::WebRenderPipelineInfo> const&, mozilla::layers::BaseTransactionId<mozilla::VsyncIdType>, mozilla::TimeStamp, mozilla::TimeStamp, mozilla::TimeStamp, bool, mozilla::wr::RendererStats) [gfx/webrender_bindings/RenderThread.cpp:537]
[task 2023-03-15T13:55:15.750Z] 13:55:15     INFO - GECKO(3600) | #06: RunnableFunction<void (*)(mozilla::layers::CompositorBridgeParent *, const RefPtr<const mozilla::wr::WebRenderPipelineInfo> &, mozilla::layers::BaseTransactionId<mozilla::VsyncIdType>, mozilla::TimeStamp, mozilla::TimeStamp, mozilla::TimeStamp, bool, mozilla::wr::RendererStats),mozilla::Tuple<mozilla::layers::CompositorBridgeParent *,RefPtr<const mozilla::wr::WebRenderPipelineInfo>,mozilla::layers::BaseTransactionId<mozilla::VsyncIdType>,mozilla::TimeStamp,mozilla::TimeStamp,mozilla::TimeStamp,bool,mozilla::wr::RendererStats> >::Run() [ipc/chromium/src/base/task.h:325]
[task 2023-03-15T13:55:15.752Z] 13:55:15     INFO - GECKO(3600) | #07: nsThread::ProcessNextEvent(bool, bool*) [xpcom/threads/nsThread.cpp:1234]
[task 2023-03-15T13:55:15.754Z] 13:55:15     INFO - GECKO(3600) | #08: NS_ProcessNextEvent(nsIThread*, bool) [xpcom/threads/nsThreadUtils.cpp:477]
[task 2023-03-15T13:55:15.754Z] 13:55:15     INFO - GECKO(3600) | #09: mozilla::ipc::MessagePumpForNonMainThreads::Run(base::MessagePump::Delegate*) [ipc/glue/MessagePump.cpp:301]
[task 2023-03-15T13:55:15.754Z] 13:55:15     INFO - GECKO(3600) | #10: MessageLoop::RunHandler() [ipc/chromium/src/base/message_loop.cc:375]
[task 2023-03-15T13:55:15.755Z] 13:55:15     INFO - GECKO(3600) | #11: MessageLoop::Run() [ipc/chromium/src/base/message_loop.cc:357]
[task 2023-03-15T13:55:15.755Z] 13:55:15     INFO - GECKO(3600) | #12: nsThread::ThreadFunc(void*) [xpcom/threads/nsThread.cpp:393]
[task 2023-03-15T13:55:15.756Z] 13:55:15     INFO - GECKO(3600) | #13: _PR_NativeRunThread(void*) [nsprpub/pr/src/threads/combined/pruthr.c:408]
[task 2023-03-15T13:55:15.756Z] 13:55:15     INFO - GECKO(3600) | #14: pr_root(void*) [nsprpub/pr/src/md/windows/w95thred.c:140]
[task 2023-03-15T13:55:15.757Z] 13:55:15     INFO - GECKO(3600) | #15: recalloc [C:\Windows\System32\ucrtbase.dll + 0x29363]
[task 2023-03-15T13:55:15.757Z] 13:55:15     INFO - GECKO(3600) | #16: BaseThreadInitThunk [C:\Windows\System32\KERNEL32.DLL + 0x126bd]
[task 2023-03-15T13:55:15.758Z] 13:55:15     INFO - GECKO(3600) | #17: patched_BaseThreadInitThunk(int, void*, void*) [toolkit/xre/dllservices/mozglue/WindowsDllBlocklist.cpp:592]
[task 2023-03-15T13:55:15.758Z] 13:55:15     INFO - GECKO(3600) | #18: RtlUserThreadStart [C:\Windows\SYSTEM32\ntdll.dll + 0x5dfb8]

Isn't it the root cause ?

Because then it is visible by the sandbox code, but this one is just stating that it cannot get a GMP probably because of the earlier GPU issues ? :

[task 2023-03-15T14:06:54.141Z] 14:06:54     INFO - TEST-START | security/sandbox/test/browser_sandbox_test.js
[task 2023-03-15T14:06:54.153Z] 14:06:54     INFO - GECKO(5916) | Chrome file doesn't exist: Z:\task_167888085426936\build\tests\mochitest\browser\security\sandbox\test\head.js
[task 2023-03-15T14:06:54.164Z] 14:06:54     INFO - GECKO(5916) | [Parent 2688, GMPThread] WARNING: GeckoMediaPluginServiceParent::GetContentParentFrom failed: file /builds/worker/checkouts/gecko/dom/media/gmp/GMPServiceParent.cpp:386
[task 2023-03-15T14:06:54.169Z] 14:06:54     INFO - GECKO(5916) | Assertion failure: false (MOZ_ASSERT_UNREACHABLE: SandboxTest; failure to get a process), at /builds/worker/checkouts/gecko/security/sandbox/common/test/SandboxTest.cpp:304

Comment 2

[:gerard-majax]

no more assertion on https://treeherder.mozilla.org/jobs?repo=try&revision=7a5ac9cd53ed5e4c70a0f8a9efc4dac1a57cb11d ?

Comment 3

[:gerard-majax]

Attachment: Bug 1823583 - Re-enable sandbox tests on Windows 11 / MSIX / Debug r?bobowen!

Depends on D182161

Comment 4

[Pulsebot]

Pushed by [e-mail]:
https://hg.mozilla.org/integration/autoland/rev/f8e5e7c0e115
Re-enable sandbox tests on Windows 11 / MSIX / Debug r=bobowen

Comment 5

[Natalia Csoregi [:nataliaCs]]

https://hg.mozilla.org/mozilla-central/rev/f8e5e7c0e115