[71.131904] Initializing watchdogs
[71.131948]   /dev/watchdog0
[71.146835] [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]
[71.151157] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[71.153383] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[71.156323] [001/156] (960s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-pwrite)
[71.293215] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-pwrite
[78.941107] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.656s)
[79.076604] [002/156] (952s left) kms_psr (fbc-psr-primary-mmap-gtt)
[79.175982] Starting subtest: fbc-psr-primary-mmap-gtt
[79.178105] Starting dynamic subtest: eDP-1
[79.182197] Dynamic subtest eDP-1: SKIP (0.000s)
[79.186364] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.000s)
[79.253458] [003/156] (952s left) dmabuf_sync_file (import-multiple-read-only)
[79.312883] Starting subtest: import-multiple-read-only
[79.315595] Subtest import-multiple-read-only: SUCCESS (0.002s)
[79.366639] [FACT dmabuf_sync_file (import-multiple-read-only)] new: kernel.kmod_is_loaded.vgem: true
[79.370884] [004/156] (952s left) kms_plane_scaling (planes-downscale-factor-0-5)
[79.467246] Starting subtest: planes-downscale-factor-0-5
[79.469665] Starting dynamic subtest: pipe-A
[79.487811] Dynamic subtest pipe-A: SKIP (0.017s)
[79.499684] Starting dynamic subtest: pipe-B
[79.521935] Dynamic subtest pipe-B: SKIP (0.034s)
[79.529776] Starting dynamic subtest: pipe-C
[79.556233] Dynamic subtest pipe-C: SKIP (0.034s)
[79.563505] Starting dynamic subtest: pipe-D
[79.590272] Dynamic subtest pipe-D: SKIP (0.034s)
[79.594562] Subtest planes-downscale-factor-0-5: SKIP (0.120s)
[79.696796] [005/156] (952s left) kms_chamelium_frames (hdmi-crc-nonplanar-formats)
[80.088045] Subtest hdmi-crc-nonplanar-formats: SKIP (0.000s)
[80.893127] [006/156] (950s left) api_intel_allocator (reserve-simple)
[80.952943] Starting subtest: reserve-simple
[80.955447] Subtest reserve-simple: SUCCESS (0.003s)
[81.076742] [007/156] (950s left) kms_cursor_crc (cursor-rapid-movement-32x32)
[81.233437] Starting subtest: cursor-rapid-movement-32x32
[81.282176] Subtest cursor-rapid-movement-32x32: SKIP (0.045s)
[81.570341] [008/156] (950s left) prime_mmap (test_correct)
[81.624219] Starting subtest: test_correct
[81.626037] Starting dynamic subtest: test_correct-smem
[81.654053] Dynamic subtest test_correct-smem: SUCCESS (0.032s)
[81.656789] Subtest test_correct: SUCCESS (0.032s)
[81.757016] [009/156] (950s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[81.844528] Starting subtest: compare-crc-sanitycheck-xr24
[81.846542] Starting dynamic subtest: pipe-A-eDP-1
[82.466731] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.623s)
[82.476771] Starting dynamic subtest: pipe-B-eDP-1
[83.772533] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.305s)
[83.780903] Starting dynamic subtest: pipe-C-eDP-1
[84.987767] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.215s)
[84.995471] Starting dynamic subtest: pipe-D-eDP-1
[86.189811] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.202s)
[86.192274] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.347s)
[87.053878] [010/156] (944s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[87.158420] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip
[88.281168] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.124s)
[88.389033] [011/156] (943s left) gem_ctx_param (set-priority-not-supported)
[88.444146] Starting subtest: set-priority-not-supported
[88.448057] Subtest set-priority-not-supported: SKIP (0.000s)
[88.520066] [012/156] (943s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[88.608830] Starting subtest: fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-cpu
[88.612312] Subtest fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[88.697714] [013/156] (943s left) kms_flip (2x-absolute-wf_vblank-interruptible)
[88.782553] Starting subtest: 2x-absolute-wf_vblank-interruptible
[88.794235] Subtest 2x-absolute-wf_vblank-interruptible: SKIP (0.011s)
[88.894124] [014/156] (943s left) prime_self_import (basic-llseek-size)
[88.923874] Starting subtest: basic-llseek-size
[88.950500] Subtest basic-llseek-size: SUCCESS (0.026s)
[89.062650] [015/156] (943s left) kms_invalid_mode (bad-htotal)
[89.150127] Starting subtest: bad-htotal
[89.152062] Starting dynamic subtest: pipe-A-eDP-1
[89.440398] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.291s)
[89.448765] Starting dynamic subtest: pipe-B-eDP-1
[89.450680] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[89.457734] Starting dynamic subtest: pipe-C-eDP-1
[89.459655] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[89.467171] Starting dynamic subtest: pipe-D-eDP-1
[89.469401] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[89.471621] Subtest bad-htotal: SUCCESS (0.295s)
[90.262796] [016/156] (941s left) kms_color_pipeline (plane-lut1d-post-ctm3x4)
[90.362114] Starting subtest: plane-lut1d-post-ctm3x4
[90.509620] Starting dynamic subtest: pipe-A-plane-0
[90.652988] Dynamic subtest pipe-A-plane-0: SUCCESS (0.144s)
[90.662071] Starting dynamic subtest: pipe-A-plane-1
[90.787140] Dynamic subtest pipe-A-plane-1: SUCCESS (0.133s)
[90.795446] Starting dynamic subtest: pipe-A-plane-2
[90.919090] Dynamic subtest pipe-A-plane-2: SUCCESS (0.133s)
[92.187497] Starting dynamic subtest: pipe-B-plane-0
[92.326846] Dynamic subtest pipe-B-plane-0: SUCCESS (0.144s)
[92.336110] Starting dynamic subtest: pipe-B-plane-1
[92.459669] Dynamic subtest pipe-B-plane-1: SUCCESS (0.133s)
[92.467397] Starting dynamic subtest: pipe-B-plane-2
[92.593161] Dynamic subtest pipe-B-plane-2: SUCCESS (0.133s)
[93.786233] Starting dynamic subtest: pipe-C-plane-0
[93.911035] Dynamic subtest pipe-C-plane-0: SUCCESS (0.133s)
[93.919574] Starting dynamic subtest: pipe-C-plane-1
[94.070054] Dynamic subtest pipe-C-plane-1: SUCCESS (0.155s)
[94.077986] Starting dynamic subtest: pipe-C-plane-2
[94.211154] Dynamic subtest pipe-C-plane-2: SUCCESS (0.143s)
[95.410898] Starting dynamic subtest: pipe-D-plane-0
[95.539058] Dynamic subtest pipe-D-plane-0: SUCCESS (0.133s)
[95.548975] Starting dynamic subtest: pipe-D-plane-1
[95.671926] Dynamic subtest pipe-D-plane-1: SUCCESS (0.133s)
[95.680473] Starting dynamic subtest: pipe-D-plane-2
[95.805277] Dynamic subtest pipe-D-plane-2: SUCCESS (0.133s)
[96.092218] Subtest plane-lut1d-post-ctm3x4: SUCCESS (5.729s)
[96.911123] [017/156] (935s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[97.034058] Starting subtest: cursorB-vs-flipB-toggle
[97.038805] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s)
[97.175666] [018/156] (935s left) kms_flip (flip-vs-rmfb-interruptible)
[97.265026] Starting subtest: flip-vs-rmfb-interruptible
[97.267358] Starting dynamic subtest: A-eDP1
[105.897818] Dynamic subtest A-eDP1: SUCCESS (8.633s)
[105.909225] Starting dynamic subtest: B-eDP1
[114.522857] Dynamic subtest B-eDP1: SUCCESS (8.623s)
[114.532447] Starting dynamic subtest: C-eDP1
[123.138336] Dynamic subtest C-eDP1: SUCCESS (8.613s)
[123.147549] Starting dynamic subtest: D-eDP1
[131.769318] Dynamic subtest D-eDP1: SUCCESS (8.629s)
[131.773639] Subtest flip-vs-rmfb-interruptible: SUCCESS (34.508s)
[132.946082] [019/156] (899s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[133.038242] Starting subtest: psr-rgb565-draw-render
[140.209094] Subtest psr-rgb565-draw-render: SUCCESS (7.177s)
[140.323697] [020/156] (892s left) syncobj_eventfd (binary-wait)
[140.373976] Starting subtest: binary-wait
[140.384236] Subtest binary-wait: SUCCESS (0.010s)
[140.456168] [021/156] (891s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-plflip-blt)
[140.549940] Starting subtest: psr-2p-scndscrn-shrfb-plflip-blt
[140.554293] Subtest psr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[140.645427] [022/156] (891s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-shrfb-draw-blt)
[140.747381] Starting subtest: hdr-2p-primscrn-pri-shrfb-draw-blt
[140.751401] Subtest hdr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[140.842030] [023/156] (891s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-shrfb-pgflip-blt)
[140.938775] Starting subtest: fbchdr-2p-primscrn-shrfb-pgflip-blt
[140.943163] Subtest fbchdr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[141.038937] [024/156] (891s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[141.130338] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[141.133685] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[141.206093] [025/156] (891s left) gem_spin_batch (resubmit-new)
[141.268074] Starting subtest: resubmit-new
[141.270162] Starting dynamic subtest: rcs0
[141.275699] Dynamic subtest rcs0: SUCCESS (0.007s)
[141.284377] Starting dynamic subtest: bcs0
[141.286262] Dynamic subtest bcs0: SUCCESS (0.004s)
[141.293888] Starting dynamic subtest: vcs0
[141.295993] Dynamic subtest vcs0: SUCCESS (0.003s)
[141.303726] Starting dynamic subtest: vcs1
[141.305488] Dynamic subtest vcs1: SUCCESS (0.004s)
[141.312190] Starting dynamic subtest: vecs0
[141.313969] Dynamic subtest vecs0: SUCCESS (0.004s)
[141.320812] Starting dynamic subtest: ccs0
[141.322598] Dynamic subtest ccs0: SUCCESS (0.004s)
[141.324356] Subtest resubmit-new: SUCCESS (0.030s)
[143.333889] [026/156] (889s left) prime_mmap_coherency (ioctl-errors)
[143.386719] Starting subtest: ioctl-errors
[158.167544] Subtest ioctl-errors: SUCCESS (14.781s)
[158.386133] [027/156] (874s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[158.542088] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu
[162.891074] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (4.355s)
[164.077160] [028/156] (868s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-shrfb-msflip-blt)
[164.176240] Starting subtest: fbcpsrhdr-2p-scndscrn-shrfb-msflip-blt
[164.180214] Subtest fbcpsrhdr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[164.282171] [029/156] (868s left) kms_flip (2x-flip-vs-modeset-vs-hang)
[164.376446] Starting subtest: 2x-flip-vs-modeset-vs-hang
[164.380901] Subtest 2x-flip-vs-modeset-vs-hang: SKIP (0.002s)
[164.489961] [030/156] (868s left) perf_pmu (enable-race)
[164.531109] Starting subtest: enable-race
[164.533402] Starting dynamic subtest: rcs0
[177.300563] Dynamic subtest rcs0: SUCCESS (12.768s)
[177.310663] Starting dynamic subtest: bcs0
[190.041989] Dynamic subtest bcs0: SUCCESS (12.739s)
[190.051779] Starting dynamic subtest: vcs0
[205.311048] Dynamic subtest vcs0: SUCCESS (15.264s)
[205.321876] Starting dynamic subtest: vcs1
[221.311880] Dynamic subtest vcs1: SUCCESS (15.999s)
[221.323095] Starting dynamic subtest: vecs0
[237.247808] Dynamic subtest vecs0: SUCCESS (15.933s)
[237.257302] Starting dynamic subtest: ccs0
[249.993133] Dynamic subtest ccs0: SUCCESS (12.744s)
[249.996356] Subtest enable-race: SUCCESS (85.461s)
[250.092607] [031/156] (782s left) kms_getfb (getfb-handle-closed)
[250.187924] Starting subtest: getfb-handle-closed
[250.190250] Subtest getfb-handle-closed: SUCCESS (0.000s)
[250.276491] [032/156] (782s left) core_getclient (basic)
[250.321748] Starting subtest: basic
[250.324068] Subtest basic: SUCCESS (0.000s)
[250.431339] [033/156] (782s left) gem_exec_schedule (pi-userfault)
[250.613355] Starting subtest: pi-userfault
[250.615730] Starting dynamic subtest: rcs0
[250.623255] Dynamic subtest rcs0: SUCCESS (0.013s)
[250.633165] Starting dynamic subtest: bcs0
[250.635364] Dynamic subtest bcs0: SUCCESS (0.007s)
[250.643403] Starting dynamic subtest: vcs0
[250.645671] Dynamic subtest vcs0: SUCCESS (0.011s)
[250.654045] Starting dynamic subtest: vcs1
[250.655959] Dynamic subtest vcs1: SUCCESS (0.007s)
[250.664367] Starting dynamic subtest: vecs0
[250.666612] Dynamic subtest vecs0: SUCCESS (0.009s)
[250.674507] Starting dynamic subtest: ccs0
[250.676361] Dynamic subtest ccs0: SUCCESS (0.005s)
[250.678330] Subtest pi-userfault: SUCCESS (0.058s)
[250.848508] [034/156] (782s left) gem_pxp (create-protected-buffer)
[250.980549] Starting subtest: create-protected-buffer
[250.982967] Subtest create-protected-buffer: SUCCESS (0.000s)
[251.084701] [035/156] (781s left) syncobj_timeline (invalid-transfer-illegal-handle)
[251.132043] Starting subtest: invalid-transfer-illegal-handle
[251.134406] Subtest invalid-transfer-illegal-handle: SUCCESS (0.000s)
[251.232626] [036/156] (781s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[251.326262] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc
[251.328618] Starting dynamic subtest: pipe-A-eDP-1
[251.348692] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[251.358350] Starting dynamic subtest: pipe-B-eDP-1
[251.377772] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[251.385975] Starting dynamic subtest: pipe-C-eDP-1
[251.405691] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[251.413704] Starting dynamic subtest: pipe-D-eDP-1
[251.433215] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[251.435419] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.007s)
[253.633232] [037/156] (779s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[253.724657] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[253.735619] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.011s)
[253.822240] [038/156] (779s left) gem_fenced_exec_thrash (no-spare-fences-busy-interruptible)
[253.886507] Subtest no-spare-fences-busy-interruptible: SKIP (0.000s)
[253.946487] [039/156] (779s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-spr-indfb-onoff)
[254.048545] Starting subtest: fbcpsrhdr-2p-scndscrn-spr-indfb-onoff
[254.052728] Subtest fbcpsrhdr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[254.148038] [040/156] (779s left) i915_pm_rps (thresholds-idle-park)
[254.204703] Starting subtest: thresholds-idle-park
[254.209083] Subtest thresholds-idle-park: SKIP (0.001s)
[254.304179] [041/156] (778s left) kms_psr (fbc-psr2-primary-render)
[254.400427] Starting subtest: fbc-psr2-primary-render
[254.402741] Starting dynamic subtest: eDP-1
[254.407187] Dynamic subtest eDP-1: SKIP (0.000s)
[254.411547] Subtest fbc-psr2-primary-render: SKIP (0.001s)
[254.474591] [042/156] (778s left) gem_pxp (verify-pxp-stale-buf-execution)
[254.540641] Starting subtest: verify-pxp-stale-buf-execution
[255.603788] Subtest verify-pxp-stale-buf-execution: SUCCESS (1.062s)
[255.723321] [043/156] (777s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-blt)
[255.813377] Starting subtest: psr-1p-primscrn-cur-indfb-draw-blt
[262.604450] Subtest psr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (6.796s)
[262.717067] [044/156] (770s left) kms_prime (basic-crc-vgem)
[262.803167] Starting subtest: basic-crc-vgem
[262.805373] Starting dynamic subtest: second-to-first
[263.789763] Dynamic subtest second-to-first: SUCCESS (0.990s)
[263.791721] Subtest basic-crc-vgem: SUCCESS (0.991s)
[263.891950] [045/156] (769s left) kms_async_flips (test-time-stamp)
[264.013393] Starting subtest: test-time-stamp
[264.394060] Starting dynamic subtest: pipe-A-eDP-1
[265.170426] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.774s)
[265.548522] Starting dynamic subtest: pipe-B-eDP-1
[266.401930] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.860s)
[266.790756] Starting dynamic subtest: pipe-C-eDP-1
[267.645378] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.861s)
[268.021425] Starting dynamic subtest: pipe-D-eDP-1
[268.784925] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.768s)
[268.787323] Subtest test-time-stamp: SUCCESS (4.771s)
[269.954452] [046/156] (763s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite)
[270.047763] Starting subtest: fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite
[270.052129] Subtest fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[270.152762] [047/156] (763s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc)
[270.244151] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc
[270.248357] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[270.345290] [048/156] (763s left) vgem_basic (dmabuf-fence)
[270.387751] Starting subtest: dmabuf-fence
[270.389577] Subtest dmabuf-fence: SUCCESS (0.000s)
[270.442980] [049/156] (763s left) i915_pm_rpm (gem-pread)
[272.497282] Starting subtest: gem-pread
[274.563714] Subtest gem-pread: SUCCESS (2.069s)
[274.650787] [050/156] (758s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-indfb-plflip-blt)
[274.750340] Starting subtest: hdr-2p-scndscrn-indfb-plflip-blt
[274.754564] Subtest hdr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[274.833429] [051/156] (758s left) gem_tiled_wb
[274.958833] [052/156] (758s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-cur-indfb-onoff)
[275.054579] Starting subtest: fbchdr-1p-primscrn-cur-indfb-onoff
[275.058695] Subtest fbchdr-1p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[275.161928] [053/156] (758s left) gem_exec_suspend (basic-s0)
[275.219566] Starting subtest: basic-S0
[275.221911] Starting dynamic subtest: smem
[296.265570] Dynamic subtest smem: SUCCESS (8.045s)
[296.268643] Subtest basic-S0: SUCCESS (8.048s)
[296.451591] [054/156] (737s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[296.579856] Starting subtest: hdr-1p-offscreen-pri-shrfb-draw-mmap-wc
[296.583948] Subtest hdr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[296.674903] [055/156] (737s left) sw_sync (sync_multi_timeline_wait)
[296.713740] Starting subtest: sync_multi_timeline_wait
[296.716073] Subtest sync_multi_timeline_wait: SUCCESS (0.000s)
[296.774442] [056/156] (737s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[296.868016] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[296.870226] Starting dynamic subtest: pipe-A-eDP-1
[296.893260] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[296.905888] Starting dynamic subtest: pipe-B-eDP-1
[296.927938] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[296.936833] Starting dynamic subtest: pipe-C-eDP-1
[296.958652] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[296.967282] Starting dynamic subtest: pipe-D-eDP-1
[296.989134] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[296.993493] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.009s)
[299.127694] [057/156] (734s left) core_setmaster_vs_auth
[299.282794] [058/156] (734s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-wc)
[299.384168] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-wc
[299.388255] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[299.475478] [059/156] (734s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[299.578388] Starting subtest: fbcpsrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt
[299.582616] Subtest fbcpsrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[299.691741] [060/156] (734s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[299.790718] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[299.795123] Subtest fbchdr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[299.898733] [061/156] (734s left) gem_mmap_gtt (medium-copy)
[299.954635] Subtest medium-copy: SKIP (0.000s)
[300.023697] [062/156] (734s left) dumb_buffer (map-valid)
[300.091764] Starting subtest: map-valid
[300.093767] Subtest map-valid: SUCCESS (0.000s)
[300.188798] [063/156] (733s left) kms_big_fb (4-tiled-16bpp-rotate-90)
[300.291140] Starting subtest: 4-tiled-16bpp-rotate-90
[300.310984] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.019s)
[300.425145] [064/156] (733s left) kms_content_protection (lic-type-1)
[300.554052] Starting subtest: lic-type-1
[300.557991] Subtest lic-type-1: SKIP (0.000s)
[300.679106] [065/156] (733s left) syncobj_timeline (host-signal-ordered)
[300.732784] Starting subtest: host-signal-ordered
[300.734837] Subtest host-signal-ordered: SUCCESS (0.000s)
[300.824422] [066/156] (733s left) gem_exec_reloc (basic-range-active)
[300.890317] Subtest basic-range-active: SKIP (0.000s)
[300.965719] [067/156] (733s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[301.057669] Starting subtest: hdr-2p-scndscrn-spr-indfb-draw-mmap-wc
[301.061051] Subtest hdr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[301.162577] [068/156] (733s left) gem_mmap_gtt (cpuset-big-copy)
[301.216992] Subtest cpuset-big-copy: SKIP (0.000s)
[301.282751] [069/156] (733s left) kms_chamelium_color (ctm-0-25)
[301.378760] Subtest ctm-0-25: SKIP (0.000s)
[301.422891] [070/156] (732s left) sysfs_heartbeat_interval (nopreempt)
[301.484986] Starting subtest: nopreempt
[301.486851] Starting dynamic subtest: vecs0
[311.305373] Dynamic subtest vecs0: SUCCESS (9.818s)
[311.317319] Starting dynamic subtest: ccs0
[315.288193] Dynamic subtest ccs0: SUCCESS (3.984s)
[315.301449] Starting dynamic subtest: vcs0
[325.314331] Dynamic subtest vcs0: SUCCESS (10.022s)
[325.326992] Starting dynamic subtest: bcs0
[329.193647] Dynamic subtest bcs0: SUCCESS (3.879s)
[329.205973] Starting dynamic subtest: rcs0
[333.225602] Dynamic subtest rcs0: SUCCESS (4.030s)
[333.236885] Starting dynamic subtest: vcs1
[343.313008] Dynamic subtest vcs1: SUCCESS (10.084s)
[343.315707] Subtest nopreempt: SUCCESS (41.830s)
[343.389901] [071/156] (691s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier)
[343.489872] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier
[343.494084] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier: SKIP (0.000s)
[343.571158] [072/156] (690s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[343.669083] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[350.361440] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.697s)
[350.503047] [073/156] (684s left) gem_eio (wait-1us)
[350.696073] Starting subtest: wait-1us
[350.986368] Subtest wait-1us: SUCCESS (0.290s)
[351.135694] [074/156] (683s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs)
[351.217439] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs
[351.219799] Starting dynamic subtest: pipe-A-eDP-1
[351.243073] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[351.255259] Starting dynamic subtest: pipe-B-eDP-1
[351.276219] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[351.286013] Starting dynamic subtest: pipe-C-eDP-1
[351.307144] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[351.316356] Starting dynamic subtest: pipe-D-eDP-1
[351.338192] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[351.342498] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.005s)
[353.503526] [075/156] (681s left) gem_sync (basic-store-all)
[353.578564] Starting subtest: basic-store-all
[357.683479] Subtest basic-store-all: SUCCESS (4.115s)
[357.867122] [076/156] (676s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[357.975716] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[357.980137] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[358.079463] [077/156] (676s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[358.186430] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt
[358.190386] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[358.280903] [078/156] (676s left) gem_exec_schedule (u-submit-early-slice)
[358.348119] Starting subtest: u-submit-early-slice
[358.350084] Starting dynamic subtest: rcs0
[358.383608] Dynamic subtest rcs0: SUCCESS (0.043s)
[358.403126] Starting dynamic subtest: bcs0
[358.425007] Dynamic subtest bcs0: SUCCESS (0.041s)
[358.437679] Starting dynamic subtest: vcs0
[358.465230] Dynamic subtest vcs0: SUCCESS (0.039s)
[358.476594] Starting dynamic subtest: vcs1
[358.504068] Dynamic subtest vcs1: SUCCESS (0.038s)
[358.514486] Starting dynamic subtest: vecs0
[358.540268] Dynamic subtest vecs0: SUCCESS (0.035s)
[358.550136] Starting dynamic subtest: ccs0
[358.585555] Dynamic subtest ccs0: SUCCESS (0.045s)
[358.587927] Subtest u-submit-early-slice: SUCCESS (0.245s)
[360.418347] [079/156] (674s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier)
[360.513067] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier
[360.517569] Subtest pixel-format-4-tiled-lnl-ccs-modifier: SKIP (0.000s)
[360.586129] [080/156] (674s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-cur-indfb-draw-blt)
[360.680773] Starting subtest: psrhdr-1p-primscrn-cur-indfb-draw-blt
[360.684963] Subtest psrhdr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[360.805377] [081/156] (674s left) kms_vrr (seamless-rr-switch-virtual)
[360.892829] Starting subtest: seamless-rr-switch-virtual
[360.899456] Subtest seamless-rr-switch-virtual: SKIP (0.000s)
[360.970952] [082/156] (673s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[361.026974] Starting subtest: single-wait-all-for-submit-signaled
[361.029191] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[361.131633] [083/156] (673s left) kms_scaling_modes (scaling-mode-full-aspect)
[361.224508] Starting subtest: scaling-mode-full-aspect
[361.226425] Starting dynamic subtest: pipe-A-eDP-1
[361.320938] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.098s)
[361.332468] Starting dynamic subtest: pipe-B-eDP-1
[362.525829] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.204s)
[362.538155] Starting dynamic subtest: pipe-C-eDP-1
[363.653522] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.126s)
[363.664463] Starting dynamic subtest: pipe-D-eDP-1
[364.799027] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.144s)
[364.801538] Subtest scaling-mode-full-aspect: SUCCESS (3.578s)
[366.042486] [084/156] (668s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-indfb-msflip-blt)
[366.132138] Starting subtest: fbcpsrhdr-2p-primscrn-indfb-msflip-blt
[366.136585] Subtest fbcpsrhdr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[366.216823] [085/156] (668s left) gem_basic (create-fd-close)
[366.274308] Starting subtest: create-fd-close
[366.278724] Subtest create-fd-close: SUCCESS (0.000s)
[366.380881] [086/156] (668s left) kms_psr (psr2-primary-blt)
[366.472883] Starting subtest: psr2-primary-blt
[366.475118] Starting dynamic subtest: eDP-1
[368.224736] Dynamic subtest eDP-1: SUCCESS (1.752s)
[368.227153] Subtest psr2-primary-blt: SUCCESS (1.753s)
[369.099326] [087/156] (665s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[369.219706] Starting subtest: psrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc
[369.224095] Subtest psrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[369.315145] [088/156] (665s left) gem_userptr_blits (invalid-mmap-offset-unsync)
[369.385622] Subtest invalid-mmap-offset-unsync: SKIP (0.000s)
[369.504003] [089/156] (665s left) kms_chamelium_hpd (dp-hpd-storm)
[369.887668] Subtest dp-hpd-storm: SKIP (0.000s)
[370.701613] [090/156] (664s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-sf)
[370.801580] Starting subtest: pr-cursor-plane-move-continuous-exceed-sf
[370.805799] Subtest pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[370.869607] [091/156] (664s left) syncobj_timeline (multi-wait-signaled)
[370.916461] Starting subtest: multi-wait-signaled
[370.918630] Subtest multi-wait-signaled: SUCCESS (0.000s)
[371.004754] [092/156] (664s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt)
[371.103625] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt
[371.107934] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[371.191775] [093/156] (664s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-pri-indfb-draw-pwrite)
[371.287724] Starting subtest: fbchdr-2p-primscrn-pri-indfb-draw-pwrite
[371.291865] Subtest fbchdr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[371.391638] [094/156] (663s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[371.495713] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[375.997496] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.507s)
[377.135600] [095/156] (658s left) kms_frontbuffer_tracking (hdr-2p-primscrn-indfb-plflip-blt)
[377.258136] Starting subtest: hdr-2p-primscrn-indfb-plflip-blt
[377.262173] Subtest hdr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[377.369826] [096/156] (658s left) kms_frontbuffer_tracking (fbchdr-suspend)
[377.473381] Starting subtest: fbchdr-suspend
[377.477650] Subtest fbchdr-suspend: SKIP (0.000s)
[377.582863] [097/156] (657s left) gem_exec_balancer (bonded-false-hang)
[377.855552] Starting subtest: bonded-false-hang
[377.860309] Subtest bonded-false-hang: SKIP (0.000s)
[377.962645] [098/156] (657s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy)
[378.084484] Starting subtest: 2x-flip-vs-cursor-legacy
[378.089748] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.001s)
[378.233456] [099/156] (657s left) kms_getfb (getfb2-handle-protection)
[378.329200] Starting subtest: getfb2-handle-protection
[378.348246] Subtest getfb2-handle-protection: SUCCESS (0.020s)
[378.440602] [100/156] (657s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[378.528058] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[378.532631] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[379.649997] [101/156] (656s left) kms_pm_backlight (fade)
[379.743982] Starting subtest: fade
[379.795820] Starting dynamic subtest: eDP-1
[382.794106] Dynamic subtest eDP-1: SUCCESS (3.000s)
[382.796475] Subtest fade: SUCCESS (3.051s)
[383.674934] [102/156] (652s left) gem_ctx_persistence (processes)
[383.727984] Starting subtest: processes
[385.282465] Subtest processes: SUCCESS (1.554s)
[385.359746] [103/156] (650s left) kms_prop_blob (invalid-set-prop)
[385.414063] Starting subtest: invalid-set-prop
[385.416382] Subtest invalid-set-prop: SUCCESS (0.000s)
[385.501419] [104/156] (650s left) kms_frontbuffer_tracking (psrhdr-rgb101010-draw-mmap-wc)
[385.597437] Starting subtest: psrhdr-rgb101010-draw-mmap-wc
[385.601516] Subtest psrhdr-rgb101010-draw-mmap-wc: SKIP (0.000s)
[385.696653] [105/156] (650s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-pgflip-blt)
[385.797125] Starting subtest: psr-2p-primscrn-indfb-pgflip-blt
[385.801502] Subtest psr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[385.878394] [106/156] (650s left) kms_pm_rpm (legacy-planes-dpms)
[387.408839] Starting subtest: legacy-planes-dpms
[387.411440] Starting dynamic subtest: plane-65
[396.034555] Dynamic subtest plane-65: SUCCESS (8.627s)
[396.047068] Starting dynamic subtest: plane-95
[404.353595] Dynamic subtest plane-95: SUCCESS (8.315s)
[404.367226] Starting dynamic subtest: plane-125
[413.159742] Dynamic subtest plane-125: SUCCESS (8.802s)
[413.173105] Starting dynamic subtest: plane-135
[421.875573] Dynamic subtest plane-135: SUCCESS (8.712s)
[421.878746] Subtest legacy-planes-dpms: SUCCESS (34.468s)
[422.274642] [107/156] (613s left) kms_flip (flip-vs-fences-interruptible)
[422.376825] Starting subtest: flip-vs-fences-interruptible
[422.381123] Subtest flip-vs-fences-interruptible: SKIP (0.000s)
[422.488562] [108/156] (613s left) gem_exec_fence (syncobj-timeline-export)
[423.048688] Starting subtest: syncobj-timeline-export
[423.054454] Subtest syncobj-timeline-export: SUCCESS (0.007s)
[424.410088] [109/156] (611s left) gen9_exec_parse (unaligned-access)
[424.470426] Subtest unaligned-access: SKIP (0.000s)
[424.542038] [110/156] (611s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-upscaling)
[424.639078] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-upscaling
[424.643612] Subtest flip-32bpp-yftile-to-64bpp-yftile-upscaling: SKIP (0.000s)
[424.728401] [111/156] (611s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-indfb-pgflip-blt)
[424.822629] Starting subtest: psrhdr-2p-primscrn-indfb-pgflip-blt
[424.826726] Subtest psrhdr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[424.910883] [112/156] (611s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite)
[425.023403] Starting subtest: fbcpsr-rgb101010-draw-pwrite
[430.088168] Subtest fbcpsr-rgb101010-draw-pwrite: SUCCESS (5.069s)
[430.225157] [113/156] (605s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-cur-indfb-draw-render)
[430.335021] Starting subtest: psrhdr-2p-primscrn-cur-indfb-draw-render
[430.339252] Subtest psrhdr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[430.433485] [114/156] (605s left) gem_exec_reloc (basic-gtt-cpu)
[430.495749] Subtest basic-gtt-cpu: SKIP (0.000s)
[430.572817] [115/156] (605s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs)
[430.661998] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs
[430.664190] Starting dynamic subtest: pipe-A-eDP-1
[430.687049] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[430.698612] Starting dynamic subtest: pipe-B-eDP-1
[430.718993] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[430.728589] Starting dynamic subtest: pipe-C-eDP-1
[430.749609] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[430.759449] Starting dynamic subtest: pipe-D-eDP-1
[430.781218] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[430.785145] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs: SKIP (0.005s)
[432.967178] [116/156] (603s left) kms_dither (fb-8bpc-vs-panel-8bpc)
[433.067032] Starting subtest: fb-8bpc-vs-panel-8bpc
[433.069235] Starting dynamic subtest: pipe-A-eDP-1
[434.421957] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.356s)
[434.424362] Subtest fb-8bpc-vs-panel-8bpc: SUCCESS (1.357s)
[435.227801] [117/156] (601s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[435.330793] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[436.177652] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.848s)
[436.346524] [118/156] (600s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-indfb-draw-pwrite)
[436.447104] Starting subtest: hdr-1p-primscrn-pri-indfb-draw-pwrite
[436.451498] Subtest hdr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[436.533087] [119/156] (599s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-spr-indfb-move)
[436.634266] Starting subtest: fbchdr-1p-primscrn-spr-indfb-move
[436.638423] Subtest fbchdr-1p-primscrn-spr-indfb-move: SKIP (0.000s)
[436.760919] [120/156] (599s left) kms_3d (basic)
[436.806974] Starting subtest: basic
[439.050054] Subtest basic: SUCCESS (2.246s)
[439.547798] [121/156] (597s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[439.602459] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[439.708029] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.104s)
[439.785415] [122/156] (596s left) kms_big_fb (yf-tiled-64bpp-rotate-0)
[439.880893] Starting subtest: yf-tiled-64bpp-rotate-0
[439.885373] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s)
[439.974761] [123/156] (596s left) syncobj_wait (wait-for-submit-complex)
[440.025644] Starting subtest: wait-for-submit-complex
[440.088261] Subtest wait-for-submit-complex: SUCCESS (0.062s)
[440.165683] [124/156] (596s left) gem_exec_params (rel-constants-invalid-ring)
[440.230639] Starting subtest: rel-constants-invalid-ring
[440.232931] Subtest rel-constants-invalid-ring: SUCCESS (0.000s)
[440.337414] [125/156] (596s left) syncobj_wait (multi-wait-for-submit-signaled)
[440.402772] Starting subtest: multi-wait-for-submit-signaled
[440.405008] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s)
[440.522072] [126/156] (596s left) syncobj_wait (wait-all-snapshot)
[440.581971] Starting subtest: wait-all-snapshot
[440.662863] Subtest wait-all-snapshot: SUCCESS (0.081s)
[440.751048] [127/156] (596s left) kms_cursor_legacy (flip-vs-cursor-crc-legacy)
[440.857524] Starting subtest: flip-vs-cursor-crc-legacy
[441.506930] Subtest flip-vs-cursor-crc-legacy: SUCCESS (0.647s)
[442.357870] [128/156] (594s left) drm_read (empty-block)
[442.506433] Starting subtest: empty-block
[443.507520] Subtest empty-block: SUCCESS (1.001s)
[443.665851] [129/156] (593s left) kms_plane_alpha_blend (constant-alpha-mid)
[443.757064] Starting subtest: constant-alpha-mid
[444.046756] Starting dynamic subtest: pipe-A-eDP-1
[444.944382] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.897s)
[444.955637] Starting dynamic subtest: pipe-D-eDP-1
[446.417118] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.471s)
[446.419801] Subtest constant-alpha-mid: SUCCESS (2.662s)
[447.254569] [130/156] (589s left) kms_frontbuffer_tracking (fbc-stridechange)
[447.360443] Starting subtest: fbc-stridechange
[450.580310] Subtest fbc-stridechange: SUCCESS (3.225s)
[451.778004] [131/156] (585s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180)
[451.875650] Starting subtest: linear-max-hw-stride-32bpp-rotate-180
[452.966567] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.090s)
[453.100249] [132/156] (583s left) gem_mmap_offset (partial-mmap)
[453.154380] Starting subtest: partial-mmap
[453.156179] Starting dynamic subtest: smem0
[453.158036] Dynamic subtest smem0: SUCCESS (0.004s)
[453.160051] Subtest partial-mmap: SUCCESS (0.004s)
[453.294698] [133/156] (583s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[453.384211] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[453.387796] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[453.459354] [134/156] (583s left) kms_psr (fbc-pr-cursor-blt)
[453.546443] Starting subtest: fbc-pr-cursor-blt
[453.550111] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[453.622277] [135/156] (583s left) gem_ctx_sseu (invalid-sseu)
[453.681908] Subtest invalid-sseu: SKIP (0.000s)
[453.751906] [136/156] (583s left) kms_frontbuffer_tracking (psr-1p-rte)
[453.858299] Starting subtest: psr-1p-rte
[459.228236] Subtest psr-1p-rte: SUCCESS (5.375s)
[459.343125] [137/156] (577s left) gem_exec_reloc (basic-gtt-wc)
[459.397536] Subtest basic-gtt-wc: SKIP (0.000s)
[459.467629] [138/156] (577s left) gem_softpin (allocator-basic)
[459.521174] Starting subtest: allocator-basic
[459.592673] Subtest allocator-basic: SUCCESS (0.072s)
[459.710270] [139/156] (577s left) prime_self_import (export-vs-gem_close-race)
[459.743421] Starting subtest: export-vs-gem_close-race
[464.860296] Subtest export-vs-gem_close-race: SUCCESS (5.115s)
[464.942261] [140/156] (572s left) gem_lmem_swapping (parallel-random-engines)
[464.988727] Subtest parallel-random-engines: SKIP (0.000s)
[465.036299] [141/156] (572s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw)
[465.138908] Starting subtest: fbc-2p-pri-indfb-multidraw
[465.142990] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s)
[465.235508] [142/156] (572s left) kms_sequence (get-idle)
[465.331135] Starting subtest: get-idle
[465.333321] Starting dynamic subtest: pipe-A-eDP-1
[467.132866] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.803s)
[467.147359] Starting dynamic subtest: pipe-B-eDP-1
[469.599099] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.463s)
[469.609826] Starting dynamic subtest: pipe-C-eDP-1
[472.080745] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.482s)
[472.092510] Starting dynamic subtest: pipe-D-eDP-1
[474.582819] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.501s)
[474.585317] Subtest get-idle: SUCCESS (9.254s)
[475.460544] [143/156] (562s left) gem_exec_gttfill (engines)
[475.518255] Starting subtest: engines
[475.520637] Starting dynamic subtest: rcs0
[498.314024] Dynamic subtest rcs0: SUCCESS (22.795s)
[498.325959] Starting dynamic subtest: bcs0
[521.602733] Dynamic subtest bcs0: SUCCESS (23.286s)
[521.616451] Starting dynamic subtest: vcs0
[544.967000] Dynamic subtest vcs0: SUCCESS (23.357s)
[544.980302] Starting dynamic subtest: vcs1
[568.279246] Dynamic subtest vcs1: SUCCESS (23.308s)
[568.291118] Starting dynamic subtest: vecs0
[591.586493] Dynamic subtest vecs0: SUCCESS (23.303s)
[591.596648] Starting dynamic subtest: ccs0
[614.952503] Dynamic subtest ccs0: SUCCESS (23.364s)
[614.954748] Subtest engines: SUCCESS (139.428s)
[615.141097] [144/156] (422s left) gem_exec_capture (pi)
[615.252886] Starting subtest: pi
[615.254954] Starting dynamic subtest: rcs0
[619.255309] Dynamic subtest rcs0: SUCCESS (4.005s)
[619.265726] Starting dynamic subtest: bcs0
[623.301882] Dynamic subtest bcs0: SUCCESS (4.045s)
[623.313200] Starting dynamic subtest: vcs0
[627.456833] Dynamic subtest vcs0: SUCCESS (4.154s)
[627.468590] Starting dynamic subtest: vcs1
[631.582461] Dynamic subtest vcs1: SUCCESS (4.124s)
[631.593410] Starting dynamic subtest: vecs0
[635.686745] Dynamic subtest vecs0: SUCCESS (4.102s)
[635.697966] Starting dynamic subtest: ccs0
[639.818106] Dynamic subtest ccs0: SUCCESS (4.129s)
[639.820557] Subtest pi: SUCCESS (24.569s)
[639.897506] [145/156] (397s left) kms_getfb (getfb-handle-not-fb)
[640.051151] Starting subtest: getfb-handle-not-fb
[640.053645] Subtest getfb-handle-not-fb: SUCCESS (0.000s)
[640.149544] [146/156] (397s left) kms_cursor_crc (cursor-onscreen-256x85)
[640.404844] Starting subtest: cursor-onscreen-256x85
[640.452461] Subtest cursor-onscreen-256x85: SKIP (0.041s)
[640.624421] [147/156] (397s left) gem_ctx_persistence (engines-hostile-preempt)
[640.687921] Starting subtest: engines-hostile-preempt
[640.690226] Starting dynamic subtest: rcs0
[640.771902] Dynamic subtest rcs0: SUCCESS (0.083s)
[640.784397] Starting dynamic subtest: bcs0
[640.827493] Dynamic subtest bcs0: SUCCESS (0.054s)
[640.839868] Starting dynamic subtest: vcs0
[642.301596] Dynamic subtest vcs0: SUCCESS (1.470s)
[642.313461] Starting dynamic subtest: vcs1
[644.289311] Dynamic subtest vcs1: SUCCESS (1.985s)
[644.300971] Starting dynamic subtest: vecs0
[646.275256] Dynamic subtest vecs0: SUCCESS (1.983s)
[646.287479] Starting dynamic subtest: ccs0
[646.332390] Dynamic subtest ccs0: SUCCESS (0.055s)
[646.335565] Subtest engines-hostile-preempt: SUCCESS (5.645s)
[646.413868] [148/156] (391s left) kms_big_fb (y-tiled-addfb)
[646.533689] Starting subtest: y-tiled-addfb
[646.538367] Subtest y-tiled-addfb: SKIP (0.000s)
[646.629771] [149/156] (391s left) gem_create (create-ext-set-pat)
[646.785984] Starting subtest: create-ext-set-pat
[646.788633] Subtest create-ext-set-pat: SUCCESS (0.000s)
[646.884342] [150/156] (390s left) i915_getparams_basic (basic-subslice-total)
[646.928467] Starting subtest: basic-subslice-total
[646.932583] Subtest basic-subslice-total: SUCCESS (0.000s)
[647.015305] [151/156] (390s left) kms_feature_discovery (display-4x)
[647.120381] Starting subtest: display-4x
[647.124791] Subtest display-4x: SKIP (0.000s)
[647.195657] [152/156] (390s left) kms_vblank (wait-busy-hang)
[647.284373] Starting subtest: wait-busy-hang
[647.286570] Starting dynamic subtest: pipe-A-eDP-1
[675.081168] Dynamic subtest pipe-A-eDP-1: SUCCESS (27.792s)
[675.097638] Starting dynamic subtest: pipe-D-eDP-1
[700.051710] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.968s)
[700.053649] Subtest wait-busy-hang: SUCCESS (52.767s)
[700.932869] [153/156] (336s left) kms_psr (pr-sprite-render)
[701.031093] Starting subtest: pr-sprite-render
[701.035195] Subtest pr-sprite-render: SKIP (0.000s)
[701.110964] [154/156] (336s left) gen9_exec_parse (cmd-crossing-page)
[701.173880] Subtest cmd-crossing-page: SKIP (0.000s)
[701.245399] [155/156] (336s left) kms_cursor_legacy (basic-busy-flip-before-cursor-varying-size)
[701.367318] Starting subtest: basic-busy-flip-before-cursor-varying-size
[701.371965] Subtest basic-busy-flip-before-cursor-varying-size: SKIP (0.000s)
[701.523856] [156/156] (336s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-move)
[701.627570] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-move
[701.631685] Subtest fbcpsr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[701.744736] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_psr
results: parsing output: 2/ for test: dmabuf_sync_file
results: parsing output: 3/ for test: kms_plane_scaling
results: parsing output: 4/ for test: kms_chamelium_frames
results: parsing output: 5/ for test: api_intel_allocator
results: parsing output: 6/ for test: kms_cursor_crc
results: parsing output: 7/ for test: prime_mmap
results: parsing output: 8/ for test: kms_pipe_crc_basic
results: parsing output: 9/ for test: kms_big_fb
results: parsing output: 10/ for test: gem_ctx_param
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_flip
results: parsing output: 13/ for test: prime_self_import
results: parsing output: 14/ for test: kms_invalid_mode
results: parsing output: 15/ for test: kms_color_pipeline
results: parsing output: 16/ for test: kms_cursor_legacy
results: parsing output: 17/ for test: kms_flip
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: syncobj_eventfd
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: gem_spin_batch
results: parsing output: 25/ for test: prime_mmap_coherency
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: kms_flip
results: parsing output: 29/ for test: perf_pmu
results: parsing output: 30/ for test: kms_getfb
results: parsing output: 31/ for test: core_getclient
results: parsing output: 32/ for test: gem_exec_schedule
results: parsing output: 33/ for test: gem_pxp
results: parsing output: 34/ for test: syncobj_timeline
results: parsing output: 35/ for test: kms_ccs
results: parsing output: 36/ for test: kms_flip
results: parsing output: 37/ for test: gem_fenced_exec_thrash
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: i915_pm_rps
results: parsing output: 40/ for test: kms_psr
results: parsing output: 41/ for test: gem_pxp
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: kms_prime
results: parsing output: 44/ for test: kms_async_flips
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: vgem_basic
results: parsing output: 48/ for test: i915_pm_rpm
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: gem_tiled_wb
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: gem_exec_suspend
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: sw_sync
results: parsing output: 55/ for test: kms_ccs
results: parsing output: 56/ for test: core_setmaster_vs_auth
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: gem_mmap_gtt
results: parsing output: 61/ for test: dumb_buffer
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: kms_content_protection
results: parsing output: 64/ for test: syncobj_timeline
results: parsing output: 65/ for test: gem_exec_reloc
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: gem_mmap_gtt
results: parsing output: 68/ for test: kms_chamelium_color
results: parsing output: 69/ for test: sysfs_heartbeat_interval
results: parsing output: 70/ for test: kms_plane
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_eio
results: parsing output: 73/ for test: kms_ccs
results: parsing output: 74/ for test: gem_sync
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: gem_exec_schedule
results: parsing output: 78/ for test: kms_plane
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: kms_vrr
results: parsing output: 81/ for test: syncobj_timeline
results: parsing output: 82/ for test: kms_scaling_modes
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: gem_basic
results: parsing output: 85/ for test: kms_psr
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: gem_userptr_blits
results: parsing output: 88/ for test: kms_chamelium_hpd
results: parsing output: 89/ for test: kms_psr2_sf
results: parsing output: 90/ for test: syncobj_timeline
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: gem_exec_balancer
results: parsing output: 97/ for test: kms_cursor_legacy
results: parsing output: 98/ for test: kms_getfb
results: parsing output: 99/ for test: kms_ccs
results: parsing output: 100/ for test: kms_pm_backlight
results: parsing output: 101/ for test: gem_ctx_persistence
results: parsing output: 102/ for test: kms_prop_blob
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_pm_rpm
results: parsing output: 106/ for test: kms_flip
results: parsing output: 107/ for test: gem_exec_fence
results: parsing output: 108/ for test: gen9_exec_parse
results: parsing output: 109/ for test: kms_flip_scaled_crc
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: gem_exec_reloc
results: parsing output: 114/ for test: kms_ccs
results: parsing output: 115/ for test: kms_dither
results: parsing output: 116/ for test: kms_big_fb
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_3d
results: parsing output: 120/ for test: syncobj_timeline
results: parsing output: 121/ for test: kms_big_fb
results: parsing output: 122/ for test: syncobj_wait
results: parsing output: 123/ for test: gem_exec_params
results: parsing output: 124/ for test: syncobj_wait
results: parsing output: 125/ for test: syncobj_wait
results: parsing output: 126/ for test: kms_cursor_legacy
results: parsing output: 127/ for test: drm_read
results: parsing output: 128/ for test: kms_plane_alpha_blend
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: kms_big_fb
results: parsing output: 131/ for test: gem_mmap_offset
results: parsing output: 132/ for test: kms_flip_scaled_crc
results: parsing output: 133/ for test: kms_psr
results: parsing output: 134/ for test: gem_ctx_sseu
results: parsing output: 135/ for test: kms_frontbuffer_tracking
results: parsing output: 136/ for test: gem_exec_reloc
results: parsing output: 137/ for test: gem_softpin
results: parsing output: 138/ for test: prime_self_import
results: parsing output: 139/ for test: gem_lmem_swapping
results: parsing output: 140/ for test: kms_frontbuffer_tracking
results: parsing output: 141/ for test: kms_sequence
results: parsing output: 142/ for test: gem_exec_gttfill
results: parsing output: 143/ for test: gem_exec_capture
results: parsing output: 144/ for test: kms_getfb
results: parsing output: 145/ for test: kms_cursor_crc
results: parsing output: 146/ for test: gem_ctx_persistence
results: parsing output: 147/ for test: kms_big_fb
results: parsing output: 148/ for test: gem_create
results: parsing output: 149/ for test: i915_getparams_basic
results: parsing output: 150/ for test: kms_feature_discovery
results: parsing output: 151/ for test: kms_vblank
results: parsing output: 152/ for test: kms_psr
results: parsing output: 153/ for test: gen9_exec_parse
results: parsing output: 154/ for test: kms_cursor_legacy
results: parsing output: 155/ for test: kms_frontbuffer_tracking
Done.