[56.780446] Initializing watchdogs
[56.780788]   /dev/watchdog0
[56.796457] [001/137] (960s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-gtt)
[57.137912] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-gtt
[57.140575] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[57.226989] [002/137] (960s left) gem_exec_fence (syncobj-timeline-chain-engines)
[58.140854] Starting subtest: syncobj-timeline-chain-engines
[58.279632] Subtest syncobj-timeline-chain-engines: SUCCESS (0.138s)
[58.493947] [003/137] (958s left) kms_color (invalid-degamma-lut-sizes)
[58.801909] Starting subtest: invalid-degamma-lut-sizes
[58.804060] Starting dynamic subtest: pipe-A
[58.900197] Dynamic subtest pipe-A: SUCCESS (0.099s)
[58.915350] Starting dynamic subtest: pipe-B
[58.917557] Dynamic subtest pipe-B: SUCCESS (0.006s)
[58.932882] Starting dynamic subtest: pipe-C
[58.934379] Dynamic subtest pipe-C: SUCCESS (0.006s)
[58.937153] Subtest invalid-degamma-lut-sizes: SUCCESS (0.113s)
[59.214836] [004/137] (958s left) i915_pm_dc (dc6-dpms)
[60.539700] Starting subtest: dc6-dpms
[60.547281] Subtest dc6-dpms: SKIP (0.000s)
[60.699207] [005/137] (956s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-render)
[61.011661] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-render
[61.014101] Subtest fbc-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[61.098382] [006/137] (956s left) i915_hangman (engine-engine-hang)
[61.331469] Starting subtest: engine-engine-hang
[61.334492] Starting dynamic subtest: rcs0
[61.940754] Dynamic subtest rcs0: SUCCESS (0.610s)
[61.956243] Starting dynamic subtest: bcs0
[62.535073] Dynamic subtest bcs0: SUCCESS (0.594s)
[62.550484] Starting dynamic subtest: vcs0
[63.128724] Dynamic subtest vcs0: SUCCESS (0.593s)
[63.143969] Starting dynamic subtest: vecs0
[63.714567] Dynamic subtest vecs0: SUCCESS (0.585s)
[63.716039] Subtest engine-engine-hang: SUCCESS (2.385s)
[63.848088] [007/137] (953s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-signaled)
[64.054326] Starting subtest: multi-wait-all-for-submit-unsubmitted-signaled
[64.160601] Subtest multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.104s)
[64.249251] [008/137] (953s left) v3d/v3d_mmap (mmap-bad-flags)
[64.517679] Subtest mmap-bad-flags: SKIP (0.000s)
[64.583558] [009/137] (952s left) kms_flip (plain-flip-fb-recreate-interruptible)
[64.882756] Starting subtest: plain-flip-fb-recreate-interruptible
[64.887316] Starting dynamic subtest: A-DP1
[75.937949] Dynamic subtest A-DP1: SUCCESS (11.051s)
[75.953186] Starting dynamic subtest: B-DP1
[86.692691] Dynamic subtest B-DP1: SUCCESS (10.753s)
[86.707771] Starting dynamic subtest: C-DP1
[97.408715] Dynamic subtest C-DP1: SUCCESS (10.716s)
[97.410160] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (32.527s)
[97.806134] [010/137] (919s left) kms_big_fb (y-tiled-8bpp-rotate-180)
[98.130853] Starting subtest: y-tiled-8bpp-rotate-180
[101.203782] Subtest y-tiled-8bpp-rotate-180: SUCCESS (3.072s)
[101.656406] [011/137] (915s left) gem_exec_balancer (parallel-keep-in-fence)
[105.700573] Subtest parallel-keep-in-fence: SKIP (0.000s)
[105.788496] [012/137] (911s left) kms_cursor_crc (cursor-rapid-movement-64x64)
[106.095254] Starting subtest: cursor-rapid-movement-64x64
[106.108369] Starting dynamic subtest: pipe-A-DP-1
[106.605646] Dynamic subtest pipe-A-DP-1: SUCCESS (0.497s)
[106.682620] Starting dynamic subtest: pipe-C-DP-1
[107.510135] Dynamic subtest pipe-C-DP-1: SUCCESS (0.840s)
[107.511390] Subtest cursor-rapid-movement-64x64: SUCCESS (1.414s)
[107.868470] [013/137] (909s left) syncobj_wait (reset-signaled)
[108.067561] Starting subtest: reset-signaled
[108.069468] Subtest reset-signaled: SUCCESS (0.000s)
[108.149018] [014/137] (909s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[108.464964] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[108.467492] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[108.565469] [015/137] (909s left) kms_ccs (pipe-b-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs_cc)
[109.159425] Starting subtest: pipe-B-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs_cc
[109.166104] Subtest pipe-B-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs_cc: SKIP (0.005s)
[109.586556] [016/137] (908s left) kms_chamelium_frames (dp-crc-fast)
[109.969777] Subtest dp-crc-fast: SKIP (0.000s)
[110.243287] [017/137] (907s left) gem_ctx_persistence (legacy-engines-hostile-preempt)
[110.448547] Starting subtest: legacy-engines-hostile-preempt
[110.452124] Starting dynamic subtest: render
[110.547830] Dynamic subtest render: SUCCESS (0.096s)
[110.564196] Starting dynamic subtest: bsd
[110.635396] Dynamic subtest bsd: SUCCESS (0.086s)
[110.650873] Starting dynamic subtest: blt
[110.729812] Dynamic subtest blt: SUCCESS (0.094s)
[110.747634] Starting dynamic subtest: vebox
[110.824810] Dynamic subtest vebox: SUCCESS (0.094s)
[110.826201] Subtest legacy-engines-hostile-preempt: SUCCESS (0.376s)
[110.905606] [018/137] (906s left) kms_cursor_crc (cursor-offscreen-512x170)
[111.229061] Starting subtest: cursor-offscreen-512x170
[111.231658] Subtest cursor-offscreen-512x170: SKIP (0.003s)
[111.339735] [019/137] (906s left) kms_big_fb (x-tiled-64bpp-rotate-0)
[111.661659] Starting subtest: x-tiled-64bpp-rotate-0
[119.054567] Subtest x-tiled-64bpp-rotate-0: SUCCESS (7.392s)
[119.990933] [020/137] (897s left) gen7_exec_parse (basic-allocation)
[120.198894] Subtest basic-allocation: SKIP (0.000s)
[120.253975] [021/137] (897s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[120.548849] Starting subtest: basic-flip-before-cursor-legacy
[121.641056] Subtest basic-flip-before-cursor-legacy: SUCCESS (1.093s)
[121.993289] [022/137] (895s left) kms_plane (pixel-format-source-clamping)
[122.288365] Starting subtest: pixel-format-source-clamping
[122.289712] Starting dynamic subtest: pipe-A-planes
[128.687185] Dynamic subtest pipe-A-planes: SUCCESS (6.399s)
[128.706780] Starting dynamic subtest: pipe-B-planes
[135.286323] Dynamic subtest pipe-B-planes: SUCCESS (6.594s)
[135.287586] Subtest pixel-format-source-clamping: SUCCESS (13.000s)
[135.621541] [023/137] (882s left) kms_psr (sprite_mmap_cpu)
[135.829328] Subtest sprite_mmap_cpu: SKIP (0.000s)
[135.871190] [024/137] (882s left) kms_flip (2x-flip-vs-fences)
[136.149883] Starting subtest: 2x-flip-vs-fences
[136.152580] Subtest 2x-flip-vs-fences: SKIP (0.003s)
[136.255365] [025/137] (881s left) i915_pm_rpm (gem-execbuf-stress)
[138.137404] Starting subtest: gem-execbuf-stress
[138.140162] Starting dynamic subtest: smem0
[140.263320] Dynamic subtest smem0: SUCCESS (2.126s)
[140.281371] Starting dynamic subtest: extra-wait-smem0
[192.906662] Dynamic subtest extra-wait-smem0: SUCCESS (52.641s)
[192.908829] Subtest gem-execbuf-stress: SUCCESS (54.768s)
[193.366527] [026/137] (824s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-wc)
[193.673119] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-wc
[195.874376] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (2.206s)
[195.994379] [027/137] (822s left) kms_cursor_legacy (cursorb-vs-flipa-atomic)
[196.291763] Starting subtest: cursorB-vs-flipA-atomic
[196.296933] Subtest cursorB-vs-flipA-atomic: SKIP (0.005s)
[196.377674] [028/137] (821s left) api_intel_bb (reset-bb)
[196.575753] Starting subtest: reset-bb
[196.583062] Subtest reset-bb: SUCCESS (0.005s)
[196.694886] [029/137] (821s left) kms_atomic (plane-immutable-zpos)
[197.127804] Starting subtest: plane-immutable-zpos
[197.357252] Subtest plane-immutable-zpos: SUCCESS (0.232s)
[197.780876] [030/137] (820s left) syncobj_timeline (invalid-multi-wait-available-unsubmitted-submitted-signaled
[197.981371] Starting subtest: invalid-multi-wait-available-unsubmitted-submitted-signaled
[197.982832] Subtest invalid-multi-wait-available-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[198.065487] [031/137] (820s left) kms_flip (modeset-vs-vblank-race-interruptible)
[198.359786] Starting subtest: modeset-vs-vblank-race-interruptible
[198.364634] Starting dynamic subtest: A-DP1
[202.679105] Dynamic subtest A-DP1: SUCCESS (4.314s)
[202.694511] Starting dynamic subtest: B-DP1
[206.862095] Dynamic subtest B-DP1: SUCCESS (4.182s)
[206.879723] Starting dynamic subtest: C-DP1
[211.056534] Dynamic subtest C-DP1: SUCCESS (4.193s)
[211.059330] Subtest modeset-vs-vblank-race-interruptible: SUCCESS (12.698s)
[211.450413] [032/137] (806s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-pwrite)
[211.764475] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-pwrite
[211.767022] Subtest fbc-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[211.865263] [033/137] (806s left) kms_busy (extended-modeset-hang-newfb-with-reset)
[212.179383] Starting subtest: extended-modeset-hang-newfb-with-reset
[212.185647] Starting dynamic subtest: pipe-A
[215.332236] Dynamic subtest pipe-A: SUCCESS (3.145s)
[215.354598] Starting dynamic subtest: pipe-C
[218.611505] Dynamic subtest pipe-C: SUCCESS (3.266s)
[218.612967] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (6.430s)
[218.960921] [034/137] (799s left) kms_ccs (pipe-d-bad-pixel-format-y_tiled_gen12_rc_ccs)
[219.674946] Subtest pipe-D-bad-pixel-format-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[219.985981] [035/137] (798s left) gem_exec_reloc (basic-wc-read-noreloc)
[220.197519] Starting subtest: basic-wc-read-noreloc
[220.207368] Subtest basic-wc-read-noreloc: SUCCESS (0.009s)
[220.386433] [036/137] (798s left) kms_ccs (pipe-c-bad-rotation-90-yf_tiled_ccs)
[220.988478] Starting subtest: pipe-C-bad-rotation-90-yf_tiled_ccs
[220.990982] Subtest pipe-C-bad-rotation-90-yf_tiled_ccs: SKIP (0.000s)
[221.381517] [037/137] (797s left) kms_ccs (pipe-b-bad-pixel-format-y_tiled_ccs)
[221.867406] Starting subtest: pipe-B-bad-pixel-format-y_tiled_ccs
[221.868903] Subtest pipe-B-bad-pixel-format-y_tiled_ccs: SUCCESS (0.001s)
[222.414554] [038/137] (796s left) gem_softpin (evict-snoop)
[222.627930] Starting subtest: evict-snoop
[222.631110] Subtest evict-snoop: SKIP (0.000s)
[222.713555] [039/137] (795s left) kms_vblank (pipe-a-query-busy-hang)
[223.023654] Starting subtest: pipe-A-query-busy-hang
[229.987586] Subtest pipe-A-query-busy-hang: SUCCESS (6.967s)
[230.324256] [040/137] (788s left) prime_vgem (basic-blt)
[230.548905] Starting subtest: basic-blt
[230.606663] Subtest basic-blt: SUCCESS (0.055s)
[230.724697] [041/137] (787s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-msflip-blt)
[231.041172] Starting subtest: psr-1p-primscrn-indfb-msflip-blt
[231.043862] Subtest psr-1p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[231.141709] [042/137] (787s left) syncobj_timeline (invalid-multi-wait-all-available-unsubmitted)
[231.343179] Starting subtest: invalid-multi-wait-all-available-unsubmitted
[231.344744] Subtest invalid-multi-wait-all-available-unsubmitted: SUCCESS (0.000s)
[231.424221] [043/137] (787s left) gem_ctx_engines (execute-allforone)
[231.646893] Starting subtest: execute-allforone
[231.665342] Subtest execute-allforone: SUCCESS (0.018s)
[231.875605] [044/137] (786s left) perf_pmu (interrupts)
[232.082314] Starting subtest: interrupts
[233.217776] Subtest interrupts: SUCCESS (1.134s)
[233.326843] [045/137] (785s left) gem_ctx_sseu (mmap-args)
[233.537456] Subtest mmap-args: SKIP (0.000s)
[233.591598] [046/137] (785s left) syncobj_wait (invalid-wait-illegal-handle)
[233.790211] Starting subtest: invalid-wait-illegal-handle
[233.791832] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s)
[233.875648] [047/137] (785s left) gem_pxp (regular-baseline-src-copy-readible)
[236.591950] Subtest regular-baseline-src-copy-readible: SKIP (0.000s)
[236.675199] [048/137] (782s left) kms_plane_scaling (planes-upscale-20x20-downscale-factor-0-75)
[236.972692] Starting subtest: planes-upscale-20x20-downscale-factor-0-75
[236.974029] Starting dynamic subtest: pipe-A-DP-1
[237.053397] Dynamic subtest pipe-A-DP-1: SUCCESS (0.080s)
[237.072854] Starting dynamic subtest: pipe-B-DP-1
[237.434471] Dynamic subtest pipe-B-DP-1: SUCCESS (0.377s)
[237.461424] Starting dynamic subtest: pipe-C-DP-1
[237.524865] Dynamic subtest pipe-C-DP-1: SKIP (0.083s)
[237.526578] Subtest planes-upscale-20x20-downscale-factor-0-75: SUCCESS (0.553s)
[237.919141] [049/137] (781s left) i915_pm_dc (dc6-psr)
[239.230071] Starting subtest: dc6-psr
[239.235188] Subtest dc6-psr: SKIP (0.000s)
[239.386267] [050/137] (779s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt)
[239.690827] Starting subtest: psr-rgb101010-draw-mmap-gtt
[239.693473] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[239.784789] [051/137] (779s left) kms_frontbuffer_tracking (fbc-tiling-y)
[240.093923] Starting subtest: fbc-tiling-y
[242.328616] Subtest fbc-tiling-y: SUCCESS (2.236s)
[242.469186] [052/137] (776s left) gem_reg_read (timestamp-monotonic)
[242.668384] Starting subtest: timestamp-monotonic
[246.897710] Subtest timestamp-monotonic: SUCCESS (4.230s)
[246.984694] [053/137] (772s left) gem_exec_store (cachelines)
[247.210371] Starting subtest: cachelines
[247.211716] Starting dynamic subtest: rcs0
[247.256724] Dynamic subtest rcs0: SUCCESS (0.047s)
[247.274392] Starting dynamic subtest: bcs0
[247.289839] Dynamic subtest bcs0: SUCCESS (0.032s)
[247.308386] Starting dynamic subtest: vcs0
[247.316727] Dynamic subtest vcs0: SUCCESS (0.026s)
[247.335202] Starting dynamic subtest: vecs0
[247.339837] Dynamic subtest vecs0: SUCCESS (0.022s)
[247.341145] Subtest cachelines: SUCCESS (0.132s)
[247.535603] [054/137] (771s left) perf_pmu (semaphore-wait)
[247.742380] Starting subtest: semaphore-wait
[247.744024] Starting dynamic subtest: rcs0
[248.261261] Dynamic subtest rcs0: SUCCESS (0.517s)
[248.280421] Starting dynamic subtest: bcs0
[248.777327] Dynamic subtest bcs0: SUCCESS (0.516s)
[248.794420] Starting dynamic subtest: vcs0
[249.291888] Dynamic subtest vcs0: SUCCESS (0.513s)
[249.309158] Starting dynamic subtest: vecs0
[249.805712] Dynamic subtest vecs0: SUCCESS (0.513s)
[249.807188] Subtest semaphore-wait: SUCCESS (2.063s)
[249.920599] [055/137] (769s left) kms_ccs (pipe-a-random-ccs-data-y_tiled_ccs)
[250.368651] Starting subtest: pipe-A-random-ccs-data-y_tiled_ccs
[250.809796] Subtest pipe-A-random-ccs-data-y_tiled_ccs: SUCCESS (0.441s)
[251.544604] [056/137] (767s left) prime_self_import (basic-llseek-bad)
[251.741500] Starting subtest: basic-llseek-bad
[251.745978] Subtest basic-llseek-bad: SUCCESS (0.004s)
[251.844452] [057/137] (767s left) kms_frontbuffer_tracking (fbc-badstride)
[252.154931] Starting subtest: fbc-badstride
[260.071325] Subtest fbc-badstride: SUCCESS (7.918s)
[260.211698] [058/137] (759s left) sw_sync (sync_busy)
[260.413707] Starting subtest: sync_busy
[260.421400] Subtest sync_busy: SUCCESS (0.008s)
[260.495441] [059/137] (758s left) drm_fdinfo (all-busy-idle-check-all)
[260.701168] Starting subtest: all-busy-idle-check-all
[261.326693] Subtest all-busy-idle-check-all: SUCCESS (0.626s)
[261.411685] [060/137] (757s left) kms_ccs (pipe-c-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc)
[262.112427] Starting subtest: pipe-C-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc
[262.115520] Subtest pipe-C-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[262.485751] [061/137] (756s left) kms_psr (psr2_primary_page_flip)
[262.685884] Subtest psr2_primary_page_flip: SKIP (0.000s)
[262.732258] [062/137] (756s left) gem_eio (context-create)
[262.959965] Starting subtest: context-create
[263.012116] Subtest context-create: SUCCESS (0.052s)
[263.182653] [063/137] (756s left) v3d/v3d_submit_csd (bad-multisync-extension)
[263.445580] Subtest bad-multisync-extension: SKIP (0.000s)
[263.516842] [064/137] (755s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[263.816829] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[263.819547] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[263.917547] [065/137] (755s left) gem_exec_params (invalid-bsd2-flag-on-blt)
[264.127253] Starting subtest: invalid-bsd2-flag-on-blt
[264.129110] Subtest invalid-bsd2-flag-on-blt: SUCCESS (0.001s)
[264.233194] [066/137] (755s left) gem_userptr_blits (coherency-sync)
[264.475666] Starting subtest: coherency-sync
[266.368371] Subtest coherency-sync: SKIP (1.880s)
[266.512409] [067/137] (753s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[266.965613] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip
[266.968922] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.002s)
[267.052261] [068/137] (752s left) kms_vblank (pipe-b-query-idle)
[267.360146] Starting subtest: pipe-B-query-idle
[270.062630] Subtest pipe-B-query-idle: SUCCESS (2.702s)
[270.399250] [069/137] (749s left) gem_spin_batch (resubmit)
[270.627613] Starting subtest: resubmit
[270.631884] Starting dynamic subtest: rcs0
[270.636197] Dynamic subtest rcs0: SUCCESS (0.006s)
[270.657255] Starting dynamic subtest: bcs0
[270.658583] Dynamic subtest bcs0: SUCCESS (0.009s)
[270.677303] Starting dynamic subtest: vcs0
[270.678538] Dynamic subtest vcs0: SUCCESS (0.007s)
[270.696559] Starting dynamic subtest: vecs0
[270.697858] Dynamic subtest vecs0: SUCCESS (0.007s)
[270.699102] Subtest resubmit: SUCCESS (0.037s)
[270.883622] [070/137] (748s left) vc4/vc4_dmabuf_poll (poll-write-waits-until-write-done)
[271.160736] Subtest poll-write-waits-until-write-done: SKIP (0.000s)
[271.234456] [071/137] (748s left) kms_frontbuffer_tracking (fbc-suspend)
[271.550630] Starting subtest: fbc-suspend
[310.047360] Subtest fbc-suspend: SUCCESS (6.075s)
[313.300951] [072/137] (741s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[313.684392] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[313.975976] [073/137] (741s left) kms_cursor_crc (cursor-random-256x85)
[314.288460] Starting subtest: cursor-random-256x85
[314.300190] Starting dynamic subtest: pipe-A-DP-1
[318.342075] Dynamic subtest pipe-A-DP-1: SUCCESS (4.041s)
[318.428521] Starting dynamic subtest: pipe-C-DP-1
[322.525455] Dynamic subtest pipe-C-DP-1: SUCCESS (4.121s)
[322.526739] Subtest cursor-random-256x85: SUCCESS (8.237s)
[322.878471] [074/137] (732s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions-varying-size)
[323.187471] Starting subtest: cursorA-vs-flipA-atomic-transitions-varying-size
[334.287518] Subtest cursorA-vs-flipA-atomic-transitions-varying-size: SUCCESS (11.098s)
[334.623820] [075/137] (720s left) syncobj_basic (bad-pad-fd-to-handle)
[334.838216] Starting subtest: bad-pad-fd-to-handle
[334.839710] Subtest bad-pad-fd-to-handle: SUCCESS (0.000s)
[334.937304] [076/137] (720s left) perf (missing-sample-flags)
[335.279812] Starting subtest: missing-sample-flags
[335.281383] Subtest missing-sample-flags: SUCCESS (0.001s)
[335.336444] [077/137] (720s left) kms_ccs (pipe-d-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs)
[336.052205] Subtest pipe-D-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs: SKIP (0.000s)
[336.372596] [078/137] (719s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-render)
[336.677794] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-render
[336.680406] Subtest fbc-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[336.789185] [079/137] (718s left) i915_pm_rps (reset)
[336.998586] Starting subtest: reset
[340.576583] Subtest reset: SUCCESS (3.578s)
[340.674330] [080/137] (714s left) kms_sequence (get-busy)
[340.971128] Starting subtest: get-busy
[340.972648] Starting dynamic subtest: DP-1-pipe-A
[343.461260] Dynamic subtest DP-1-pipe-A: SUCCESS (2.488s)
[343.487183] Starting dynamic subtest: DP-1-pipe-B
[346.238642] Dynamic subtest DP-1-pipe-B: SUCCESS (2.771s)
[346.262190] Starting dynamic subtest: DP-1-pipe-C
[349.145947] Dynamic subtest DP-1-pipe-C: SUCCESS (2.904s)
[349.147284] Subtest get-busy: SUCCESS (8.179s)
[349.468484] [081/137] (706s left) perf_pmu (event-wait)
[349.676384] Starting subtest: event-wait
[349.678186] Starting dynamic subtest: rcs0
[349.681271] Dynamic subtest rcs0: SKIP (0.000s)
[349.684573] Subtest event-wait: SKIP (0.002s)
[349.767132] [082/137] (705s left) kms_plane_scaling (planes-downscale-factor-0-5)
[350.062842] Starting subtest: planes-downscale-factor-0-5
[350.067064] Starting dynamic subtest: pipe-A-DP-1
[350.396484] Dynamic subtest pipe-A-DP-1: SUCCESS (0.329s)
[350.423917] Starting dynamic subtest: pipe-B-DP-1
[350.772960] Dynamic subtest pipe-B-DP-1: SUCCESS (0.372s)
[350.798620] Starting dynamic subtest: pipe-C-DP-1
[350.865025] Dynamic subtest pipe-C-DP-1: SKIP (0.086s)
[350.866347] Subtest planes-downscale-factor-0-5: SUCCESS (0.801s)
[351.257655] [083/137] (704s left) gem_mmap_wc (pf-nonblock)
[351.459777] Starting subtest: pf-nonblock
[351.463718] Subtest pf-nonblock: SUCCESS (0.005s)
[351.574415] [084/137] (704s left) kms_ccs (pipe-d-random-ccs-data-y_tiled_gen12_rc_ccs)
[352.302227] Subtest pipe-D-random-ccs-data-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[352.621213] [085/137] (703s left) vc4/vc4_tiling (set-get)
[352.878440] Subtest set-get: SKIP (0.000s)
[352.953823] [086/137] (702s left) gem_ctx_param (non-root-set)
[353.152999] Starting subtest: non-root-set
[353.185140] Subtest non-root-set: SUCCESS (0.033s)
[353.274237] [087/137] (702s left) gem_ccs (block-multicopy-inplace)
[353.481602] Subtest block-multicopy-inplace: SKIP (0.000s)
[353.537193] [088/137] (702s left) gem_exec_schedule (semaphore-resolve)
[353.767677] Starting subtest: semaphore-resolve
[353.821059] Subtest semaphore-resolve: SUCCESS (0.052s)
[354.173537] [089/137] (701s left) drm_read (short-buffer-nonblock)
[354.597275] Starting subtest: short-buffer-nonblock
[354.599078] Subtest short-buffer-nonblock: SUCCESS (0.000s)
[354.723728] [090/137] (701s left) gem_exec_suspend (basic)
[354.947074] Starting subtest: basic
[354.951366] Starting dynamic subtest: smem
[356.237702] Dynamic subtest smem: SUCCESS (1.289s)
[356.238999] Subtest basic: SUCCESS (1.291s)
[356.438187] [091/137] (699s left) kms_big_fb (yf-tiled-addfb-size-overflow)
[356.765708] Starting subtest: yf-tiled-addfb-size-overflow
[356.767364] Subtest yf-tiled-addfb-size-overflow: SUCCESS (0.002s)
[356.871099] [092/137] (699s left) gem_exec_fair (basic-none-solo)
[357.096813] Starting subtest: basic-none-solo
[357.098510] Starting dynamic subtest: rcs0
[366.198730] Dynamic subtest rcs0: SUCCESS (9.100s)
[366.200137] Subtest basic-none-solo: SUCCESS (9.102s)
[366.409679] [093/137] (689s left) api_intel_bb (bb-with-allocator)
[366.627353] Starting subtest: bb-with-allocator
[366.637820] Subtest bb-with-allocator: SUCCESS (0.012s)
[366.756004] [094/137] (689s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[367.055053] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[367.056357] Starting dynamic subtest: pipe-A-valid-mode
[367.143959] Dynamic subtest pipe-A-valid-mode: SKIP (0.086s)
[367.146724] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.090s)
[367.446509] [095/137] (688s left) gem_render_copy (yf-tiled-ccs-to-y-tiled-ccs)
[367.670735] Starting subtest: yf-tiled-ccs-to-y-tiled-ccs
[367.672180] Starting dynamic subtest: smem
[368.003983] Dynamic subtest smem: SUCCESS (0.333s)
[368.005239] Subtest yf-tiled-ccs-to-y-tiled-ccs: SUCCESS (0.334s)
[368.214455] [096/137] (688s left) kms_atomic (atomic_plane_damage)
[368.642327] Starting subtest: atomic_plane_damage
[368.644982] Subtest atomic_plane_damage: SKIP (0.000s)
[369.065294] [097/137] (687s left) gem_exec_suspend (basic-s3)
[369.288838] Starting subtest: basic-S3
[369.290367] Starting dynamic subtest: smem
[391.309751] Dynamic subtest smem: SUCCESS (5.444s)
[391.311078] Subtest basic-S3: SUCCESS (5.446s)
[396.243878] [098/137] (681s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[396.554795] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[396.557436] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[396.671394] [099/137] (681s left) syncobj_basic (bad-fd-to-handle)
[396.871004] Starting subtest: bad-fd-to-handle
[396.872869] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[396.967720] [100/137] (680s left) kms_psr2_sf (overlay-primary-update-sf-dmg-area)
[397.170584] Subtest overlay-primary-update-sf-dmg-area: SKIP (0.000s)
[397.232838] [101/137] (680s left) vc4/vc4_perfmon (get-values-invalid-perfmon)
[397.490897] Subtest get-values-invalid-perfmon: SKIP (0.000s)
[397.567435] [102/137] (680s left) gem_exec_parallel (fds)
[397.793348] Starting subtest: fds
[397.794756] Starting dynamic subtest: rcs0
[402.440106] Dynamic subtest rcs0: SUCCESS (4.647s)
[402.465270] Starting dynamic subtest: bcs0
[406.959786] Dynamic subtest bcs0: SUCCESS (4.518s)
[406.984221] Starting dynamic subtest: vcs0
[411.582189] Dynamic subtest vcs0: SUCCESS (4.621s)
[411.608592] Starting dynamic subtest: vecs0
[416.093901] Dynamic subtest vecs0: SUCCESS (4.510s)
[416.095216] Subtest fds: SUCCESS (18.302s)
[416.304465] [103/137] (661s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180)
[416.632637] Starting subtest: linear-max-hw-stride-32bpp-rotate-180
[418.187995] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.558s)
[418.370254] [104/137] (659s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt)
[418.683981] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt
[418.686590] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[418.785404] [105/137] (659s left) syncobj_timeline (single-wait-for-submit-signaled)
[418.989650] Starting subtest: single-wait-for-submit-signaled
[418.991416] Subtest single-wait-for-submit-signaled: SUCCESS (0.001s)
[419.090414] [106/137] (658s left) perf (low-oa-exponent-permissions)
[419.392808] Starting subtest: low-oa-exponent-permissions
[419.552219] Subtest low-oa-exponent-permissions: SUCCESS (0.159s)
[419.619943] [107/137] (658s left) gem_exec_fence (syncobj-wait)
[420.283032] Starting subtest: syncobj-wait
[420.317945] Subtest syncobj-wait: SUCCESS (0.035s)
[420.669323] [108/137] (657s left) kms_lease (master-vs-lease)
[420.975996] Starting subtest: master-vs-lease
[420.978054] Subtest master-vs-lease: SUCCESS (0.004s)
[421.068281] [109/137] (657s left) kms_flip_event_leak (basic)
[421.375347] Starting subtest: basic
[421.376554] Starting dynamic subtest: pipe-A-DP-1
[421.671900] Dynamic subtest pipe-A-DP-1: SUCCESS (0.298s)
[421.710280] Starting dynamic subtest: pipe-B-DP-1
[422.252138] Dynamic subtest pipe-B-DP-1: SUCCESS (0.571s)
[422.287710] Starting dynamic subtest: pipe-C-DP-1
[422.948275] Dynamic subtest pipe-C-DP-1: SUCCESS (0.689s)
[422.949716] Subtest basic: SUCCESS (1.575s)
[423.284270] [110/137] (654s left) gem_lmem_swapping (parallel-random-verify-ccs)
[423.496020] Subtest parallel-random-verify-ccs: SKIP (0.000s)
[423.550510] [111/137] (654s left) sysfs_heartbeat_interval (idempotent)
[423.760248] Starting subtest: idempotent
[423.764445] Starting dynamic subtest: vecs0
[423.768776] Dynamic subtest vecs0: SUCCESS (0.006s)
[423.796388] Starting dynamic subtest: vcs0
[423.797626] Dynamic subtest vcs0: SUCCESS (0.004s)
[423.821556] Starting dynamic subtest: bcs0
[423.822824] Dynamic subtest bcs0: SUCCESS (0.004s)
[423.846403] Starting dynamic subtest: rcs0
[423.847911] Dynamic subtest rcs0: SUCCESS (0.004s)
[423.849329] Subtest idempotent: SUCCESS (0.026s)
[423.885895] [112/137] (654s left) gem_exec_schedule (preempt-self)
[424.126030] Starting subtest: preempt-self
[424.127598] Starting dynamic subtest: rcs0
[424.160395] Dynamic subtest rcs0: SUCCESS (0.033s)
[424.203372] Starting dynamic subtest: bcs0
[424.206129] Dynamic subtest bcs0: SUCCESS (0.036s)
[424.241542] Starting dynamic subtest: vcs0
[424.243056] Dynamic subtest vcs0: SUCCESS (0.037s)
[424.279780] Starting dynamic subtest: vecs0
[424.281106] Dynamic subtest vecs0: SUCCESS (0.037s)
[424.283242] Subtest preempt-self: SUCCESS (0.149s)
[424.635371] [113/137] (653s left) kms_ccs (pipe-c-bad-pixel-format-y_tiled_gen12_rc_ccs)
[425.272091] Starting subtest: pipe-C-bad-pixel-format-y_tiled_gen12_rc_ccs
[425.275630] Subtest pipe-C-bad-pixel-format-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[425.713420] [114/137] (652s left) gem_mmap (bad-offset)
[425.914153] Starting subtest: bad-offset
[425.915860] Subtest bad-offset: SUCCESS (0.001s)
[426.029535] [115/137] (652s left) kms_concurrent (pipe-c)
[426.328420] Starting subtest: pipe-C
[426.330848] Starting dynamic subtest: DP-1
[427.107216] Dynamic subtest DP-1: SUCCESS (0.776s)
[427.108468] Subtest pipe-C: SUCCESS (0.782s)
[427.433670] [116/137] (651s left) kms_addfb_basic (no-handle)
[427.636070] Starting subtest: no-handle
[427.637460] Subtest no-handle: SUCCESS (0.000s)
[427.849880] [117/137] (650s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[428.157319] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[428.159884] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[428.250656] [118/137] (650s left) gem_userptr_blits (map-fixed-invalidate)
[428.491227] Starting subtest: map-fixed-invalidate
[428.492620] Starting dynamic subtest: gtt
[428.842051] Dynamic subtest gtt: SUCCESS (0.349s)
[428.867618] Starting dynamic subtest: wb
[429.116253] Dynamic subtest wb: SUCCESS (0.272s)
[429.140954] Starting dynamic subtest: wc
[429.385102] Dynamic subtest wc: SUCCESS (0.268s)
[429.415767] Starting dynamic subtest: uc
[429.662026] Dynamic subtest uc: SUCCESS (0.275s)
[429.663321] Subtest map-fixed-invalidate: SUCCESS (1.170s)
[429.800233] [119/137] (648s left) kms_getfb (getfb2-into-addfb2)
[430.003464] Starting subtest: getfb2-into-addfb2
[430.005030] Subtest getfb2-into-addfb2: SUCCESS (0.000s)
[430.116348] [120/137] (648s left) kms_addfb_basic (bad-pitch-128)
[430.317395] Starting subtest: bad-pitch-128
[430.318755] Subtest bad-pitch-128: SUCCESS (0.000s)
[430.533449] [121/137] (648s left) kms_pipe_crc_basic (compare-crc-sanitycheck)
[430.843793] Starting subtest: compare-crc-sanitycheck
[430.845351] Starting dynamic subtest: pipe-A-DP-1
[431.269249] Dynamic subtest pipe-A-DP-1: SUCCESS (0.422s)
[431.299333] Starting dynamic subtest: pipe-B-DP-1
[431.982021] Dynamic subtest pipe-B-DP-1: SUCCESS (0.709s)
[432.014654] Starting dynamic subtest: pipe-C-DP-1
[432.914987] Dynamic subtest pipe-C-DP-1: SUCCESS (0.920s)
[432.916362] Subtest compare-crc-sanitycheck: SUCCESS (2.070s)
[433.246906] [122/137] (645s left) kms_vblank (pipe-b-query-forked-busy)
[433.544194] Starting subtest: pipe-B-query-forked-busy
[436.387125] Subtest pipe-B-query-forked-busy: SUCCESS (2.845s)
[436.728366] [123/137] (642s left) dumb_buffer (map-invalid-size)
[436.931784] Starting subtest: map-invalid-size
[436.933483] Subtest map-invalid-size: SUCCESS (0.000s)
[437.027291] [124/137] (641s left) api_intel_allocator (gem-pool)
[437.228440] Starting subtest: gem-pool
[437.244938] Subtest gem-pool: SUCCESS (0.017s)
[437.360571] [125/137] (641s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[437.661463] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[437.664552] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[437.777852] [126/137] (641s left) kms_vrr (flipline)
[438.084881] Starting subtest: flipline
[438.087656] Subtest flipline: SKIP (0.000s)
[438.144838] [127/137] (640s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[438.456386] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt
[438.459812] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[438.561292] [128/137] (640s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[438.884443] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[440.163964] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (1.282s)
[440.596321] [129/137] (638s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt)
[440.912142] Starting subtest: fbcpsr-rgb101010-draw-blt
[440.914980] Subtest fbcpsr-rgb101010-draw-blt: SKIP (0.000s)
[441.010950] [130/137] (638s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-pwrite)
[441.325536] Starting subtest: fbcpsr-rgb565-draw-pwrite
[441.328050] Subtest fbcpsr-rgb565-draw-pwrite: SKIP (0.000s)
[441.427842] [131/137] (637s left) kms_setmode (basic-clone-single-crtc)
[441.631786] Starting subtest: basic-clone-single-crtc
[441.635510] Subtest basic-clone-single-crtc: SKIP (0.000s)
[441.727453] [132/137] (637s left) gem_ringfill (legacy-basic)
[442.206263] Starting subtest: legacy-basic
[442.207607] Starting dynamic subtest: default
[442.235990] Dynamic subtest default: SUCCESS (0.028s)
[442.265419] Starting dynamic subtest: render
[442.266975] Dynamic subtest render: SUCCESS (0.025s)
[442.295666] Starting dynamic subtest: bsd
[442.297134] Dynamic subtest bsd: SUCCESS (0.026s)
[442.326032] Starting dynamic subtest: bsd1
[442.327491] Dynamic subtest bsd1: SUCCESS (0.028s)
[442.353406] Starting dynamic subtest: blt
[442.354717] Dynamic subtest blt: SUCCESS (0.028s)
[442.378630] Starting dynamic subtest: vebox
[442.383266] Dynamic subtest vebox: SUCCESS (0.029s)
[442.384599] Subtest legacy-basic: SUCCESS (0.175s)
[442.477064] [133/137] (636s left) gem_render_copy_redux (interruptible)
[442.705393] Starting subtest: interruptible
[444.945004] Subtest interruptible: SUCCESS (2.239s)
[445.045467] [134/137] (634s left) syncobj_timeline (multi-wait-submitted-signaled)
[445.248947] Starting subtest: multi-wait-submitted-signaled
[445.250341] Subtest multi-wait-submitted-signaled: SUCCESS (0.003s)
[445.345371] [135/137] (633s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-render)
[445.650225] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-render
[445.652889] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[445.761911] [136/137] (633s left) gem_exec_nop (basic-parallel)
[445.985408] Starting subtest: basic-parallel
[449.126041] Subtest basic-parallel: SUCCESS (3.140s)
[449.361621] [137/137] (630s left) kms_ccs (pipe-a-crc-primary-basic-4_tiled_dg2_mc_ccs)
[449.760549] Starting subtest: pipe-A-crc-primary-basic-4_tiled_dg2_mc_ccs
[449.763136] Subtest pipe-A-crc-primary-basic-4_tiled_dg2_mc_ccs: SKIP (0.002s)
[450.391755] Closing watchdogs
Done.