[58.970694] Initializing watchdogs
[58.970739]   /dev/watchdog0
[58.984739] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[58.989095] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.991462] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.994937] [001/131] (960s left) gem_exec_whisper (basic-contexts-all)
[59.081749] Starting subtest: basic-contexts-all
[72.822559] Subtest basic-contexts-all: SUCCESS (13.765s)
[73.016806] [002/131] (946s left) kms_big_fb (y-tiled-32bpp-rotate-270)
[73.125596] Starting subtest: y-tiled-32bpp-rotate-270
[73.130062] Subtest y-tiled-32bpp-rotate-270: SKIP (0.000s)
[73.210695] [003/131] (946s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt)
[73.308648] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt
[73.313079] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[73.426628] [004/131] (946s left) kms_flip (2x-flip-vs-rmfb-interruptible)
[73.521910] Starting subtest: 2x-flip-vs-rmfb-interruptible
[73.533549] Subtest 2x-flip-vs-rmfb-interruptible: SKIP (0.010s)
[73.608585] [005/131] (946s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs)
[73.701484] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs
[73.703740] Starting dynamic subtest: pipe-A-eDP-1
[73.727980] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[73.738087] Starting dynamic subtest: pipe-B-eDP-1
[73.761107] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[73.768099] Starting dynamic subtest: pipe-C-eDP-1
[73.790774] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[73.798041] Starting dynamic subtest: pipe-D-eDP-1
[73.821988] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[73.826152] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.003s)
[75.858776] [006/131] (943s left) sysfs_timeslice_duration (idempotent)
[75.920281] Starting subtest: idempotent
[75.922457] Starting dynamic subtest: vecs0
[75.924821] Dynamic subtest vecs0: SUCCESS (0.000s)
[75.934053] Starting dynamic subtest: ccs0
[75.936176] Dynamic subtest ccs0: SUCCESS (0.000s)
[75.943483] Starting dynamic subtest: vcs0
[75.945618] Dynamic subtest vcs0: SUCCESS (0.000s)
[75.954705] Starting dynamic subtest: bcs0
[75.956926] Dynamic subtest bcs0: SUCCESS (0.000s)
[75.964129] Starting dynamic subtest: rcs0
[75.965965] Dynamic subtest rcs0: SUCCESS (0.000s)
[75.973303] Starting dynamic subtest: vcs1
[75.975464] Dynamic subtest vcs1: SUCCESS (0.000s)
[75.977632] Subtest idempotent: SUCCESS (0.003s)
[76.036419] [007/131] (943s left) gem_exec_async (concurrent-writes)
[76.100544] Starting subtest: concurrent-writes
[76.102788] Starting dynamic subtest: rcs0
[76.116092] Dynamic subtest rcs0: SUCCESS (0.016s)
[76.125033] Starting dynamic subtest: bcs0
[76.127657] Dynamic subtest bcs0: SUCCESS (0.006s)
[76.136387] Starting dynamic subtest: vcs0
[76.138517] Dynamic subtest vcs0: SUCCESS (0.005s)
[76.147199] Starting dynamic subtest: vcs1
[76.149427] Dynamic subtest vcs1: SUCCESS (0.006s)
[76.156648] Starting dynamic subtest: vecs0
[76.158741] Dynamic subtest vecs0: SUCCESS (0.006s)
[76.165963] Starting dynamic subtest: ccs0
[76.168158] Dynamic subtest ccs0: SUCCESS (0.006s)
[76.170266] Subtest concurrent-writes: SUCCESS (0.047s)
[76.381571] [008/131] (943s left) kms_feature_discovery (chamelium)
[76.471603] Starting subtest: chamelium
[76.475848] Subtest chamelium: SKIP (0.000s)
[76.542470] [009/131] (943s left) gem_set_tiling_vs_blt (tiled-to-untiled)
[76.596604] Subtest tiled-to-untiled: SKIP (0.000s)
[76.677801] [010/131] (943s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-blt)
[76.772740] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-blt
[76.776662] Subtest fbc-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[76.855482] [011/131] (943s left) i915_hangman (hangcheck-unterminated)
[76.914571] Starting subtest: hangcheck-unterminated
[88.885127] Subtest hangcheck-unterminated: SUCCESS (11.969s)
[89.005337] [012/131] (930s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite)
[89.109063] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite
[98.512828] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.407s)
[98.633228] [013/131] (921s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[98.736266] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt
[98.740534] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[98.826701] [014/131] (921s left) gem_close_race (multigpu-basic-threads)
[98.880927] Starting subtest: multigpu-basic-threads
[98.886056] Subtest multigpu-basic-threads: SKIP (0.000s)
[99.097194] [015/131] (920s left) gem_mmap_gtt (basic-write-read-distinct)
[99.143789] Subtest basic-write-read-distinct: SKIP (0.000s)
[99.204644] [016/131] (920s left) gem_exec_fence (nb-await)
[99.383115] Starting subtest: nb-await
[99.385641] Starting dynamic subtest: rcs0
[99.450052] Dynamic subtest rcs0: SUCCESS (0.066s)
[99.459579] Starting dynamic subtest: bcs0
[99.509084] Dynamic subtest bcs0: SUCCESS (0.058s)
[99.519673] Starting dynamic subtest: vcs0
[99.569207] Dynamic subtest vcs0: SUCCESS (0.059s)
[99.579993] Starting dynamic subtest: vcs1
[99.628423] Dynamic subtest vcs1: SUCCESS (0.058s)
[99.637849] Starting dynamic subtest: vecs0
[99.686593] Dynamic subtest vecs0: SUCCESS (0.057s)
[99.696920] Starting dynamic subtest: ccs0
[99.745024] Dynamic subtest ccs0: SUCCESS (0.058s)
[99.747872] Subtest nb-await: SUCCESS (0.362s)
[101.987936] [FACT gem_exec_fence (nb-await)] new: kernel.kmod_is_loaded.vgem: true
[101.992832] [017/131] (918s left) kms_chamelium_hpd (vga-hpd-with-enabled-mode)
[102.383743] Subtest vga-hpd-with-enabled-mode: SKIP (0.000s)
[103.169528] [018/131] (916s left) perf_pmu (busy-no-semaphores)
[103.214108] Starting subtest: busy-no-semaphores
[103.216490] Starting dynamic subtest: rcs0
[103.772929] Dynamic subtest rcs0: SUCCESS (0.559s)
[103.782601] Starting dynamic subtest: bcs0
[104.323253] Dynamic subtest bcs0: SUCCESS (0.549s)
[104.334034] Starting dynamic subtest: vcs0
[104.872067] Dynamic subtest vcs0: SUCCESS (0.547s)
[104.882918] Starting dynamic subtest: vcs1
[106.456788] Dynamic subtest vcs1: SUCCESS (1.584s)
[106.468049] Starting dynamic subtest: vecs0
[108.442040] Dynamic subtest vecs0: SUCCESS (1.983s)
[108.452654] Starting dynamic subtest: ccs0
[110.426635] Dynamic subtest ccs0: SUCCESS (1.983s)
[110.429510] Subtest busy-no-semaphores: SUCCESS (7.212s)
[110.543280] [019/131] (909s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping)
[110.637811] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping
[110.663976] Starting dynamic subtest: pipe-A-plane-0
[111.019919] Dynamic subtest pipe-A-plane-0: SUCCESS (0.356s)
[111.030199] Starting dynamic subtest: pipe-A-plane-3
[111.252884] Dynamic subtest pipe-A-plane-3: SUCCESS (0.232s)
[112.374937] Starting dynamic subtest: pipe-B-plane-0
[112.657837] Dynamic subtest pipe-B-plane-0: SUCCESS (0.289s)
[112.667085] Starting dynamic subtest: pipe-B-plane-3
[112.891179] Dynamic subtest pipe-B-plane-3: SUCCESS (0.233s)
[113.199746] Subtest pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping: SUCCESS (2.563s)
[114.054273] [020/131] (906s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[114.148643] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[114.153237] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[114.251140] [021/131] (905s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-modifier)
[114.342302] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-modifier
[114.346717] Subtest pixel-format-4-tiled-dg2-rc-ccs-modifier: SKIP (0.000s)
[114.462716] [022/131] (905s left) kms_psr (fbc-psr2-primary-mmap-gtt)
[114.563091] Starting subtest: fbc-psr2-primary-mmap-gtt
[114.565158] Starting dynamic subtest: eDP-1
[114.569246] Dynamic subtest eDP-1: SKIP (0.000s)
[114.573370] Subtest fbc-psr2-primary-mmap-gtt: SKIP (0.000s)
[114.649452] [023/131] (905s left) kms_addfb_basic (unused-pitches)
[114.698760] Starting subtest: unused-pitches
[114.701049] Subtest unused-pitches: SUCCESS (0.000s)
[114.838189] [024/131] (905s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180)
[114.933956] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180
[114.938436] Subtest y-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[115.038969] [025/131] (905s left) syncobj_timeline (wait-all-complex)
[115.100154] Starting subtest: wait-all-complex
[115.315078] Subtest wait-all-complex: SUCCESS (0.213s)
[115.394616] [026/131] (905s left) kms_psr (psr-dpms)
[115.485909] Starting subtest: psr-dpms
[115.488284] Starting dynamic subtest: eDP-1
[118.484759] Dynamic subtest eDP-1: SUCCESS (2.997s)
[118.487264] Subtest psr-dpms: SUCCESS (2.998s)
[119.354849] [027/131] (901s left) syncobj_timeline (multi-wait-signaled)
[119.409982] Starting subtest: multi-wait-signaled
[119.412395] Subtest multi-wait-signaled: SUCCESS (0.001s)
[119.508520] [028/131] (901s left) gem_exec_balancer (indices)
[119.575485] Starting subtest: indices
[121.842932] Subtest indices: SUCCESS (2.265s)
[122.186863] [029/131] (898s left) prime_busy (before)
[122.265034] Starting subtest: before
[122.269971] Starting dynamic subtest: rcs0
[122.290473] Dynamic subtest rcs0: SUCCESS (0.022s)
[122.300081] Starting dynamic subtest: bcs0
[122.345028] Dynamic subtest bcs0: SUCCESS (0.054s)
[122.354104] Starting dynamic subtest: vcs0
[122.387245] Dynamic subtest vcs0: SUCCESS (0.042s)
[122.396153] Starting dynamic subtest: vcs1
[122.428974] Dynamic subtest vcs1: SUCCESS (0.042s)
[122.437834] Starting dynamic subtest: vecs0
[122.470859] Dynamic subtest vecs0: SUCCESS (0.041s)
[122.480104] Starting dynamic subtest: ccs0
[122.513576] Dynamic subtest ccs0: SUCCESS (0.043s)
[122.622626] Subtest before: SUCCESS (0.356s)
[122.697882] [030/131] (897s left) gem_ctx_param (set-priority-invalid-size)
[122.754853] Starting subtest: set-priority-invalid-size
[122.757327] Subtest set-priority-invalid-size: SUCCESS (0.000s)
[122.830825] [031/131] (897s left) kms_addfb_basic (tile-pitch-mismatch)
[122.881968] Starting subtest: tile-pitch-mismatch
[122.886353] Subtest tile-pitch-mismatch: SKIP (0.000s)
[123.040505] [032/131] (897s left) gem_exec_schedule (independent)
[123.124680] Starting subtest: independent
[123.127085] Starting dynamic subtest: rcs0
[124.885706] Dynamic subtest rcs0: SUCCESS (1.772s)
[124.897658] Starting dynamic subtest: vcs0
[126.953626] Dynamic subtest vcs0: SUCCESS (2.067s)
[126.964476] Starting dynamic subtest: vcs1
[128.928851] Dynamic subtest vcs1: SUCCESS (1.974s)
[128.940917] Starting dynamic subtest: vecs0
[130.912527] Dynamic subtest vecs0: SUCCESS (1.983s)
[130.924758] Starting dynamic subtest: ccs0
[132.885826] Dynamic subtest ccs0: SUCCESS (1.972s)
[132.888734] Subtest independent: SUCCESS (9.772s)
[133.215072] [033/131] (887s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt)
[133.320398] Starting subtest: fbcpsr-rgb565-draw-blt
[140.306115] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (6.989s)
[140.446904] [034/131] (880s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[140.537496] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[140.539757] Starting dynamic subtest: pipe-A-default-mode
[143.276757] Dynamic subtest pipe-A-default-mode: SUCCESS (2.739s)
[143.279309] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.741s)
[144.154580] [035/131] (876s left) gem_userptr_blits (stress-mm-invalidate-close-overlap)
[144.234571] Starting subtest: stress-mm-invalidate-close-overlap
[146.382936] Subtest stress-mm-invalidate-close-overlap: SUCCESS (2.148s)
[146.492733] [036/131] (874s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[146.594728] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[147.296267] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.703s)
[147.444827] [037/131] (873s left) gem_exec_flush (basic-uc-pro-default)
[147.508457] Starting subtest: basic-uc-pro-default
[152.975892] Subtest basic-uc-pro-default: SUCCESS (5.468s)
[153.162801] [038/131] (867s left) dumb_buffer (map-invalid-size)
[153.212836] Starting subtest: map-invalid-size
[153.215112] Subtest map-invalid-size: SUCCESS (0.000s)
[153.332959] [039/131] (867s left) kms_hdr (bpc-switch-suspend)
[153.429705] Starting subtest: bpc-switch-suspend
[154.515413] Starting dynamic subtest: pipe-A-eDP-1
[174.327068] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.665s)
[174.329452] Subtest bpc-switch-suspend: SUCCESS (5.751s)
[174.438255] [040/131] (846s left) kms_content_protection (dp-mst-lic-type-1)
[174.590555] Starting subtest: dp-mst-lic-type-1
[174.595024] Subtest dp-mst-lic-type-1: SKIP (0.000s)
[174.706107] [041/131] (846s left) gem_wait (write-busy)
[174.759023] Starting subtest: write-busy
[174.761389] Starting dynamic subtest: all-engines
[175.342389] Dynamic subtest all-engines: SUCCESS (0.595s)
[175.357526] Starting dynamic subtest: rcs0
[175.893340] Dynamic subtest rcs0: SUCCESS (0.560s)
[175.909567] Starting dynamic subtest: bcs0
[176.443790] Dynamic subtest bcs0: SUCCESS (0.559s)
[176.459420] Starting dynamic subtest: vcs0
[178.066129] Dynamic subtest vcs0: SUCCESS (1.645s)
[178.082586] Starting dynamic subtest: vcs1
[180.049251] Dynamic subtest vcs1: SUCCESS (2.005s)
[180.065672] Starting dynamic subtest: vecs0
[182.097028] Dynamic subtest vecs0: SUCCESS (2.065s)
[182.114597] Starting dynamic subtest: ccs0
[182.649702] Dynamic subtest ccs0: SUCCESS (0.557s)
[182.652169] Subtest write-busy: SUCCESS (7.993s)
[182.856801] [042/131] (838s left) kms_big_fb (yf-tiled-8bpp-rotate-90)
[182.958358] Starting subtest: yf-tiled-8bpp-rotate-90
[182.962753] Subtest yf-tiled-8bpp-rotate-90: SKIP (0.000s)
[183.067643] [043/131] (838s left) kms_plane_scaling (invalid-num-scalers)
[183.149366] Starting subtest: invalid-num-scalers
[183.151535] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers
[183.167537] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.017s)
[183.177053] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers
[183.201954] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.034s)
[183.211769] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers
[183.244136] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.043s)
[183.253402] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers
[183.279131] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.033s)
[183.281393] Subtest invalid-num-scalers: SUCCESS (0.131s)
[183.402744] [044/131] (837s left) kms_force_connector_basic (prune-stale-modes)
[183.488473] Starting subtest: prune-stale-modes
[183.927782] Subtest prune-stale-modes: SUCCESS (0.445s)
[184.063376] [045/131] (837s left) kms_big_fb (4-tiled-8bpp-rotate-90)
[184.150823] Starting subtest: 4-tiled-8bpp-rotate-90
[184.171826] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.020s)
[184.294512] [046/131] (837s left) kms_flip (flip-vs-fences-interruptible)
[184.381213] Starting subtest: flip-vs-fences-interruptible
[184.385423] Subtest flip-vs-fences-interruptible: SKIP (0.000s)
[184.481245] [047/131] (836s left) gem_userptr_blits (unsync-unmap-after-close)
[184.550301] Subtest unsync-unmap-after-close: SKIP (0.000s)
[184.666479] [048/131] (836s left) kms_psr (pr-cursor-plane-onoff)
[184.754270] Starting subtest: pr-cursor-plane-onoff
[184.758021] Subtest pr-cursor-plane-onoff: SKIP (0.000s)
[184.837041] [049/131] (836s left) kms_flip (dpms-off-confusion-interruptible)
[184.926770] Starting subtest: dpms-off-confusion-interruptible
[184.928710] Starting dynamic subtest: A-eDP1
[193.551072] Dynamic subtest A-eDP1: SUCCESS (8.653s)
[193.562560] Starting dynamic subtest: B-eDP1
[202.222184] Dynamic subtest B-eDP1: SUCCESS (8.683s)
[202.233865] Starting dynamic subtest: C-eDP1
[210.902089] Dynamic subtest C-eDP1: SUCCESS (8.677s)
[210.913487] Starting dynamic subtest: D-eDP1
[219.490457] Dynamic subtest D-eDP1: SUCCESS (8.586s)
[219.495446] Subtest dpms-off-confusion-interruptible: SUCCESS (34.611s)
[220.640514] [050/131] (800s left) kms_psr (psr2-sprite-plane-move)
[220.736310] Starting subtest: psr2-sprite-plane-move
[220.738651] Starting dynamic subtest: eDP-1
[222.536385] Dynamic subtest eDP-1: SUCCESS (1.798s)
[222.538276] Subtest psr2-sprite-plane-move: SUCCESS (1.799s)
[223.330596] [051/131] (798s left) kms_ccs (crc-primary-suspend-y-tiled-ccs)
[223.429181] Starting subtest: crc-primary-suspend-y-tiled-ccs
[223.431574] Starting dynamic subtest: pipe-A-eDP-1
[223.440920] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[223.452406] Starting dynamic subtest: pipe-B-eDP-1
[223.461420] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[223.470825] Starting dynamic subtest: pipe-C-eDP-1
[223.479419] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[223.488718] Starting dynamic subtest: pipe-D-eDP-1
[223.497844] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[223.502052] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.004s)
[225.637423] [052/131] (795s left) kms_color_pipeline (plane-lut1d)
[225.722843] Starting subtest: plane-lut1d
[225.890680] Starting dynamic subtest: pipe-A-plane-0
[226.235796] Dynamic subtest pipe-A-plane-0: FAIL (0.179s)
[226.246857] Starting dynamic subtest: pipe-A-plane-1
[226.463612] Dynamic subtest pipe-A-plane-1: FAIL (0.161s)
[226.474391] Starting dynamic subtest: pipe-A-plane-2
[226.708360] Dynamic subtest pipe-A-plane-2: FAIL (0.166s)
[227.632085] Starting dynamic subtest: pipe-B-plane-0
[228.088603] Dynamic subtest pipe-B-plane-0: FAIL (0.196s)
[228.100276] Starting dynamic subtest: pipe-B-plane-1
[228.402017] Dynamic subtest pipe-B-plane-1: FAIL (0.189s)
[228.413062] Starting dynamic subtest: pipe-B-plane-2
[228.708614] Dynamic subtest pipe-B-plane-2: FAIL (0.166s)
[229.389890] Starting dynamic subtest: pipe-C-plane-0
[229.860228] Dynamic subtest pipe-C-plane-0: FAIL (0.128s)
[229.871271] Starting dynamic subtest: pipe-C-plane-1
[230.262797] Dynamic subtest pipe-C-plane-1: FAIL (0.133s)
[230.273717] Starting dynamic subtest: pipe-C-plane-2
[230.621878] Dynamic subtest pipe-C-plane-2: FAIL (0.608s)
[231.485900] Starting dynamic subtest: pipe-D-plane-0
[232.042831] Dynamic subtest pipe-D-plane-0: FAIL (0.128s)
[232.052452] Starting dynamic subtest: pipe-D-plane-1
[232.494949] Dynamic subtest pipe-D-plane-1: FAIL (0.600s)
[232.505831] Starting dynamic subtest: pipe-D-plane-2
[232.919478] Dynamic subtest pipe-D-plane-2: FAIL (0.543s)
[233.051250] Subtest plane-lut1d: FAIL (7.331s)
[233.927349] [053/131] (787s left) gem_mmap (basic-small-bo)
[233.981369] Subtest basic-small-bo: SKIP (0.000s)
[234.046320] [054/131] (787s left) kms_async_flips (async-flip-with-page-flip-events-tiled-atomic)
[234.144180] Starting subtest: async-flip-with-page-flip-events-tiled-atomic
[234.515202] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs
[237.272198] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.756s)
[237.284518] Starting dynamic subtest: pipe-A-eDP-1-4
[239.458026] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.185s)
[239.468227] Starting dynamic subtest: pipe-A-eDP-1-4
[241.466319] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.008s)
[241.478297] Starting dynamic subtest: pipe-A-eDP-1-x
[243.645084] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.178s)
[244.011015] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs
[246.767636] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.766s)
[246.776867] Starting dynamic subtest: pipe-B-eDP-1-4
[248.942366] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.174s)
[248.952437] Starting dynamic subtest: pipe-B-eDP-1-4
[250.951673] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.009s)
[250.963832] Starting dynamic subtest: pipe-B-eDP-1-x
[253.140441] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.189s)
[253.511711] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs
[256.258646] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.755s)
[256.271360] Starting dynamic subtest: pipe-C-eDP-1-4
[258.432824] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.174s)
[258.445005] Starting dynamic subtest: pipe-C-eDP-1-4
[260.442424] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s)
[260.458580] Starting dynamic subtest: pipe-C-eDP-1-x
[262.631114] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.188s)
[263.001043] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs
[265.764588] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.772s)
[265.779598] Starting dynamic subtest: pipe-D-eDP-1-4
[267.947614] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.182s)
[267.958806] Starting dynamic subtest: pipe-D-eDP-1-4
[269.957473] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.008s)
[269.969856] Starting dynamic subtest: pipe-D-eDP-1-x
[272.136434] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.177s)
[272.139205] Subtest async-flip-with-page-flip-events-tiled-atomic: SUCCESS (38.003s)
[273.311408] [055/131] (748s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[273.539340] Starting subtest: cursor-rapid-movement-128x42
[273.582733] Subtest cursor-rapid-movement-128x42: SKIP (0.040s)
[273.775646] [056/131] (747s left) gem_exec_balancer (parallel-out-fence)
[274.044378] Starting subtest: parallel-out-fence
[275.161266] Subtest parallel-out-fence: SUCCESS (1.119s)
[275.262087] [057/131] (746s left) gem_eio (hibernate)
[275.495083] Starting subtest: hibernate
[290.171194] Subtest hibernate: SUCCESS (14.671s)
[297.323886] [058/131] (731s left) kms_frontbuffer_tracking (basic)
[297.442611] Starting subtest: basic
[300.496820] Subtest basic: SUCCESS (3.058s)
[300.640251] [059/131] (728s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy)
[300.707650] Starting subtest: map-fixed-invalidate-overlap-busy
[300.711577] Subtest map-fixed-invalidate-overlap-busy: SKIP (0.000s)
[300.828879] [060/131] (728s left) prime_mmap (test_errors)
[300.887815] Starting subtest: test_errors
[300.889572] Starting dynamic subtest: test_errors-smem
[300.986962] Dynamic subtest test_errors-smem: SUCCESS (0.100s)
[300.988934] Subtest test_errors: SUCCESS (0.101s)
[301.095450] [061/131] (727s left) kms_invalid_mode (bad-htotal)
[301.197031] Starting subtest: bad-htotal
[301.198826] Starting dynamic subtest: pipe-A-eDP-1
[301.480187] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[301.490239] Starting dynamic subtest: pipe-B-eDP-1
[301.492456] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[301.501809] Starting dynamic subtest: pipe-C-eDP-1
[301.504067] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[301.513507] Starting dynamic subtest: pipe-D-eDP-1
[301.515705] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[301.517972] Subtest bad-htotal: SUCCESS (0.291s)
[302.329954] [062/131] (726s left) gem_render_copy (y-tiled)
[302.394132] Starting subtest: y-tiled
[302.398518] Subtest y-tiled: SKIP (0.000s)
[302.578056] [063/131] (726s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen)
[302.677371] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen
[302.681639] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[302.761389] [064/131] (726s left) gem_mmap (bad-offset)
[302.812046] Subtest bad-offset: SKIP (0.000s)
[302.872515] [065/131] (726s left) gem_ctx_exec (basic)
[302.935279] Starting subtest: basic
[302.937799] Subtest basic: SUCCESS (0.005s)
[303.099185] [066/131] (726s left) perf (per-context-mode-unprivileged)
[303.245936] Starting subtest: per-context-mode-unprivileged
[303.250343] Subtest per-context-mode-unprivileged: SKIP (0.000s)
[303.288015] [067/131] (725s left) kms_tv_load_detect (load-detect)
[303.341659] Subtest load-detect: SKIP (0.000s)
[303.404215] [068/131] (725s left) gem_lmem_evict (dontneed-evict-race)
[303.444011] Subtest dontneed-evict-race: SKIP (0.000s)
[303.493148] [069/131] (725s left) kms_vblank (query-forked)
[303.577285] Starting subtest: query-forked
[303.579090] Starting dynamic subtest: pipe-A-eDP-1
[305.386391] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.810s)
[305.400862] Starting dynamic subtest: pipe-D-eDP-1
[307.903927] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.513s)
[307.905806] Subtest query-forked: SUCCESS (4.327s)
[308.723489] [070/131] (720s left) gem_mmap_offset (partial-mmap)
[308.780392] Starting subtest: partial-mmap
[308.782549] Starting dynamic subtest: smem0
[308.784859] Dynamic subtest smem0: SUCCESS (0.004s)
[308.786803] Subtest partial-mmap: SUCCESS (0.005s)
[308.896363] [071/131] (720s left) gem_pxp (display-protected-crc)
[309.031829] Starting subtest: display-protected-crc
[311.040684] Subtest display-protected-crc: SUCCESS (2.010s)
[311.151771] [072/131] (718s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs)
[311.253674] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs
[311.255913] Starting dynamic subtest: pipe-A-eDP-1
[311.278459] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[311.290695] Starting dynamic subtest: pipe-B-eDP-1
[311.311907] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[311.321277] Starting dynamic subtest: pipe-C-eDP-1
[311.342232] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[311.351754] Starting dynamic subtest: pipe-D-eDP-1
[311.373064] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[311.376937] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[313.517998] [073/131] (715s left) syncobj_eventfd (timeline-wait)
[313.572127] Starting subtest: timeline-wait
[313.581518] Subtest timeline-wait: SUCCESS (0.011s)
[313.668168] [074/131] (715s left) gem_sync (basic-all)
[313.749270] Starting subtest: basic-all
[315.915981] Subtest basic-all: SUCCESS (2.178s)
[316.113892] [075/131] (713s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render)
[316.245354] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render
[316.249503] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[316.351924] [076/131] (713s left) syncobj_timeline (multi-wait-all-available-submitted)
[316.405713] Starting subtest: multi-wait-all-available-submitted
[316.408051] Subtest multi-wait-all-available-submitted: SUCCESS (0.001s)
[316.508952] [077/131] (713s left) kms_properties (colorop-properties-legacy)
[316.605098] Starting subtest: colorop-properties-legacy
[316.607039] Starting dynamic subtest: pipe-A-eDP-1
[316.941046] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.336s)
[316.952460] Starting dynamic subtest: pipe-B-eDP-1
[318.047990] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.104s)
[318.061023] Starting dynamic subtest: pipe-C-eDP-1
[319.156938] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.110s)
[319.167940] Starting dynamic subtest: pipe-D-eDP-1
[320.267104] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.109s)
[320.269418] Subtest colorop-properties-legacy: SUCCESS (3.665s)
[321.116121] [078/131] (708s left) gem_mmap_wc (coherency)
[321.180379] Subtest coherency: SKIP (0.000s)
[321.242275] [079/131] (708s left) kms_display_modes (extended-mode-basic)
[321.327864] Starting subtest: extended-mode-basic
[321.331810] Subtest extended-mode-basic: SKIP (0.000s)
[321.376052] [080/131] (708s left) kms_big_fb (linear-addfb)
[321.470749] Starting subtest: linear-addfb
[321.472970] Subtest linear-addfb: SUCCESS (0.000s)
[321.556325] [081/131] (708s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc)
[321.657151] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc
[321.659308] Starting dynamic subtest: pipe-A-eDP-1
[321.681473] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[321.693526] Starting dynamic subtest: pipe-B-eDP-1
[321.713798] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[321.723120] Starting dynamic subtest: pipe-C-eDP-1
[321.743965] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[321.753249] Starting dynamic subtest: pipe-D-eDP-1
[321.776039] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[321.780195] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.006s)
[323.926448] [082/131] (705s left) kms_flip (dpms-vs-vblank-race-interruptible)
[324.026221] Starting subtest: dpms-vs-vblank-race-interruptible
[324.029313] Starting dynamic subtest: A-eDP1
[327.881091] Dynamic subtest A-eDP1: SUCCESS (3.851s)
[327.892237] Starting dynamic subtest: B-eDP1
[331.371186] Dynamic subtest B-eDP1: SUCCESS (3.491s)
[331.385962] Starting dynamic subtest: C-eDP1
[334.864380] Dynamic subtest C-eDP1: SUCCESS (3.489s)
[334.875366] Starting dynamic subtest: D-eDP1
[338.371467] Dynamic subtest D-eDP1: SUCCESS (3.506s)
[338.373385] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (14.350s)
[339.216172] [083/131] (690s left) gem_pxp (hw-rejects-pxp-context)
[339.280527] Starting subtest: hw-rejects-pxp-context
[339.285014] Subtest hw-rejects-pxp-context: SKIP (0.000s)
[339.391862] [084/131] (690s left) gem_flink_basic (flink-lifetime)
[339.451665] Starting subtest: flink-lifetime
[339.453968] Subtest flink-lifetime: SUCCESS (0.002s)
[339.554330] [085/131] (690s left) kms_pm_dc (dc5-retention-flops)
[340.655502] Starting subtest: dc5-retention-flops
[340.659907] Subtest dc5-retention-flops: SKIP (0.000s)
[340.726174] [086/131] (689s left) kms_plane_scaling (planes-downscale-factor-0-75)
[340.825054] Starting subtest: planes-downscale-factor-0-75
[340.827367] Starting dynamic subtest: pipe-A
[340.845213] Dynamic subtest pipe-A: SKIP (0.018s)
[340.855579] Starting dynamic subtest: pipe-B
[340.874848] Dynamic subtest pipe-B: SKIP (0.029s)
[340.885194] Starting dynamic subtest: pipe-C
[340.903964] Dynamic subtest pipe-C: SKIP (0.029s)
[340.913693] Starting dynamic subtest: pipe-D
[340.933805] Dynamic subtest pipe-D: SKIP (0.029s)
[340.937376] Subtest planes-downscale-factor-0-75: SKIP (0.108s)
[341.048374] [087/131] (689s left) kms_legacy_colorkey (invalid-plane)
[341.129733] Starting subtest: invalid-plane
[341.131994] Starting dynamic subtest: zero-id
[341.133850] Dynamic subtest zero-id: SUCCESS (0.000s)
[341.147542] Starting dynamic subtest: outrange-id
[341.149795] Dynamic subtest outrange-id: SUCCESS (0.000s)
[341.151983] Subtest invalid-plane: SUCCESS (0.001s)
[341.203342] [088/131] (688s left) syncobj_basic (bad-pad-handle-to-fd)
[341.261345] Starting subtest: bad-pad-handle-to-fd
[341.263297] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s)
[341.372208] [089/131] (688s left) fbdev (write)
[341.408543] Starting subtest: write
[341.768104] Subtest write: SUCCESS (0.357s)
[341.832446] [090/131] (688s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-upscaling)
[341.921843] Starting subtest: flip-64bpp-linear-to-32bpp-linear-upscaling
[341.924251] Starting dynamic subtest: pipe-A-default-mode
[344.620280] Dynamic subtest pipe-A-default-mode: SUCCESS (2.700s)
[344.622546] Subtest flip-64bpp-linear-to-32bpp-linear-upscaling: SUCCESS (2.702s)
[345.422974] [091/131] (684s left) kms_atomic_transition (plane-use-after-nonblocking-unbind)
[345.529690] Starting subtest: plane-use-after-nonblocking-unbind
[345.532050] Starting dynamic subtest: pipe-A-eDP-1
[345.589384] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.061s)
[345.885525] Starting dynamic subtest: pipe-B-eDP-1
[346.675604] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.799s)
[346.961568] Subtest plane-use-after-nonblocking-unbind: SUCCESS (1.430s)
[347.797087] [092/131] (682s left) perf (gen12-unprivileged-single-ctx-counters)
[347.917444] Starting subtest: gen12-unprivileged-single-ctx-counters
[347.919704] Starting dynamic subtest: rcs0
[348.004133] Dynamic subtest rcs0: SUCCESS (0.089s)
[348.006513] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.091s)
[348.060469] [093/131] (682s left) kms_frontbuffer_tracking (psr-2p-pri-indfb-multidraw)
[348.199393] Starting subtest: psr-2p-pri-indfb-multidraw
[348.203839] Subtest psr-2p-pri-indfb-multidraw: SKIP (0.000s)
[348.306457] [094/131] (682s left) gem_exec_flush (basic-batch-kernel-default-wb)
[348.359163] Starting subtest: basic-batch-kernel-default-wb
[355.481451] Subtest basic-batch-kernel-default-wb: SUCCESS (7.124s)
[355.687665] [095/131] (674s left) kms_chamelium_color (ctm-limited-range)
[355.784124] Subtest ctm-limited-range: SKIP (0.000s)
[355.830187] [096/131] (674s left) kms_chamelium_edid (dp-mode-timings)
[356.209087] Subtest dp-mode-timings: SKIP (0.000s)
[356.985520] [097/131] (673s left) kms_async_flips (crc-atomic)
[357.070951] Starting subtest: crc-atomic
[357.455496] Starting dynamic subtest: pipe-A-eDP-1
[360.384893] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.928s)
[360.771016] Starting dynamic subtest: pipe-B-eDP-1
[363.692944] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.940s)
[364.067357] Starting dynamic subtest: pipe-C-eDP-1
[366.965079] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.906s)
[367.323858] Starting dynamic subtest: pipe-D-eDP-1
[370.183718] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.871s)
[370.186084] Subtest crc-atomic: SUCCESS (13.116s)
[371.393520] [098/131] (659s left) kms_vrr (flip-dpms)
[371.485546] Starting subtest: flip-dpms
[371.491983] Subtest flip-dpms: SKIP (0.000s)
[371.560949] [099/131] (659s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc)
[371.664413] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc
[378.092992] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (6.434s)
[378.207271] [100/131] (652s left) syncobj_timeline (etime-multi-wait-available-unsubmitted)
[378.264967] Starting subtest: etime-multi-wait-available-unsubmitted
[378.373504] Subtest etime-multi-wait-available-unsubmitted: SUCCESS (0.108s)
[378.465664] [101/131] (652s left) kms_cursor_crc (cursor-onscreen-64x64)
[378.658626] Starting subtest: cursor-onscreen-64x64
[378.660811] Starting dynamic subtest: pipe-A-eDP-1
[380.745787] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.085s)
[380.778207] Starting dynamic subtest: pipe-D-eDP-1
[383.608751] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.842s)
[383.610970] Subtest cursor-onscreen-64x64: SUCCESS (4.952s)
[384.413660] [102/131] (646s left) gem_ctx_persistence (idempotent)
[384.472627] Starting subtest: idempotent
[384.474821] Subtest idempotent: SUCCESS (0.000s)
[384.571360] [103/131] (646s left) kms_addfb_basic (bad-pitch-0)
[384.623546] Starting subtest: bad-pitch-0
[384.625495] Subtest bad-pitch-0: SUCCESS (0.000s)
[384.766669] [104/131] (646s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[384.859560] Starting subtest: fbc-rgb101010-draw-mmap-wc
[389.430513] Subtest fbc-rgb101010-draw-mmap-wc: SUCCESS (4.574s)
[390.614054] [105/131] (640s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[390.730470] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[397.975646] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.251s)
[398.125680] [106/131] (632s left) prime_mmap (test_forked_cpu_write)
[398.173742] Starting subtest: test_forked_cpu_write
[398.175639] Starting dynamic subtest: test_forked_cpu_write-smem
[398.181083] Dynamic subtest test_forked_cpu_write-smem: SUCCESS (0.009s)
[398.183397] Subtest test_forked_cpu_write: SUCCESS (0.010s)
[398.277251] [107/131] (632s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[398.378700] Starting subtest: compare-crc-sanitycheck-xr24
[398.380921] Starting dynamic subtest: pipe-A-eDP-1
[398.981832] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.602s)
[398.993345] Starting dynamic subtest: pipe-B-eDP-1
[400.218802] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.237s)
[400.230667] Starting dynamic subtest: pipe-C-eDP-1
[401.458100] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.237s)
[401.475397] Starting dynamic subtest: pipe-D-eDP-1
[402.684151] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.224s)
[402.686058] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.306s)
[403.511164] [108/131] (627s left) kms_pipe_crc_basic (bad-source)
[403.609750] Starting subtest: bad-source
[403.611631] Subtest bad-source: SUCCESS (0.000s)
[403.680289] [109/131] (627s left) gem_mmap_gtt (big-copy-xy)
[403.747554] Subtest big-copy-XY: SKIP (0.000s)
[403.803378] [110/131] (627s left) kms_cursor_crc (cursor-suspend)
[403.931474] Starting subtest: cursor-suspend
[403.934309] Starting dynamic subtest: pipe-A-eDP-1
[436.687457] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.192s)
[436.699084] Starting dynamic subtest: pipe-D-eDP-1
[470.683120] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.745s)
[470.685287] Subtest cursor-suspend: SUCCESS (6.941s)
[471.466050] [111/131] (559s left) i915_pm_rps (thresholds)
[471.527364] Starting subtest: thresholds
[471.531747] Subtest thresholds: SKIP (0.001s)
[471.635797] [112/131] (559s left) gem_spin_batch (legacy-resubmit-new)
[471.690983] Starting subtest: legacy-resubmit-new
[471.693114] Starting dynamic subtest: default
[471.698081] Dynamic subtest default: SUCCESS (0.007s)
[471.709396] Starting dynamic subtest: render
[471.711443] Dynamic subtest render: SUCCESS (0.003s)
[471.721444] Starting dynamic subtest: bsd
[471.723618] Dynamic subtest bsd: SUCCESS (0.005s)
[471.733540] Starting dynamic subtest: bsd1
[471.735336] Dynamic subtest bsd1: SUCCESS (0.005s)
[471.744539] Starting dynamic subtest: bsd2
[471.746383] Dynamic subtest bsd2: SUCCESS (0.004s)
[471.755439] Starting dynamic subtest: blt
[471.757336] Dynamic subtest blt: SUCCESS (0.004s)
[471.766540] Starting dynamic subtest: vebox
[471.768407] Dynamic subtest vebox: SUCCESS (0.004s)
[471.770252] Subtest legacy-resubmit-new: SUCCESS (0.040s)
[472.994158] [113/131] (558s left) api_intel_bb (render-ccs)
[473.064163] Starting subtest: render-ccs
[473.438078] Subtest render-ccs: SUCCESS (0.380s)
[473.573388] [114/131] (557s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite)
[473.681329] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite
[473.685626] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[473.783664] [115/131] (557s left) kms_psr2_sf (pr-overlay-plane-update-continuous-sf)
[473.889514] Starting subtest: pr-overlay-plane-update-continuous-sf
[473.893594] Subtest pr-overlay-plane-update-continuous-sf: SKIP (0.000s)
[473.966238] [116/131] (557s left) kms_psr (fbc-psr-primary-mmap-gtt)
[474.059026] Starting subtest: fbc-psr-primary-mmap-gtt
[474.060889] Starting dynamic subtest: eDP-1
[474.064982] Dynamic subtest eDP-1: SKIP (0.000s)
[474.068966] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s)
[474.146451] [117/131] (557s left) gem_render_copy (y-tiled-ccs-to-y-tiled-ccs)
[474.201818] Starting subtest: y-tiled-ccs-to-y-tiled-ccs
[474.206343] Subtest y-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s)
[474.382907] [118/131] (557s left) kms_big_fb (x-tiled-8bpp-rotate-0)
[474.493211] Starting subtest: x-tiled-8bpp-rotate-0
[475.670821] Subtest x-tiled-8bpp-rotate-0: SUCCESS (1.191s)
[475.784251] [119/131] (555s left) prime_mmap (test_refcounting)
[475.841226] Starting subtest: test_refcounting
[475.843451] Starting dynamic subtest: test_refcounting-smem
[475.869168] Dynamic subtest test_refcounting-smem: SUCCESS (0.031s)
[475.871221] Subtest test_refcounting: SUCCESS (0.032s)
[475.969325] [120/131] (555s left) syncobj_wait (reset-multiple-signaled)
[476.022448] Starting subtest: reset-multiple-signaled
[476.024504] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[476.127115] [121/131] (555s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[476.231989] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[480.670541] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (4.476s)
[481.873414] [122/131] (549s left) i915_pm_rpm (gem-idle)
[484.100474] Starting subtest: gem-idle
[490.299711] Subtest gem-idle: SUCCESS (6.219s)
[490.628423] [123/131] (540s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen)
[491.911230] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen
[491.915366] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[492.021734] [124/131] (539s left) api_intel_allocator (fork-simple-once)
[492.083927] Starting subtest: fork-simple-once
[492.099355] Subtest fork-simple-once: SUCCESS (0.018s)
[492.224171] [125/131] (539s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move)
[492.323919] Starting subtest: psr-2p-primscrn-spr-indfb-move
[492.327984] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[492.421670] [126/131] (539s left) gen9_exec_parse (unaligned-access)
[492.476655] Subtest unaligned-access: SKIP (0.000s)
[492.548929] [127/131] (539s left) gen7_exec_parse (basic-rejected)
[492.598707] Subtest basic-rejected: SKIP (0.000s)
[492.676195] [128/131] (539s left) gem_ctx_isolation (clean)
[492.740320] Starting subtest: clean
[492.742814] Starting dynamic subtest: rcs0
[492.785139] Dynamic subtest rcs0: SUCCESS (0.045s)
[492.796943] Starting dynamic subtest: bcs0
[492.860683] Dynamic subtest bcs0: SUCCESS (0.074s)
[492.873125] Starting dynamic subtest: vcs0
[492.911726] Dynamic subtest vcs0: SUCCESS (0.051s)
[492.923024] Starting dynamic subtest: vcs1
[494.987237] Dynamic subtest vcs1: SUCCESS (2.077s)
[495.000010] Starting dynamic subtest: vecs0
[496.952851] Dynamic subtest vecs0: SUCCESS (1.967s)
[496.965566] Starting dynamic subtest: ccs0
[498.942695] Dynamic subtest ccs0: SUCCESS (1.991s)
[498.945352] Subtest clean: SUCCESS (6.211s)
[499.178094] [129/131] (532s left) kms_psr (fbc-pr-cursor-mmap-cpu)
[499.276892] Starting subtest: fbc-pr-cursor-mmap-cpu
[499.281442] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s)
[499.352078] [130/131] (532s left) gem_exec_parallel (userptr)
[499.419396] Starting subtest: userptr
[499.421753] Starting dynamic subtest: rcs0
[500.826608] Dynamic subtest rcs0: SUCCESS (1.407s)
[500.837269] Starting dynamic subtest: bcs0
[502.287563] Dynamic subtest bcs0: SUCCESS (1.457s)
[502.301252] Starting dynamic subtest: vcs0
[503.944372] Dynamic subtest vcs0: SUCCESS (1.653s)
[503.955002] Starting dynamic subtest: vcs1
[505.916328] Dynamic subtest vcs1: SUCCESS (1.967s)
[505.927725] Starting dynamic subtest: vecs0
[507.963502] Dynamic subtest vecs0: SUCCESS (2.043s)
[507.975348] Starting dynamic subtest: ccs0
[509.449361] Dynamic subtest ccs0: SUCCESS (1.483s)
[509.451712] Subtest userptr: SUCCESS (10.024s)
[509.639153] [131/131] (522s left) gem_exec_schedule (submit-early-slice)
[509.709505] Starting subtest: submit-early-slice
[509.711448] Starting dynamic subtest: rcs0
[509.772589] Dynamic subtest rcs0: SUCCESS (0.069s)
[509.787361] Starting dynamic subtest: bcs0
[509.825407] Dynamic subtest bcs0: SUCCESS (0.053s)
[509.837639] Starting dynamic subtest: vcs0
[509.882947] Dynamic subtest vcs0: SUCCESS (0.057s)
[509.894506] Starting dynamic subtest: vcs1
[509.947183] Dynamic subtest vcs1: SUCCESS (0.062s)
[509.959861] Starting dynamic subtest: vecs0
[509.994536] Dynamic subtest vecs0: SUCCESS (0.047s)
[510.004848] Starting dynamic subtest: ccs0
[510.053110] Dynamic subtest ccs0: SUCCESS (0.057s)
[510.055435] Subtest submit-early-slice: SUCCESS (0.351s)
[510.992898] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_whisper
results: parsing output: 1/ for test: kms_big_fb
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_flip
results: parsing output: 4/ for test: kms_ccs
results: parsing output: 5/ for test: sysfs_timeslice_duration
results: parsing output: 6/ for test: gem_exec_async
results: parsing output: 7/ for test: kms_feature_discovery
results: parsing output: 8/ for test: gem_set_tiling_vs_blt
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: i915_hangman
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: gem_close_race
results: parsing output: 14/ for test: gem_mmap_gtt
results: parsing output: 15/ for test: gem_exec_fence
results: parsing output: 16/ for test: kms_chamelium_hpd
results: parsing output: 17/ for test: perf_pmu
results: parsing output: 18/ for test: kms_plane
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: kms_plane
results: parsing output: 21/ for test: kms_psr
results: parsing output: 22/ for test: kms_addfb_basic
results: parsing output: 23/ for test: kms_big_fb
results: parsing output: 24/ for test: syncobj_timeline
results: parsing output: 25/ for test: kms_psr
results: parsing output: 26/ for test: syncobj_timeline
results: parsing output: 27/ for test: gem_exec_balancer
results: parsing output: 28/ for test: prime_busy
results: parsing output: 29/ for test: gem_ctx_param
results: parsing output: 30/ for test: kms_addfb_basic
results: parsing output: 31/ for test: gem_exec_schedule
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_flip_scaled_crc
results: parsing output: 34/ for test: gem_userptr_blits
results: parsing output: 35/ for test: kms_big_fb
results: parsing output: 36/ for test: gem_exec_flush
results: parsing output: 37/ for test: dumb_buffer
results: parsing output: 38/ for test: kms_hdr
results: parsing output: 39/ for test: kms_content_protection
results: parsing output: 40/ for test: gem_wait
results: parsing output: 41/ for test: kms_big_fb
results: parsing output: 42/ for test: kms_plane_scaling
results: parsing output: 43/ for test: kms_force_connector_basic
results: parsing output: 44/ for test: kms_big_fb
results: parsing output: 45/ for test: kms_flip
results: parsing output: 46/ for test: gem_userptr_blits
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: kms_flip
results: parsing output: 49/ for test: kms_psr
results: parsing output: 50/ for test: kms_ccs
results: parsing output: 51/ for test: kms_color_pipeline
results: parsing output: 52/ for test: gem_mmap
results: parsing output: 53/ for test: kms_async_flips
results: parsing output: 54/ for test: kms_cursor_crc
results: parsing output: 55/ for test: gem_exec_balancer
results: parsing output: 56/ for test: gem_eio
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: gem_userptr_blits
results: parsing output: 59/ for test: prime_mmap
results: parsing output: 60/ for test: kms_invalid_mode
results: parsing output: 61/ for test: gem_render_copy
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: gem_mmap
results: parsing output: 64/ for test: gem_ctx_exec
results: parsing output: 65/ for test: perf
results: parsing output: 66/ for test: kms_tv_load_detect
results: parsing output: 67/ for test: gem_lmem_evict
results: parsing output: 68/ for test: kms_vblank
results: parsing output: 69/ for test: gem_mmap_offset
results: parsing output: 70/ for test: gem_pxp
results: parsing output: 71/ for test: kms_ccs
results: parsing output: 72/ for test: syncobj_eventfd
results: parsing output: 73/ for test: gem_sync
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: syncobj_timeline
results: parsing output: 76/ for test: kms_properties
results: parsing output: 77/ for test: gem_mmap_wc
results: parsing output: 78/ for test: kms_display_modes
results: parsing output: 79/ for test: kms_big_fb
results: parsing output: 80/ for test: kms_ccs
results: parsing output: 81/ for test: kms_flip
results: parsing output: 82/ for test: gem_pxp
results: parsing output: 83/ for test: gem_flink_basic
results: parsing output: 84/ for test: kms_pm_dc
results: parsing output: 85/ for test: kms_plane_scaling
results: parsing output: 86/ for test: kms_legacy_colorkey
results: parsing output: 87/ for test: syncobj_basic
results: parsing output: 88/ for test: fbdev
results: parsing output: 89/ for test: kms_flip_scaled_crc
results: parsing output: 90/ for test: kms_atomic_transition
results: parsing output: 91/ for test: perf
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: gem_exec_flush
results: parsing output: 94/ for test: kms_chamelium_color
results: parsing output: 95/ for test: kms_chamelium_edid
results: parsing output: 96/ for test: kms_async_flips
results: parsing output: 97/ for test: kms_vrr
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: syncobj_timeline
results: parsing output: 100/ for test: kms_cursor_crc
results: parsing output: 101/ for test: gem_ctx_persistence
results: parsing output: 102/ for test: kms_addfb_basic
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: prime_mmap
results: parsing output: 106/ for test: kms_pipe_crc_basic
results: parsing output: 107/ for test: kms_pipe_crc_basic
results: parsing output: 108/ for test: gem_mmap_gtt
results: parsing output: 109/ for test: kms_cursor_crc
results: parsing output: 110/ for test: i915_pm_rps
results: parsing output: 111/ for test: gem_spin_batch
results: parsing output: 112/ for test: api_intel_bb
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_psr2_sf
results: parsing output: 115/ for test: kms_psr
results: parsing output: 116/ for test: gem_render_copy
results: parsing output: 117/ for test: kms_big_fb
results: parsing output: 118/ for test: prime_mmap
results: parsing output: 119/ for test: syncobj_wait
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: i915_pm_rpm
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: api_intel_allocator
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: gen9_exec_parse
results: parsing output: 126/ for test: gen7_exec_parse
results: parsing output: 127/ for test: gem_ctx_isolation
results: parsing output: 128/ for test: kms_psr
results: parsing output: 129/ for test: gem_exec_parallel
results: parsing output: 130/ for test: gem_exec_schedule
Done.