[46.024831] Initializing watchdogs
[46.025074]   /dev/watchdog0
[46.059050] [001/139] (960s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-indfb-draw-pwrite)
[46.690187] Starting subtest: fbc-1p-offscren-pri-indfb-draw-pwrite
[48.561082] Subtest fbc-1p-offscren-pri-indfb-draw-pwrite: SUCCESS (1.949s)
[48.712207] [002/139] (957s left) kms_atomic (plane-invalid-params-fence)
[49.009585] Starting subtest: plane-invalid-params-fence
[49.028899] Starting dynamic subtest: pipe-A-DP-1
[49.476254] Dynamic subtest pipe-A-DP-1: SUCCESS (0.469s)
[49.498093] Subtest plane-invalid-params-fence: SUCCESS (0.472s)
[49.822985] [003/139] (956s left) kms_atomic_interruptible (legacy-dpms)
[50.114789] Starting subtest: legacy-dpms
[50.133763] Starting dynamic subtest: pipe-A-DP-1
[56.704077] Dynamic subtest pipe-A-DP-1: SUCCESS (6.530s)
[56.725341] Subtest legacy-dpms: SUCCESS (6.533s)
[57.002965] [004/139] (949s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-blt)
[57.354705] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-blt
[57.397396] Subtest fbcpsr-1p-offscren-pri-indfb-draw-blt: SKIP (0.000s)
[57.484548] [005/139] (949s left) kms_cursor_edge_walk (256x256-top-bottom)
[57.778570] Starting subtest: 256x256-top-bottom
[57.798190] Starting dynamic subtest: pipe-A-DP-1
[61.473165] Dynamic subtest pipe-A-DP-1: SUCCESS (3.680s)
[61.506603] Starting dynamic subtest: pipe-C-DP-1
[64.964428] Dynamic subtest pipe-C-DP-1: SUCCESS (3.499s)
[64.987979] Subtest 256x256-top-bottom: SUCCESS (7.185s)
[65.324238] [006/139] (941s left) gem_exec_reloc (basic-wc-gtt-active)
[65.587371] Starting subtest: basic-wc-gtt-active
[65.713289] Subtest basic-wc-gtt-active: SUCCESS (0.143s)
[65.922851] [007/139] (941s left) i915_pm_rc6_residency (rc6-accuracy)
[66.295465] Starting subtest: rc6-accuracy
[69.506911] Subtest rc6-accuracy: SUCCESS (3.001s)
[69.599528] [008/139] (937s left) gem_lmem_swapping (verify)
[69.865366] Subtest verify: SKIP (0.000s)
[69.954635] [009/139] (937s left) kms_cursor_legacy (cursor-vs-flip-toggle)
[70.258249] Starting subtest: cursor-vs-flip-toggle
[111.840780] Subtest cursor-vs-flip-toggle: SUCCESS (41.564s)
[112.150344] [010/139] (895s left) kms_color (ctm-max)
[112.443817] Starting subtest: ctm-max
[112.464541] Starting dynamic subtest: pipe-A
[112.990694] Dynamic subtest pipe-A: SUCCESS (0.530s)
[113.026220] Starting dynamic subtest: pipe-B
[113.675667] Dynamic subtest pipe-B: SUCCESS (0.705s)
[113.709041] Starting dynamic subtest: pipe-C
[114.408309] Dynamic subtest pipe-C: SUCCESS (0.714s)
[114.427974] Subtest ctm-max: SUCCESS (1.950s)
[114.751917] [011/139] (892s left) gem_ctx_create (basic)
[114.980739] Starting subtest: basic
[115.002503] Subtest basic: SUCCESS (0.000s)
[115.196550] [012/139] (892s left) kms_psr (psr2_primary_render)
[115.446041] Subtest psr2_primary_render: SKIP (0.000s)
[115.527250] [013/139] (892s left) syncobj_wait (invalid-signal-one-illegal-handle)
[115.756568] Starting subtest: invalid-signal-one-illegal-handle
[115.775689] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[115.862316] [014/139] (891s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-cpu)
[116.232617] Starting subtest: fbcpsr-rgb565-draw-mmap-cpu
[116.275268] Subtest fbcpsr-rgb565-draw-mmap-cpu: SKIP (0.000s)
[116.357845] [015/139] (891s left) gem_pxp (verify-pxp-stale-buf-optout-execution)
[119.301115] Subtest verify-pxp-stale-buf-optout-execution: SKIP (0.000s)
[119.407271] [016/139] (888s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-blt)
[119.760832] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-blt
[119.803962] Subtest psr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[119.886561] [017/139] (887s left) kms_lease (lease-unleased-connector)
[120.180973] Starting subtest: lease-unleased-connector
[120.199689] Starting dynamic subtest: pipe-A-DP-1
[120.329584] Dynamic subtest pipe-A-DP-1: SUCCESS (0.154s)
[120.361284] Starting dynamic subtest: pipe-B-DP-1
[120.493394] Dynamic subtest pipe-B-DP-1: SUCCESS (0.155s)
[120.524863] Starting dynamic subtest: pipe-C-DP-1
[120.657272] Dynamic subtest pipe-C-DP-1: SUCCESS (0.155s)
[120.678270] Subtest lease-unleased-connector: SUCCESS (0.473s)
[120.776799] [018/139] (887s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling)
[121.094380] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling
[121.115272] Starting dynamic subtest: pipe-A-valid-mode
[121.198427] Dynamic subtest pipe-A-valid-mode: SKIP (0.101s)
[121.240798] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (0.104s)
[121.496074] [019/139] (886s left) gem_ccs (ctrl-surf-copy-new-ctx)
[121.745492] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[121.827844] [020/139] (886s left) gem_exec_schedule (smoketest-all)
[122.218411] Starting subtest: smoketest-all
[154.434912] Subtest smoketest-all: SUCCESS (32.302s)
[154.728336] [021/139] (853s left) kms_ccs (pipe-b-bad-rotation-90-4-tiled-dg2-rc-ccs)
[155.165735] Starting subtest: pipe-B-bad-rotation-90-4-tiled-dg2-rc-ccs
[155.203511] Subtest pipe-B-bad-rotation-90-4-tiled-dg2-rc-ccs: SKIP (0.000s)
[155.610400] [022/139] (852s left) drm_fdinfo (idle)
[155.847627] Starting subtest: idle
[155.868460] Starting dynamic subtest: rcs0
[156.331439] Dynamic subtest rcs0: SUCCESS (0.507s)
[156.366147] Starting dynamic subtest: bcs0
[156.832093] Dynamic subtest bcs0: SUCCESS (0.505s)
[156.865335] Starting dynamic subtest: vcs0
[157.340511] Dynamic subtest vcs0: SUCCESS (0.507s)
[157.376758] Starting dynamic subtest: vecs0
[157.848111] Dynamic subtest vecs0: SUCCESS (0.506s)
[157.869894] Subtest idle: SUCCESS (2.028s)
[157.968227] [023/139] (850s left) gem_exec_fair (basic-deadline)
[158.420658] Starting subtest: basic-deadline
[162.346105] Subtest basic-deadline: FAIL (2.447s)
[162.427986] [024/139] (846s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[162.659476] Starting subtest: addfb25-x-tiled-legacy
[162.678796] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s)
[162.823908] [025/139] (845s left) v3d/v3d_wait_bo (used-bo-1ns)
[163.113652] Subtest used-bo-1ns: SKIP (0.000s)
[163.198317] [026/139] (845s left) kms_flip (2x-wf_vblank-ts-check-interruptible)
[163.474980] Starting subtest: 2x-wf_vblank-ts-check-interruptible
[163.513234] Subtest 2x-wf_vblank-ts-check-interruptible: SKIP (0.003s)
[163.600875] [027/139] (845s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[163.892736] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[163.932578] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.002s)
[164.013750] [028/139] (844s left) gem_create (create-valid-nonaligned)
[164.241675] Starting subtest: create-valid-nonaligned
[164.260531] Subtest create-valid-nonaligned: SUCCESS (0.000s)
[164.456767] [029/139] (844s left) gem_lmem_swapping (parallel-random-verify)
[164.706150] Subtest parallel-random-verify: SKIP (0.000s)
[164.787675] [030/139] (844s left) kms_hdr (bpc-switch-dpms)
[165.085401] Starting subtest: bpc-switch-dpms
[167.312444] Starting dynamic subtest: pipe-A-DP-1
[168.756347] Dynamic subtest pipe-A-DP-1: SUCCESS (1.446s)
[168.776442] Subtest bpc-switch-dpms: SUCCESS (3.673s)
[169.139042] [031/139] (839s left) v3d/v3d_perfmon (destroy-valid-perfmon)
[169.409559] Subtest destroy-valid-perfmon: SKIP (0.000s)
[169.490952] [032/139] (839s left) kms_plane (plane-panning-bottom-right)
[169.780693] Starting subtest: plane-panning-bottom-right
[169.802579] Starting dynamic subtest: pipe-A
[170.615647] Dynamic subtest pipe-A: SUCCESS (0.821s)
[170.665456] Starting dynamic subtest: pipe-B
[171.623357] Dynamic subtest pipe-B: SUCCESS (0.991s)
[171.641795] Subtest plane-panning-bottom-right: SUCCESS (1.819s)
[171.968512] [033/139] (837s left) kms_flip (2x-nonexisting-fb)
[172.261660] Starting subtest: 2x-nonexisting-fb
[172.299234] Subtest 2x-nonexisting-fb: SKIP (0.003s)
[172.384214] [034/139] (836s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[172.655937] Starting subtest: multi-wait-all-for-submit-submitted
[172.719468] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.105s)
[172.848972] [035/139] (836s left) kms_ccs (pipe-a-ccs-on-another-bo-y-tiled-ccs)
[173.283355] Starting subtest: pipe-A-ccs-on-another-bo-y-tiled-ccs
[173.307829] Subtest pipe-A-ccs-on-another-bo-y-tiled-ccs: SUCCESS (0.001s)
[173.745732] [036/139] (835s left) gem_vm_create (isolation)
[173.990960] Starting subtest: isolation
[174.012786] Subtest isolation: SUCCESS (0.011s)
[174.108806] [037/139] (835s left) kms_big_fb (y-tiled-16bpp-rotate-0)
[174.471801] Starting subtest: y-tiled-16bpp-rotate-0
[178.092311] Subtest y-tiled-16bpp-rotate-0: SUCCESS (3.661s)
[178.454730] [038/139] (831s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[178.806805] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[180.056315] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (1.283s)
[180.422393] [039/139] (829s left) kms_ccs (pipe-c-crc-primary-rotation-180-y-tiled-ccs)
[180.917761] Starting subtest: pipe-C-crc-primary-rotation-180-y-tiled-ccs
[180.960788] Subtest pipe-C-crc-primary-rotation-180-y-tiled-ccs: SKIP (0.001s)
[181.282233] [040/139] (828s left) gem_exec_reloc (basic-cpu-noreloc)
[181.513271] Starting subtest: basic-cpu-noreloc
[181.532494] Subtest basic-cpu-noreloc: SUCCESS (0.012s)
[181.707145] [041/139] (828s left) kms_ccs (pipe-c-bad-aux-stride-y-tiled-gen12-mc-ccs)
[182.221298] Starting subtest: pipe-C-bad-aux-stride-y-tiled-gen12-mc-ccs
[182.260289] Subtest pipe-C-bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.000s)
[182.575927] [042/139] (827s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing)
[182.867436] Starting subtest: plane-use-after-nonblocking-unbind-fencing
[182.886353] Starting dynamic subtest: pipe-A-DP-1
[183.034575] Dynamic subtest pipe-A-DP-1: SUCCESS (0.167s)
[183.161116] Starting dynamic subtest: pipe-B-DP-1
[183.700270] Dynamic subtest pipe-B-DP-1: SUCCESS (0.566s)
[183.811105] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (0.932s)
[184.171105] [043/139] (825s left) gem_userptr_blits (readonly-unsync)
[184.481828] Subtest readonly-unsync: SKIP (0.000s)
[184.568192] [044/139] (825s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[184.860070] Starting subtest: primary-y-tiled-reflect-x-90
[184.900522] Subtest primary-y-tiled-reflect-x-90: SKIP (0.003s)
[184.983213] [045/139] (825s left) kms_ccs (pipe-a-crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[185.409081] Starting subtest: pipe-A-crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[185.446849] Subtest pipe-A-crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SKIP (0.005s)
[185.852343] [046/139] (824s left) syncobj_timeline (single-wait-for-submit-available-submitted)
[186.086235] Starting subtest: single-wait-for-submit-available-submitted
[186.104986] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.001s)
[186.191092] [047/139] (824s left) kms_ccs (pipe-c-missing-ccs-buffer-y-tiled-gen12-mc-ccs)
[186.699739] Starting subtest: pipe-C-missing-ccs-buffer-y-tiled-gen12-mc-ccs
[186.743303] Subtest pipe-C-missing-ccs-buffer-y-tiled-gen12-mc-ccs: SKIP (0.000s)
[187.060459] [048/139] (823s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt)
[187.434550] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt
[187.471546] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[187.558896] [049/139] (822s left) gem_exec_balancer (parallel-dmabuf-import-out-fence)
[191.787124] Subtest parallel-dmabuf-import-out-fence: SKIP (0.000s)
[191.873309] [050/139] (818s left) kms_cursor_crc (cursor-offscreen-32x32)
[192.197894] Starting subtest: cursor-offscreen-32x32
[192.352770] Subtest cursor-offscreen-32x32: SKIP (0.126s)
[192.457074] [051/139] (818s left) kms_flip (bo-too-big)
[192.733123] Starting subtest: bo-too-big
[192.752157] Starting dynamic subtest: A-DP1
[195.988743] Dynamic subtest A-DP1: SUCCESS (3.092s)
[196.027120] Starting dynamic subtest: B-DP1
[199.029221] Dynamic subtest B-DP1: SUCCESS (3.038s)
[199.066749] Starting dynamic subtest: C-DP1
[202.064184] Dynamic subtest C-DP1: SUCCESS (3.041s)
[202.085773] Subtest bo-too-big: SUCCESS (9.180s)
[202.519761] [052/139] (808s left) gem_exec_schedule (manyslice)
[202.905912] Starting subtest: manyslice
[202.927440] Starting dynamic subtest: rcs0
[204.232844] Dynamic subtest rcs0: SUCCESS (1.483s)
[204.269516] Starting dynamic subtest: bcs0
[205.034691] Dynamic subtest bcs0: SUCCESS (0.801s)
[205.070272] Starting dynamic subtest: vcs0
[205.824553] Dynamic subtest vcs0: SUCCESS (0.785s)
[205.863347] Starting dynamic subtest: vecs0
[206.620357] Dynamic subtest vecs0: SUCCESS (0.793s)
[206.640132] Subtest manyslice: SUCCESS (3.868s)
[206.979892] [053/139] (803s left) gem_mmap (pf-nonblock)
[207.238057] Starting subtest: pf-nonblock
[207.268379] Subtest pf-nonblock: SUCCESS (0.005s)
[207.368872] [054/139] (803s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[207.679371] Starting subtest: cursorA-vs-flipB-atomic-transitions
[207.732492] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.002s)
[207.838749] [055/139] (803s left) kms_ccs (pipe-a-bad-pixel-format-4-tiled-dg2-rc-ccs-cc)
[208.146459] Starting subtest: pipe-A-bad-pixel-format-4-tiled-dg2-rc-ccs-cc
[208.195986] Subtest pipe-A-bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.000s)
[208.736307] [056/139] (802s left) kms_flip (plain-flip-interruptible)
[209.069859] Starting subtest: plain-flip-interruptible
[209.092650] Starting dynamic subtest: A-DP1
[210.217200] Dynamic subtest A-DP1: SUCCESS (1.169s)
[210.257051] Starting dynamic subtest: B-DP1
[211.304604] Dynamic subtest B-DP1: SUCCESS (1.090s)
[211.339267] Starting dynamic subtest: C-DP1
[212.411170] Dynamic subtest C-DP1: SUCCESS (1.107s)
[212.431374] Subtest plain-flip-interruptible: SUCCESS (3.376s)
[212.836646] [057/139] (798s left) gem_bad_reloc (negative-reloc-lut)
[213.069656] Starting subtest: negative-reloc-lut
[213.126705] Subtest negative-reloc-lut: SUCCESS (0.001s)
[213.213684] [058/139] (798s left) kms_ccs (pipe-a-missing-ccs-buffer-y-tiled-ccs)
[213.614715] Starting subtest: pipe-A-missing-ccs-buffer-y-tiled-ccs
[213.635966] Subtest pipe-A-missing-ccs-buffer-y-tiled-ccs: SUCCESS (0.001s)
[214.082437] [059/139] (797s left) kms_ccs (pipe-d-bad-pixel-format-4-tiled-dg2-rc-ccs-cc)
[214.641619] Subtest pipe-D-bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.000s)
[214.964133] [060/139] (796s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-render)
[215.342746] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-render
[215.387524] Subtest psr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[215.469978] [061/139] (796s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[215.766679] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling
[215.788280] Starting dynamic subtest: pipe-A-valid-mode
[215.871659] Dynamic subtest pipe-A-valid-mode: SKIP (0.083s)
[215.909078] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.086s)
[216.185238] [062/139] (795s left) perf_pmu (init-sema)
[216.411815] Starting subtest: init-sema
[216.433402] Starting dynamic subtest: rcs0
[216.454648] Dynamic subtest rcs0: SUCCESS (0.003s)
[216.489570] Starting dynamic subtest: bcs0
[216.508381] Dynamic subtest bcs0: SUCCESS (0.001s)
[216.540626] Starting dynamic subtest: vcs0
[216.559313] Dynamic subtest vcs0: SUCCESS (0.001s)
[216.591352] Starting dynamic subtest: vecs0
[216.613088] Dynamic subtest vecs0: SUCCESS (0.001s)
[216.634492] Subtest init-sema: SUCCESS (0.013s)
[216.740380] [063/139] (795s left) gem_fence_thrash (bo-write-verify-threaded-none)
[216.950862] Starting subtest: bo-write-verify-threaded-none
[218.894440] Subtest bo-write-verify-threaded-none: SUCCESS (1.966s)
[219.021334] [064/139] (792s left) gem_ctx_exec (basic-nohangcheck)
[219.248976] Starting subtest: basic-nohangcheck
[219.527185] Subtest basic-nohangcheck: SUCCESS (0.326s)
[219.667654] [065/139] (792s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[220.042976] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[220.080106] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[220.169719] [066/139] (791s left) vgem_basic (bad-pad)
[220.490964] Starting subtest: bad-pad
[220.510271] Subtest bad-pad: SUCCESS (0.000s)
[220.592583] [067/139] (791s left) i915_getparams_basic (basic-eu-total)
[220.822024] Starting subtest: basic-eu-total
[220.859460] Subtest basic-eu-total: SUCCESS (0.000s)
[220.949804] [068/139] (791s left) kms_ccs (pipe-d-random-ccs-data-y-tiled-gen12-rc-ccs)
[221.500738] Subtest pipe-D-random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.000s)
[221.817427] [069/139] (790s left) perf_pmu (busy-accuracy-2)
[222.048465] Starting subtest: busy-accuracy-2
[222.067261] Starting dynamic subtest: rcs0
[225.113212] Dynamic subtest rcs0: SUCCESS (3.066s)
[225.146486] Starting dynamic subtest: bcs0
[228.186392] Dynamic subtest bcs0: SUCCESS (3.070s)
[228.221639] Starting dynamic subtest: vcs0
[231.250794] Dynamic subtest vcs0: SUCCESS (3.064s)
[231.285752] Starting dynamic subtest: vecs0
[234.314982] Dynamic subtest vecs0: SUCCESS (3.066s)
[234.336417] Subtest busy-accuracy-2: SUCCESS (12.273s)
[234.442595] [070/139] (777s left) gem_exec_reloc (basic-gtt-read-active)
[234.673949] Starting subtest: basic-gtt-read-active
[234.787139] Subtest basic-gtt-read-active: SUCCESS (0.138s)
[234.984601] [071/139] (777s left) gem_exec_async (concurrent-writes)
[235.201495] Starting subtest: concurrent-writes
[235.220483] Starting dynamic subtest: rcs0
[235.239956] Dynamic subtest rcs0: SUCCESS (0.018s)
[235.273245] Starting dynamic subtest: bcs0
[235.292123] Dynamic subtest bcs0: SUCCESS (0.012s)
[235.328108] Starting dynamic subtest: vcs0
[235.349703] Dynamic subtest vcs0: SUCCESS (0.013s)
[235.385400] Starting dynamic subtest: vecs0
[235.406573] Dynamic subtest vecs0: SUCCESS (0.012s)
[235.425350] Subtest concurrent-writes: SUCCESS (0.063s)
[235.509171] [072/139] (777s left) kms_big_fb (4-tiled-32bpp-rotate-0)
[235.848295] Starting subtest: 4-tiled-32bpp-rotate-0
[235.888379] Subtest 4-tiled-32bpp-rotate-0: SKIP (0.000s)
[235.972358] [073/139] (776s left) gem_exec_schedule (semaphore-noskip)
[236.367158] Starting subtest: semaphore-noskip
[236.443301] Subtest semaphore-noskip: SUCCESS (0.240s)
[236.835990] [074/139] (775s left) vc4/vc4_perfmon (create-perfmon-invalid-events)
[237.113507] Subtest create-perfmon-invalid-events: SKIP (0.000s)
[237.197392] [075/139] (775s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[237.422424] Starting subtest: no-spare-fences-interruptible
[239.603183] Subtest no-spare-fences-interruptible: SUCCESS (2.159s)
[239.764211] [076/139] (773s left) kms_ccs (pipe-b-crc-primary-rotation-180-y-tiled-gen12-rc-ccs)
[240.224201] Starting subtest: pipe-B-crc-primary-rotation-180-y-tiled-gen12-rc-ccs
[240.274697] Subtest pipe-B-crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.001s)
[240.669418] [077/139] (772s left) gem_exec_whisper (basic-fds-all)
[240.952670] Starting subtest: basic-fds-all
[258.452827] Subtest basic-fds-all: SUCCESS (17.524s)
[258.648793] [078/139] (754s left) kms_pm_lpsp (screens-disabled)
[259.979228] Starting subtest: screens-disabled
[260.018667] Subtest screens-disabled: SKIP (0.000s)
[260.157271] [079/139] (752s left) syncobj_basic (bad-flags-fd-to-handle)
[260.380111] Starting subtest: bad-flags-fd-to-handle
[260.401675] Subtest bad-flags-fd-to-handle: SUCCESS (0.000s)
[260.493588] [080/139] (752s left) gem_pxp (create-regular-context-1)
[263.398333] Subtest create-regular-context-1: SKIP (0.000s)
[263.546708] [081/139] (749s left) gem_eio (wait-wedge-1us)
[263.800909] Starting subtest: wait-wedge-1us
[263.844230] Subtest wait-wedge-1us: SUCCESS (0.088s)
[264.068855] [082/139] (749s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0)
[264.400839] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0
[265.790627] Subtest y-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.411s)
[265.972886] [083/139] (747s left) gem_exec_reloc (basic-gtt-read)
[266.198140] Starting subtest: basic-gtt-read
[266.219550] Subtest basic-gtt-read: SUCCESS (0.018s)
[266.398839] [084/139] (747s left) kms_sequence (queue-idle)
[266.689838] Starting subtest: queue-idle
[266.711936] Starting dynamic subtest: pipe-A-DP-1
[268.965809] Dynamic subtest pipe-A-DP-1: SUCCESS (2.278s)
[269.000729] Starting dynamic subtest: pipe-B-DP-1
[271.421960] Dynamic subtest pipe-B-DP-1: SUCCESS (2.432s)
[271.466508] Starting dynamic subtest: pipe-C-DP-1
[273.871453] Dynamic subtest pipe-C-DP-1: SUCCESS (2.459s)
[273.891199] Subtest queue-idle: SUCCESS (7.179s)
[274.216144] [085/139] (739s left) kms_cursor_crc (cursor-random-512x512)
[274.531424] Starting subtest: cursor-random-512x512
[274.568756] Subtest cursor-random-512x512: SKIP (0.003s)
[274.655973] [086/139] (739s left) i915_pm_rpm (system-suspend-devices)
[276.422976] Starting subtest: system-suspend-devices
[283.059311] Subtest system-suspend-devices: SUCCESS (6.042s)
[288.373427] [087/139] (730s left) kms_ccs (pipe-c-bad-rotation-90-y-tiled-ccs)
[288.860791] Starting subtest: pipe-C-bad-rotation-90-y-tiled-ccs
[288.901893] Subtest pipe-C-bad-rotation-90-y-tiled-ccs: SKIP (0.000s)
[289.281724] [088/139] (729s left) kms_pm_rpm (modeset-non-lpsp-stress-no-wait)
[291.044774] Starting subtest: modeset-non-lpsp-stress-no-wait
[294.790451] Subtest modeset-non-lpsp-stress-no-wait: SUCCESS (3.718s)
[295.001715] [089/139] (724s left) kms_panel_fitting (legacy)
[295.316211] Starting subtest: legacy
[295.361783] Subtest legacy: SKIP (0.000s)
[295.480332] [090/139] (723s left) kms_dp_aux_dev
[296.297283] [091/139] (723s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-75)
[296.596870] Starting subtest: planes-unity-scaling-downscale-factor-0-75
[296.616118] Starting dynamic subtest: pipe-A-DP-1
[296.706297] Dynamic subtest pipe-A-DP-1: SUCCESS (0.101s)
[296.747529] Starting dynamic subtest: pipe-B-DP-1
[297.108330] Dynamic subtest pipe-B-DP-1: SUCCESS (0.377s)
[297.130774] Subtest planes-unity-scaling-downscale-factor-0-75: SUCCESS (0.511s)
[297.544307] [092/139] (722s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt)
[297.898149] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt
[297.939343] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[298.034644] [093/139] (721s left) kms_atomic_interruptible (legacy-pageflip)
[298.329217] Starting subtest: legacy-pageflip
[298.348222] Starting dynamic subtest: pipe-A-DP-1
[304.882734] Dynamic subtest pipe-A-DP-1: SUCCESS (6.554s)
[304.903130] Subtest legacy-pageflip: SUCCESS (6.559s)
[305.254223] [094/139] (714s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-pwrite)
[305.607314] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-pwrite
[305.649812] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[305.744197] [095/139] (714s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-render)
[306.099992] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-render
[306.142605] Subtest fbc-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[306.234714] [096/139] (713s left) kms_ccs (pipe-d-crc-primary-rotation-180-y-tiled-gen12-rc-ccs)
[306.789876] Subtest pipe-D-crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.000s)
[307.118387] [097/139] (712s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt)
[307.479421] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt
[309.781575] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (2.367s)
[309.933781] [098/139] (710s left) syncobj_timeline (invalid-transfer-illegal-handle)
[310.159093] Starting subtest: invalid-transfer-illegal-handle
[310.179937] Subtest invalid-transfer-illegal-handle: SUCCESS (0.000s)
[310.275722] [099/139] (709s left) core_hotunplug (unbind-rebind)
[310.506372] Starting subtest: unbind-rebind
[314.143246] Subtest unbind-rebind: SUCCESS (3.629s)
[314.233656] [100/139] (706s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[314.584815] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[314.605825] Starting dynamic subtest: pipe-A-valid-mode
[314.685690] Dynamic subtest pipe-A-valid-mode: SKIP (0.092s)
[314.728795] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.097s)
[315.005074] [101/139] (705s left) syncobj_wait (reset-multiple-signaled)
[315.232378] Starting subtest: reset-multiple-signaled
[315.253048] Subtest reset-multiple-signaled: SUCCESS (0.001s)
[315.344573] [102/139] (705s left) kms_chamelium_frames (dp-crc-multiple)
[315.770282] Subtest dp-crc-multiple: SKIP (0.000s)
[316.076795] [103/139] (704s left) api_intel_allocator (simple-allocator)
[316.315661] Starting subtest: simple-allocator
[316.334588] Starting dynamic subtest: basic
[316.353486] Dynamic subtest basic: SUCCESS (0.006s)
[316.395077] Starting dynamic subtest: parallel-one
[316.458212] Dynamic subtest parallel-one: SUCCESS (0.163s)
[316.500144] Starting dynamic subtest: print
[316.519315] Dynamic subtest print: SUCCESS (0.000s)
[316.558131] Starting dynamic subtest: reuse
[316.576902] Dynamic subtest reuse: SUCCESS (0.000s)
[316.614890] Starting dynamic subtest: reserve
[316.636513] Dynamic subtest reserve: SUCCESS (0.000s)
[316.677484] Starting dynamic subtest: fork-reopen-allocator
[316.698158] Dynamic subtest fork-reopen-allocator: SUCCESS (0.045s)
[316.718806] Subtest simple-allocator: SUCCESS (0.230s)
[316.817062] [104/139] (703s left) prime_busy (before)
[317.050326] Starting subtest: before
[317.069175] Starting dynamic subtest: rcs0
[317.089176] Dynamic subtest rcs0: SUCCESS (0.022s)
[317.153567] Starting dynamic subtest: bcs0
[317.174928] Dynamic subtest bcs0: SUCCESS (0.020s)
[317.214519] Starting dynamic subtest: vcs0
[317.235339] Dynamic subtest vcs0: SUCCESS (0.034s)
[317.276220] Starting dynamic subtest: vecs0
[317.295381] Dynamic subtest vecs0: SUCCESS (0.014s)
[317.314212] Subtest before: SUCCESS (0.234s)
[317.409892] [105/139] (703s left) kms_psr2_sf (cursor-plane-move-continuous-sf)
[317.635082] Subtest cursor-plane-move-continuous-sf: SKIP (0.000s)
[317.725700] [106/139] (703s left) gem_exec_reloc (basic-wc-read)
[317.982080] Starting subtest: basic-wc-read
[318.010916] Subtest basic-wc-read: SUCCESS (0.018s)
[318.186246] [107/139] (702s left) gem_exec_params (invalid-bsd2-flag-on-blt)
[318.452926] Starting subtest: invalid-bsd2-flag-on-blt
[318.475773] Subtest invalid-bsd2-flag-on-blt: SUCCESS (0.001s)
[318.594861] [108/139] (702s left) kms_ccs (pipe-b-crc-sprite-planes-basic-y-tiled-ccs)
[319.091236] Starting subtest: pipe-B-crc-sprite-planes-basic-y-tiled-ccs
[319.635849] Subtest pipe-B-crc-sprite-planes-basic-y-tiled-ccs: SUCCESS (0.534s)
[320.137483] [109/139] (701s left) kms_big_fb (yf-tiled-16bpp-rotate-270)
[320.505514] Starting subtest: yf-tiled-16bpp-rotate-270
[320.584435] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.089s)
[320.706987] [110/139] (700s left) gem_spin_batch (spin-all-new)
[320.935989] Starting subtest: spin-all-new
[320.956690] Subtest spin-all-new: SUCCESS (0.027s)
[321.208461] [111/139] (700s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted)
[321.437795] Starting subtest: invalid-multi-wait-unsubmitted-submitted
[321.456782] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.001s)
[321.551989] [112/139] (700s left) kms_invalid_mode (bad-vsync-start)
[321.865843] Starting subtest: bad-vsync-start
[321.884800] Starting dynamic subtest: pipe-A-DP-1
[321.946500] Dynamic subtest pipe-A-DP-1: SUCCESS (0.099s)
[321.987827] Starting dynamic subtest: pipe-B-DP-1
[322.009454] Dynamic subtest pipe-B-DP-1: SUCCESS (0.002s)
[322.051894] Starting dynamic subtest: pipe-C-DP-1
[322.072799] Dynamic subtest pipe-C-DP-1: SUCCESS (0.002s)
[322.092059] Subtest bad-vsync-start: SUCCESS (0.115s)
[322.317688] [113/139] (699s left) kms_vblank (ts-continuation-modeset-hang)
[322.615198] Starting subtest: ts-continuation-modeset-hang
[322.634050] Starting dynamic subtest: pipe-A-DP-1
[330.012707] Dynamic subtest pipe-A-DP-1: SUCCESS (7.379s)
[330.054870] Starting dynamic subtest: pipe-C-DP-1
[337.049220] Dynamic subtest pipe-C-DP-1: SUCCESS (7.028s)
[337.069818] Subtest ts-continuation-modeset-hang: SUCCESS (14.421s)
[337.399418] [114/139] (684s left) kms_cursor_legacy (flip-vs-cursor-crc-atomic)
[337.696940] Starting subtest: flip-vs-cursor-crc-atomic
[338.327322] Subtest flip-vs-cursor-crc-atomic: SUCCESS (0.620s)
[338.686119] [115/139] (683s left) kms_hdmi_inject (inject-4k)
[338.933073] Subtest inject-4k: SKIP (0.000s)
[339.022923] [116/139] (682s left) gem_exec_schedule (independent)
[339.416668] Starting subtest: independent
[339.438110] Starting dynamic subtest: rcs0
[339.457382] Dynamic subtest rcs0: SUCCESS (0.193s)
[339.501355] Starting dynamic subtest: bcs0
[339.636193] Dynamic subtest bcs0: SUCCESS (0.187s)
[339.683948] Starting dynamic subtest: vcs0
[339.817119] Dynamic subtest vcs0: SUCCESS (0.179s)
[339.862243] Starting dynamic subtest: vecs0
[339.991788] Dynamic subtest vecs0: SUCCESS (0.169s)
[340.012374] Subtest independent: SUCCESS (0.741s)
[340.362937] [117/139] (681s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[340.738190] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[340.775360] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[340.878184] [118/139] (681s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy)
[341.216223] Starting subtest: fbcpsr-modesetfrombusy
[341.253463] Subtest fbcpsr-modesetfrombusy: SKIP (0.000s)
[341.351693] [119/139] (680s left) syncobj_timeline (invalid-multi-wait-all-available-unsubmitted-submitted-sign
[341.580774] Starting subtest: invalid-multi-wait-all-available-unsubmitted-submitted-signaled
[341.602158] Subtest invalid-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.002s)
[341.695730] [120/139] (680s left) gem_userptr_blits (stress-mm)
[341.984444] Starting subtest: stress-mm
[347.470277] Subtest stress-mm: SUCCESS (5.374s)
[347.568402] [121/139] (674s left) sysfs_timeslice_duration (idempotent)
[347.796981] Starting subtest: idempotent
[347.817530] Starting dynamic subtest: vecs0
[347.838045] Dynamic subtest vecs0: SUCCESS (0.002s)
[347.875682] Starting dynamic subtest: vcs0
[347.894448] Dynamic subtest vcs0: SUCCESS (0.001s)
[347.932316] Starting dynamic subtest: bcs0
[347.950921] Dynamic subtest bcs0: SUCCESS (0.001s)
[347.991651] Starting dynamic subtest: rcs0
[348.013679] Dynamic subtest rcs0: SUCCESS (0.001s)
[348.034075] Subtest idempotent: SUCCESS (0.019s)
[348.125506] [122/139] (674s left) gem_exec_params (invalid-bsd1-flag-on-vebox)
[348.336535] Starting subtest: invalid-bsd1-flag-on-vebox
[348.357196] Subtest invalid-bsd1-flag-on-vebox: SUCCESS (0.001s)
[348.446395] [123/139] (674s left) syncobj_timeline (multi-wait-for-submit-available-signaled)
[348.676192] Starting subtest: multi-wait-for-submit-available-signaled
[348.694760] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.002s)
[348.790461] [124/139] (673s left) v3d/v3d_submit_cl (multisync-out-syncs)
[349.068965] Subtest multisync-out-syncs: SKIP (0.000s)
[349.182985] [125/139] (673s left) kms_getfb (getfb-handle-valid)
[349.413514] Starting subtest: getfb-handle-valid
[349.434128] Subtest getfb-handle-valid: SUCCESS (0.000s)
[349.523685] [126/139] (673s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[349.904489] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu
[349.941504] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[350.032547] [127/139] (673s left) gem_exec_fence (syncobj-timeline-invalid-wait)
[350.852263] Starting subtest: syncobj-timeline-invalid-wait
[350.873773] Subtest syncobj-timeline-invalid-wait: SUCCESS (0.004s)
[351.127393] [128/139] (671s left) kms_big_fb (x-tiled-16bpp-rotate-270)
[351.462656] Starting subtest: x-tiled-16bpp-rotate-270
[351.544109] Subtest x-tiled-16bpp-rotate-270: SKIP (0.081s)
[351.663984] [129/139] (671s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[352.073295] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[352.384982] [130/139] (670s left) gem_ctx_shared (q-smoketest)
[352.624335] Starting subtest: Q-smoketest
[352.649093] Starting dynamic subtest: rcs0
[358.358166] Dynamic subtest rcs0: SUCCESS (5.468s)
[358.404329] Starting dynamic subtest: bcs0
[363.831175] Dynamic subtest bcs0: SUCCESS (5.471s)
[363.882377] Starting dynamic subtest: vcs0
[369.109127] Dynamic subtest vcs0: SUCCESS (5.468s)
[369.153307] Starting dynamic subtest: vecs0
[374.599744] Dynamic subtest vecs0: SUCCESS (5.469s)
[374.621167] Subtest Q-smoketest: SUCCESS (21.887s)
[374.726136] [131/139] (648s left) kms_big_fb (linear-32bpp-rotate-0)
[375.044744] Starting subtest: linear-32bpp-rotate-0
[380.814039] Subtest linear-32bpp-rotate-0: SUCCESS (5.790s)
[381.381732] [132/139] (642s left) kms_plane_scaling (planes-downscale-factor-0-25-upscale-20x20)
[381.680585] Starting subtest: planes-downscale-factor-0-25-upscale-20x20
[381.700804] Starting dynamic subtest: pipe-A-DP-1
[381.739599] Dynamic subtest pipe-A-DP-1: SKIP (0.030s)
[381.808314] Starting dynamic subtest: pipe-B-DP-1
[381.852522] Dynamic subtest pipe-B-DP-1: SKIP (0.079s)
[381.894034] Subtest planes-downscale-factor-0-25-upscale-20x20: SKIP (0.148s)
[382.007917] [133/139] (641s left) gem_ctx_persistence (engines-hang)
[382.217388] Starting subtest: engines-hang
[382.236485] Starting dynamic subtest: rcs0
[382.255788] Dynamic subtest rcs0: SUCCESS (0.050s)
[382.298237] Starting dynamic subtest: bcs0
[382.341864] Dynamic subtest bcs0: SKIP (0.004s)
[382.383670] Starting dynamic subtest: vcs0
[382.404722] Dynamic subtest vcs0: SUCCESS (0.051s)
[382.443927] Starting dynamic subtest: vecs0
[382.462893] Dynamic subtest vecs0: SUCCESS (0.039s)
[382.481763] Subtest engines-hang: SUCCESS (0.156s)
[382.577924] [134/139] (641s left) gem_userptr_blits (readonly-pwrite-unsync)
[382.888082] Subtest readonly-pwrite-unsync: SKIP (0.000s)
[382.978697] [135/139] (640s left) kms_ccs (pipe-d-crc-primary-basic-y-tiled-gen12-rc-ccs)
[383.508978] Subtest pipe-D-crc-primary-basic-y-tiled-gen12-rc-ccs: SKIP (0.000s)
[383.849205] [136/139] (640s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[384.071795] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[384.114920] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[384.289847] [137/139] (639s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[384.649678] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu
[384.688675] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[384.781566] [138/139] (639s left) syncobj_timeline (32bits-limit)
[385.017502] Starting subtest: 32bits-limit
[385.037529] Subtest 32bits-limit: SUCCESS (0.002s)
[385.134772] [139/139] (639s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[385.470784] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[385.508887] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[385.585214] Closing watchdogs
Done.