[56.420508] Initializing watchdogs
[56.420553]   /dev/watchdog0
[56.434217] [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]
[56.438608] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.440831] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.444264] [001/131] (960s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs)
[56.553908] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs
[56.556933] Starting dynamic subtest: pipe-A-eDP-1
[56.566480] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[56.574051] Starting dynamic subtest: pipe-B-eDP-1
[56.583359] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[56.590112] Starting dynamic subtest: pipe-C-eDP-1
[56.598408] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[56.604790] Starting dynamic subtest: pipe-D-eDP-1
[56.613019] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[56.617016] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs: SKIP (0.003s)
[58.762520] [002/131] (958s left) kms_atomic (plane-invalid-params-fence)
[58.856089] Starting subtest: plane-invalid-params-fence
[58.858502] Starting dynamic subtest: pipe-A-eDP-1
[59.244136] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.382s)
[59.246605] Subtest plane-invalid-params-fence: SUCCESS (0.383s)
[60.123086] [003/131] (956s left) kms_properties (crtc-properties-atomic)
[60.212092] Starting subtest: crtc-properties-atomic
[60.214460] Starting dynamic subtest: pipe-A-eDP-1
[60.653541] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.434s)
[60.661854] Starting dynamic subtest: pipe-B-eDP-1
[61.782543] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.115s)
[61.792211] Starting dynamic subtest: pipe-C-eDP-1
[62.918810] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.123s)
[62.928247] Starting dynamic subtest: pipe-D-eDP-1
[64.067531] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.136s)
[64.069795] Subtest crtc-properties-atomic: SUCCESS (3.812s)
[64.894845] [004/131] (952s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[64.995530] Starting subtest: fbcpsr-indfb-scaledprimary
[70.795532] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.773s)
[71.059732] [005/131] (946s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[71.297783] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[71.302312] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[71.589232] [006/131] (945s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs)
[71.707471] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-rc-ccs
[71.709901] Starting dynamic subtest: pipe-A-eDP-1
[71.733643] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[71.743432] Starting dynamic subtest: pipe-B-eDP-1
[71.765156] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[71.772879] Starting dynamic subtest: pipe-C-eDP-1
[71.795429] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[71.804852] Starting dynamic subtest: pipe-D-eDP-1
[71.827682] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[71.831887] Subtest crc-primary-rotation-180-4-tiled-dg2-rc-ccs: SKIP (0.008s)
[73.937416] [007/131] (943s left) syncobj_timeline (invalid-signal-illegal-handle)
[73.990683] Starting subtest: invalid-signal-illegal-handle
[73.993029] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[74.128837] [008/131] (943s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move)
[74.226758] Starting subtest: psr-1p-primscrn-spr-indfb-move
[81.586582] Subtest psr-1p-primscrn-spr-indfb-move: SUCCESS (7.353s)
[81.733243] [009/131] (935s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0)
[81.833653] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0
[82.755923] Subtest x-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (0.923s)
[82.908289] [010/131] (934s left) prime_mmap (test_forked)
[82.953595] Starting subtest: test_forked
[82.955664] Starting dynamic subtest: test_forked-smem
[82.988568] Dynamic subtest test_forked-smem: SUCCESS (0.036s)
[82.991033] Subtest test_forked: SUCCESS (0.037s)
[83.102623] [011/131] (934s left) kms_frontbuffer_tracking (fbc-tiling-y)
[83.196724] Starting subtest: fbc-tiling-y
[83.200189] Subtest fbc-tiling-y: SKIP (0.000s)
[83.320766] [012/131] (934s left) syncobj_timeline (host-signal-ordered)
[83.369179] Starting subtest: host-signal-ordered
[83.371148] Subtest host-signal-ordered: SUCCESS (0.000s)
[83.511411] [013/131] (933s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-pwrite)
[83.597379] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-pwrite
[88.320558] Subtest fbc-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (4.722s)
[89.486157] [014/131] (927s left) gem_exec_schedule (u-semaphore-user)
[89.562343] Starting subtest: u-semaphore-user
[89.618701] Subtest u-semaphore-user: SUCCESS (0.058s)
[90.953237] [015/131] (926s left) kms_psr (psr2-cursor-plane-onoff)
[91.054993] Starting subtest: psr2-cursor-plane-onoff
[91.057380] Starting dynamic subtest: eDP-1
[92.731499] Dynamic subtest eDP-1: SUCCESS (1.675s)
[92.733641] Subtest psr2-cursor-plane-onoff: SUCCESS (1.677s)
[93.526676] [016/131] (924s left) dmabuf_sync_file (export-wait-after-attach)
[93.605157] Starting subtest: export-wait-after-attach
[93.607387] Subtest export-wait-after-attach: SUCCESS (0.001s)
[93.669397] [FACT dmabuf_sync_file (export-wait-after-attach)] new: kernel.kmod_is_loaded.vgem: true
[93.672887] [017/131] (923s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt)
[93.761299] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt
[100.969836] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (7.209s)
[101.138299] [018/131] (916s left) kms_dp_link_training (non-uhbr-mst)
[101.249405] Starting subtest: non-uhbr-mst
[101.258068] Subtest non-uhbr-mst: SKIP (0.000s)
[101.346462] [019/131] (916s left) kms_properties (connector-properties-legacy)
[101.439676] Starting subtest: connector-properties-legacy
[101.441772] Starting dynamic subtest: pipe-A-eDP-1
[109.147122] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.704s)
[109.157016] Starting dynamic subtest: pipe-None-DP-1
[109.161075] Dynamic subtest pipe-None-DP-1: SUCCESS (0.001s)
[109.167994] Starting dynamic subtest: pipe-None-HDMI-A-1
[109.172161] Dynamic subtest pipe-None-HDMI-A-1: SUCCESS (0.001s)
[109.179160] Starting dynamic subtest: pipe-None-DP-2
[109.183130] Dynamic subtest pipe-None-DP-2: SUCCESS (0.001s)
[109.189655] Starting dynamic subtest: pipe-None-HDMI-A-2
[109.193599] Dynamic subtest pipe-None-HDMI-A-2: SUCCESS (0.001s)
[109.200139] Starting dynamic subtest: pipe-None-DP-3
[109.204066] Dynamic subtest pipe-None-DP-3: SUCCESS (0.001s)
[109.210634] Starting dynamic subtest: pipe-None-DP-4
[109.214631] Dynamic subtest pipe-None-DP-4: SUCCESS (0.001s)
[109.216475] Subtest connector-properties-legacy: SUCCESS (7.714s)
[110.023149] [020/131] (907s left) syncobj_eventfd (invalid-illegal-handle)
[110.078171] Starting subtest: invalid-illegal-handle
[110.080448] Subtest invalid-illegal-handle: SUCCESS (0.000s)
[110.176392] [021/131] (907s left) gem_exec_params (dr4-dirt)
[110.221108] Starting subtest: DR4-dirt
[110.223361] Subtest DR4-dirt: SUCCESS (0.000s)
[110.346228] [022/131] (907s left) gem_mmap_offset (perf)
[110.394862] Starting subtest: perf
[110.396801] Starting dynamic subtest: smem0
[110.757081] Dynamic subtest smem0: SUCCESS (0.361s)
[110.759955] Subtest perf: SUCCESS (0.362s)
[110.875686] [023/131] (906s left) kms_content_protection (type1)
[111.010856] Starting subtest: type1
[111.015308] Subtest type1: SKIP (0.000s)
[111.179884] [024/131] (906s left) gem_exec_reloc (basic-wc-gtt-active)
[111.253825] Subtest basic-wc-gtt-active: SKIP (0.000s)
[111.339834] [025/131] (906s left) kms_cursor_crc (cursor-sliding-128x42)
[111.581221] Starting subtest: cursor-sliding-128x42
[111.622422] Subtest cursor-sliding-128x42: SKIP (0.037s)
[111.833401] [026/131] (906s left) kms_vblank (wait-idle)
[111.930968] Starting subtest: wait-idle
[111.933076] Starting dynamic subtest: pipe-A-eDP-1
[113.689728] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.757s)
[113.702845] Starting dynamic subtest: pipe-D-eDP-1
[116.165177] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.470s)
[116.167444] Subtest wait-idle: SUCCESS (4.230s)
[116.981174] [027/131] (900s left) syncobj_basic (bad-handle-to-fd)
[117.039101] Starting subtest: bad-handle-to-fd
[117.041393] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[117.155624] [028/131] (900s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[117.253302] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[117.265847] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.011s)
[117.351703] [029/131] (900s left) kms_getfb (getfb2-handle-not-fb)
[117.439247] Starting subtest: getfb2-handle-not-fb
[117.441115] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[117.576925] [030/131] (900s left) kms_rotation_crc (primary-4-tiled-reflect-x-0)
[117.672387] Starting subtest: primary-4-tiled-reflect-x-0
[124.796694] Subtest primary-4-tiled-reflect-x-0: SUCCESS (7.122s)
[126.065922] [031/131] (892s left) perf (non-zero-reason)
[126.187315] Starting subtest: non-zero-reason
[126.189476] Starting dynamic subtest: 0-rcs0
[131.489789] Dynamic subtest 0-rcs0: SUCCESS (5.302s)
[131.499999] Starting dynamic subtest: 1-vecs0
[135.361662] Dynamic subtest 1-vecs0: SUCCESS (3.871s)
[135.364297] Subtest non-zero-reason: SUCCESS (9.174s)
[135.411947] [032/131] (882s left) prime_mmap (test_aperture_limit)
[135.457588] Starting subtest: test_aperture_limit
[135.459411] Starting dynamic subtest: test_aperture_limit-smem
[135.466043] Dynamic subtest test_aperture_limit-smem: SKIP (0.007s)
[135.470201] Subtest test_aperture_limit: SKIP (0.008s)
[135.590145] [033/131] (882s left) gem_mmap_gtt (basic-wc)
[135.645957] Subtest basic-wc: SKIP (0.000s)
[135.704371] [034/131] (882s left) kms_big_fb (4-tiled-addfb-size-offset-overflow)
[135.802514] Starting subtest: 4-tiled-addfb-size-offset-overflow
[135.804453] Subtest 4-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[135.908161] [035/131] (882s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[136.032074] Starting subtest: 2x-cursor-vs-flip-atomic
[136.036557] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.001s)
[136.226996] [036/131] (882s left) kms_pm_rpm (cursor)
[138.049207] Starting subtest: cursor
[138.054499] Subtest cursor: SKIP (0.000s)
[138.502017] [037/131] (879s left) kms_atomic_interruptible (legacy-dpms)
[138.602997] Starting subtest: legacy-dpms
[138.605307] Starting dynamic subtest: pipe-A-eDP-1
[145.996837] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.391s)
[145.999238] Subtest legacy-dpms: SUCCESS (7.392s)
[146.844537] [038/131] (871s left) kms_psr (fbc-pr-cursor-plane-move)
[146.936143] Starting subtest: fbc-pr-cursor-plane-move
[146.940580] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s)
[147.015356] [039/131] (871s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant)
[147.113051] Starting subtest: coverage-vs-premult-vs-constant
[147.388819] Starting dynamic subtest: pipe-A-eDP-1
[147.961933] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.570s)
[147.971688] Starting dynamic subtest: pipe-D-eDP-1
[149.233870] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.271s)
[149.236082] Subtest coverage-vs-premult-vs-constant: SUCCESS (2.122s)
[150.126543] [040/131] (868s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt)
[150.220254] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt
[157.467721] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.250s)
[157.625419] [041/131] (860s left) gem_exec_balancer (invalid-balancer)
[157.684402] Starting subtest: invalid-balancer
[158.532052] Subtest invalid-balancer: SUCCESS (0.846s)
[158.845696] [042/131] (859s left) i915_selftest (perf)
[162.322656] Starting subtest: perf
[162.325682] Starting dynamic subtest: engine_cs
[166.829721] Dynamic subtest engine_cs: SUCCESS (4.507s)
[166.838978] Starting dynamic subtest: request
[174.269957] Dynamic subtest request: SUCCESS (7.438s)
[174.278405] Starting dynamic subtest: migrate
[178.781334] Dynamic subtest migrate: SUCCESS (4.509s)
[178.789721] Starting dynamic subtest: region
[184.716874] Dynamic subtest region: SUCCESS (5.906s)
[184.721367] Subtest perf: SUCCESS (22.368s)
[184.747627] [FACT i915_selftest (perf)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[184.748373] [FACT i915_selftest (perf)] deleted: kernel.kmod_is_loaded.i915: true
[184.751379] [043/131] (833s left) gem_eio (create-ext)
[186.263287] Starting subtest: create-ext
[186.630248] Subtest create-ext: SUCCESS (0.366s)
[186.769485] [FACT gem_eio (create-ext)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[186.770689] [FACT gem_eio (create-ext)] new: kernel.kmod_is_loaded.i915: true
[186.775113] [044/131] (831s left) gem_exec_flush (basic-batch-kernel-default-wb)
[186.840709] Starting subtest: basic-batch-kernel-default-wb
[193.540164] Subtest basic-batch-kernel-default-wb: SUCCESS (6.700s)
[193.742521] [045/131] (824s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[193.859783] Starting subtest: cursorB-vs-flipB-toggle
[193.864895] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s)
[194.015525] [046/131] (824s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-sf)
[199.013177] Starting subtest: fbc-pr-cursor-plane-move-continuous-sf
[199.017613] Subtest fbc-pr-cursor-plane-move-continuous-sf: SKIP (0.002s)
[199.895407] [047/131] (818s left) kms_cdclk (plane-scaling)
[199.993345] Starting subtest: plane-scaling
[199.995607] Starting dynamic subtest: pipe-A-eDP-1
[200.280146] Dynamic subtest pipe-A-eDP-1: SKIP (0.284s)
[200.290064] Starting dynamic subtest: pipe-B-eDP-1
[200.294573] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[200.303263] Starting dynamic subtest: pipe-C-eDP-1
[200.307770] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[200.315232] Starting dynamic subtest: pipe-D-eDP-1
[200.319307] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[200.323377] Subtest plane-scaling: SKIP (0.291s)
[201.115471] [048/131] (817s left) gem_mmap_offset (clear)
[201.172581] Starting subtest: clear
[201.175091] Starting dynamic subtest: smem0
[226.322836] Dynamic subtest smem0: SUCCESS (25.144s)
[226.325535] Subtest clear: SUCCESS (25.145s)
[226.494595] [049/131] (792s left) syncobj_wait (single-wait-all-for-submit-unsubmitted)
[226.588751] Starting subtest: single-wait-all-for-submit-unsubmitted
[226.698046] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.107s)
[226.792568] [050/131] (792s left) kms_busy (basic-hang)
[226.909146] Starting subtest: basic-hang
[226.911516] Starting dynamic subtest: flip-pipe-A
[227.506140] Dynamic subtest flip-pipe-A: SUCCESS (0.597s)
[227.517085] Starting dynamic subtest: modeset-pipe-A
[230.945256] Dynamic subtest modeset-pipe-A: SUCCESS (3.437s)
[230.958334] Starting dynamic subtest: flip-pipe-D
[232.141562] Dynamic subtest flip-pipe-D: SUCCESS (1.193s)
[232.150976] Starting dynamic subtest: modeset-pipe-D
[235.550915] Dynamic subtest modeset-pipe-D: SUCCESS (3.407s)
[235.553311] Subtest basic-hang: SUCCESS (8.644s)
[236.368145] [051/131] (782s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[236.422425] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[236.426956] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[236.626309] [052/131] (782s left) gem_exec_whisper (basic-fds-all)
[236.703093] Starting subtest: basic-fds-all
[248.886221] Subtest basic-fds-all: SUCCESS (12.178s)
[249.076056] [053/131] (769s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[249.170903] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[249.175086] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[249.302810] [054/131] (769s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[249.404752] Subtest addfb25-framebuffer-vs-set-tiling: SKIP (0.000s)
[249.519773] [055/131] (769s left) kms_frontbuffer_tracking (fbc-1p-rte)
[249.611911] Starting subtest: fbc-1p-rte
[255.044328] Subtest fbc-1p-rte: SUCCESS (5.436s)
[256.171235] [056/131] (762s left) syncobj_wait (multi-wait-submitted)
[256.230618] Starting subtest: multi-wait-submitted
[256.337893] Subtest multi-wait-submitted: SUCCESS (0.107s)
[256.437419] [057/131] (762s left) kms_psr (fbc-psr2-sprite-plane-onoff)
[256.541976] Starting subtest: fbc-psr2-sprite-plane-onoff
[256.544116] Starting dynamic subtest: eDP-1
[256.548460] Dynamic subtest eDP-1: SKIP (0.000s)
[256.552780] Subtest fbc-psr2-sprite-plane-onoff: SKIP (0.001s)
[256.628396] [058/131] (762s left) kms_atomic_transition (plane-all-modeset-transition-fencing-internal-panels)
[256.729200] Starting subtest: plane-all-modeset-transition-fencing-internal-panels
[256.731093] Starting dynamic subtest: pipe-A-eDP-1
[258.102300] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.373s)
[258.391712] Starting dynamic subtest: pipe-B-eDP-1
[259.429205] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.046s)
[259.711626] Subtest plane-all-modeset-transition-fencing-internal-panels: SUCCESS (2.984s)
[260.561730] [059/131] (758s left) syncobj_timeline (multi-wait-submitted-signaled)
[260.622062] Starting subtest: multi-wait-submitted-signaled
[260.624256] Subtest multi-wait-submitted-signaled: SUCCESS (0.001s)
[260.751474] [060/131] (758s left) kms_pipe_b_c_ivb (enable-pipe-c-while-b-has-3-lanes)
[260.813251] Subtest enable-pipe-C-while-B-has-3-lanes: SKIP (0.000s)
[260.878405] [061/131] (758s left) gem_exec_reloc (basic-wc-gtt-noreloc)
[260.938683] Subtest basic-wc-gtt-noreloc: SKIP (0.000s)
[261.019316] [062/131] (758s left) vgem_basic (bad-pad)
[261.054797] Starting subtest: bad-pad
[261.056652] Subtest bad-pad: SUCCESS (0.000s)
[261.123239] [063/131] (758s left) gem_create (create-massive)
[261.181393] Starting subtest: create-massive
[261.183507] Subtest create-massive: SUCCESS (0.000s)
[261.390943] [064/131] (758s left) gem_ccs (ctrl-surf-copy)
[261.448087] Starting subtest: ctrl-surf-copy
[261.452690] Subtest ctrl-surf-copy: SKIP (0.000s)
[261.580792] [065/131] (757s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-mc-ccs)
[261.679885] Starting subtest: missing-ccs-buffer-y-tiled-gen12-mc-ccs
[261.682203] Starting dynamic subtest: pipe-A-eDP-1
[261.706437] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[261.718475] Starting dynamic subtest: pipe-B-eDP-1
[261.739196] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[261.748093] Starting dynamic subtest: pipe-C-eDP-1
[261.768835] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[261.777527] Starting dynamic subtest: pipe-D-eDP-1
[261.798493] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[261.802368] Subtest missing-ccs-buffer-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[263.840010] [066/131] (755s left) gem_softpin (allocator-evict)
[263.898943] Starting subtest: allocator-evict
[263.901157] Starting dynamic subtest: rcs0
[287.103836] Dynamic subtest rcs0: SUCCESS (23.204s)
[287.113282] Starting dynamic subtest: bcs0
[311.147698] Dynamic subtest bcs0: SUCCESS (24.041s)
[311.156991] Starting dynamic subtest: vcs0
[335.046934] Dynamic subtest vcs0: SUCCESS (23.897s)
[335.056354] Starting dynamic subtest: vcs1
[358.833639] Dynamic subtest vcs1: SUCCESS (23.784s)
[358.842778] Starting dynamic subtest: vecs0
[382.792744] Dynamic subtest vecs0: SUCCESS (23.956s)
[382.802839] Starting dynamic subtest: ccs0
[406.512132] Dynamic subtest ccs0: SUCCESS (23.717s)
[406.514620] Subtest allocator-evict: SUCCESS (142.608s)
[406.605216] [067/131] (612s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-render)
[406.750231] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-render
[410.482938] Subtest fbc-1p-primscrn-spr-indfb-draw-render: SUCCESS (3.737s)
[411.642949] [068/131] (608s left) gem_flink_race (flink_close)
[411.673722] Starting subtest: flink_close
[416.771283] Subtest flink_close: SUCCESS (5.096s)
[416.858974] [069/131] (602s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs)
[416.956169] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs
[416.958348] Starting dynamic subtest: pipe-A-eDP-1
[416.978098] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[416.990304] Starting dynamic subtest: pipe-B-eDP-1
[417.009472] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[417.018690] Starting dynamic subtest: pipe-C-eDP-1
[417.037372] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[417.046061] Starting dynamic subtest: pipe-D-eDP-1
[417.065503] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[417.067717] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SUCCESS (0.005s)
[419.181810] [070/131] (600s left) gem_exec_reloc (basic-cpu-gtt)
[419.233103] Subtest basic-cpu-gtt: SKIP (0.000s)
[419.315195] [071/131] (600s left) kms_async_flips (async-flip-hang)
[419.408092] Starting subtest: async-flip-hang
[419.778053] Starting dynamic subtest: pipe-A-eDP-1
[435.379653] Dynamic subtest pipe-A-eDP-1: SUCCESS (15.599s)
[435.747042] Starting dynamic subtest: pipe-B-eDP-1
[451.375145] Dynamic subtest pipe-B-eDP-1: SUCCESS (15.631s)
[451.743089] Starting dynamic subtest: pipe-C-eDP-1
[467.376659] Dynamic subtest pipe-C-eDP-1: SUCCESS (15.638s)
[467.755068] Starting dynamic subtest: pipe-D-eDP-1
[483.373825] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.626s)
[483.377284] Subtest async-flip-hang: SUCCESS (63.962s)
[484.613859] [072/131] (535s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[484.723595] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling
[484.725926] Starting dynamic subtest: pipe-A-default-mode
[485.867490] Dynamic subtest pipe-A-default-mode: SKIP (1.140s)
[485.871693] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (1.144s)
[486.049339] [073/131] (533s left) kms_cursor_legacy (forked-move)
[486.164403] Starting subtest: forked-move
[486.166529] Starting dynamic subtest: pipe-A
[491.612220] Dynamic subtest pipe-A: SUCCESS (5.445s)
[491.626580] Starting dynamic subtest: pipe-B
[497.072476] Dynamic subtest pipe-B: SUCCESS (5.458s)
[497.082831] Starting dynamic subtest: pipe-C
[502.532071] Dynamic subtest pipe-C: SUCCESS (5.457s)
[502.543133] Starting dynamic subtest: pipe-D
[508.003095] Dynamic subtest pipe-D: SUCCESS (5.468s)
[508.015073] Starting dynamic subtest: all-pipes
[513.505438] Dynamic subtest all-pipes: SUCCESS (5.499s)
[513.507879] Subtest forked-move: SUCCESS (27.338s)
[513.672197] [074/131] (506s left) gem_exec_fence (syncobj-invalid-flags)
[514.140911] Starting subtest: syncobj-invalid-flags
[514.143285] Subtest syncobj-invalid-flags: SUCCESS (0.000s)
[516.025911] [075/131] (503s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-pgflip-blt)
[516.131869] Starting subtest: psr-2p-primscrn-indfb-pgflip-blt
[516.135787] Subtest psr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[516.228447] [076/131] (503s left) gem_exec_nop (basic-parallel)
[516.299147] Starting subtest: basic-parallel
[531.926691] Subtest basic-parallel: SUCCESS (15.636s)
[532.173990] [077/131] (487s left) gem_userptr_blits (stress-mm-invalidate-close)
[532.234545] Starting subtest: stress-mm-invalidate-close
[534.383099] Subtest stress-mm-invalidate-close: SUCCESS (2.148s)
[534.546435] [078/131] (485s left) kms_flip (flip-vs-absolute-wf_vblank-interruptible)
[534.647025] Starting subtest: flip-vs-absolute-wf_vblank-interruptible
[534.649186] Starting dynamic subtest: A-eDP1
[543.586692] Dynamic subtest A-eDP1: SUCCESS (8.939s)
[543.596741] Starting dynamic subtest: B-eDP1
[552.512723] Dynamic subtest B-eDP1: SUCCESS (8.924s)
[552.521879] Starting dynamic subtest: C-eDP1
[561.430371] Dynamic subtest C-eDP1: SUCCESS (8.916s)
[561.442436] Starting dynamic subtest: D-eDP1
[570.353963] Dynamic subtest D-eDP1: SUCCESS (8.921s)
[570.359546] Subtest flip-vs-absolute-wf_vblank-interruptible: SUCCESS (35.711s)
[571.593582] [079/131] (448s left) syncobj_wait (wait-any-complex)
[571.664325] Starting subtest: wait-any-complex
[571.723309] Subtest wait-any-complex: SUCCESS (0.061s)
[571.815541] [080/131] (448s left) api_intel_bb (intel-bb-blit-none)
[571.872503] Starting subtest: intel-bb-blit-none
[576.347752] Subtest intel-bb-blit-none: SUCCESS (4.476s)
[576.492316] [081/131] (443s left) kms_plane (plane-panning-top-left)
[576.593846] Starting subtest: plane-panning-top-left
[576.596138] Starting dynamic subtest: pipe-A
[578.238663] Dynamic subtest pipe-A: SUCCESS (1.644s)
[578.247830] Starting dynamic subtest: pipe-B
[580.617015] Dynamic subtest pipe-B: SUCCESS (2.377s)
[580.619333] Subtest plane-panning-top-left: SUCCESS (4.024s)
[581.451177] [082/131] (438s left) gem_exec_create (forked)
[581.522989] Starting subtest: forked
[581.525375] Starting dynamic subtest: smem
[602.903738] Dynamic subtest smem: SUCCESS (21.378s)
[602.906389] Subtest forked: SUCCESS (21.380s)
[603.105866] [083/131] (417s left) syncobj_timeline (wait-all-snapshot)
[603.162471] Starting subtest: wait-all-snapshot
[603.242381] Subtest wait-all-snapshot: SUCCESS (0.081s)
[603.345904] [084/131] (416s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[603.404097] Starting subtest: x-tiled-to-vebox-y-tiled
[603.408575] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[603.602481] [085/131] (416s left) i915_pm_freq_api (freq-basic-api)
[603.688578] Starting subtest: freq-basic-api
[603.690578] Starting dynamic subtest: gt0
[603.692957] Dynamic subtest gt0: SUCCESS (0.005s)
[603.704297] Starting dynamic subtest: gt1
[603.706145] Dynamic subtest gt1: SUCCESS (0.002s)
[603.708026] Subtest freq-basic-api: SUCCESS (0.009s)
[603.825964] [086/131] (416s left) kms_flip (2x-flip-vs-dpms-on-nop)
[603.919987] Starting subtest: 2x-flip-vs-dpms-on-nop
[603.928659] Subtest 2x-flip-vs-dpms-on-nop: SKIP (0.010s)
[604.019128] [087/131] (416s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render)
[604.109558] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render
[604.113600] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[604.222302] [088/131] (416s left) gen9_exec_parse (batch-invalid-length)
[604.272243] Subtest batch-invalid-length: SKIP (0.000s)
[604.343414] [089/131] (416s left) gem_mmap_gtt (basic-read)
[604.402110] Subtest basic-read: SKIP (0.000s)
[604.469649] [090/131] (416s left) kms_mmap_write_crc (main)
[604.563739] Starting subtest: main
[604.565606] Starting dynamic subtest: pipe-A-eDP-1
[607.776515] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.210s)
[607.778748] Subtest main: SUCCESS (3.211s)
[608.601255] [091/131] (411s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-blt)
[608.708355] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-blt
[615.369852] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.665s)
[615.539725] [092/131] (405s left) kms_content_protection (legacy)
[615.680160] Starting subtest: legacy
[615.684621] Subtest legacy: SKIP (0.000s)
[615.860808] [093/131] (404s left) kms_fbcon_fbt (fbc-suspend)
[615.922057] Starting subtest: fbc-suspend
[663.957834] Subtest fbc-suspend: SUCCESS (18.648s)
[665.149676] [094/131] (355s left) gem_softpin (evict-active)
[665.220837] Starting subtest: evict-active
[665.224494] Subtest evict-active: SUCCESS (0.006s)
[665.376708] [095/131] (355s left) i915_drm_fdinfo (memory-info-active)
[665.415732] Starting subtest: memory-info-active
[665.418153] Starting dynamic subtest: smem0
[668.207627] Dynamic subtest smem0: SUCCESS (2.749s)
[668.209960] Subtest memory-info-active: SUCCESS (2.750s)
[668.296968] [096/131] (352s left) gem_fence_thrash (bo-write-verify-x)
[668.333492] Starting subtest: bo-write-verify-x
[668.360704] Subtest bo-write-verify-x: SKIP (0.025s)
[668.427695] [097/131] (352s left) gem_eio (wait-immediate)
[668.664227] Starting subtest: wait-immediate
[669.101568] Subtest wait-immediate: SUCCESS (0.432s)
[669.253741] [098/131] (351s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[669.425898] Starting subtest: cursor-rapid-movement-32x10
[669.466380] Subtest cursor-rapid-movement-32x10: SKIP (0.037s)
[669.754814] [099/131] (351s left) gem_exec_schedule (noreorder)
[669.946246] Starting subtest: noreorder
[669.948949] Starting dynamic subtest: rcs0
[670.003675] Dynamic subtest rcs0: SUCCESS (0.057s)
[670.015357] Starting dynamic subtest: vcs0
[671.900728] Dynamic subtest vcs0: SUCCESS (1.877s)
[671.912177] Starting dynamic subtest: vcs1
[673.878115] Dynamic subtest vcs1: SUCCESS (1.959s)
[673.891815] Starting dynamic subtest: vecs0
[675.891608] Dynamic subtest vecs0: SUCCESS (1.999s)
[675.904404] Starting dynamic subtest: ccs0
[676.005461] Dynamic subtest ccs0: SUCCESS (0.111s)
[676.008169] Subtest noreorder: SUCCESS (6.015s)
[676.210160] [100/131] (344s left) sriov_basic (enable-vfs-bind-unbind-each-numvfs-all)
[676.269323] Starting subtest: enable-vfs-bind-unbind-each-numvfs-all
[676.350973] Subtest enable-vfs-bind-unbind-each-numvfs-all: FAIL (0.030s)
[676.392047] [101/131] (344s left) gem_exec_reloc (basic-concurrent16)
[676.458469] Subtest basic-concurrent16: SKIP (0.000s)
[676.532806] [102/131] (344s left) gem_mmap_gtt (cpuset-medium-copy)
[676.584785] Subtest cpuset-medium-copy: SKIP (0.000s)
[676.649654] [103/131] (344s left) kms_pm_backlight (bad-brightness)
[676.744951] Starting subtest: bad-brightness
[676.795645] Starting dynamic subtest: eDP-1
[677.108284] Dynamic subtest eDP-1: SUCCESS (0.310s)
[677.110724] Subtest bad-brightness: SUCCESS (0.363s)
[677.945007] [104/131] (343s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-render)
[678.038413] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-render
[678.042836] Subtest psr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[678.154265] [105/131] (343s left) gem_userptr_blits (userfault)
[678.209225] Starting subtest: userfault
[678.211581] Subtest userfault: SUCCESS (0.007s)
[678.335876] [106/131] (342s left) gem_exec_fence (basic-wait)
[678.513463] Starting subtest: basic-wait
[678.516043] Starting dynamic subtest: rcs0
[678.611266] Dynamic subtest rcs0: SUCCESS (0.097s)
[678.623485] Starting dynamic subtest: bcs0
[678.666995] Dynamic subtest bcs0: SUCCESS (0.054s)
[678.678808] Starting dynamic subtest: vcs0
[678.726845] Dynamic subtest vcs0: SUCCESS (0.057s)
[678.736845] Starting dynamic subtest: vcs1
[678.781265] Dynamic subtest vcs1: SUCCESS (0.053s)
[678.792251] Starting dynamic subtest: vecs0
[678.843374] Dynamic subtest vecs0: SUCCESS (0.059s)
[678.855434] Starting dynamic subtest: ccs0
[678.906637] Dynamic subtest ccs0: SUCCESS (0.061s)
[678.909155] Subtest basic-wait: SUCCESS (0.394s)
[681.007523] [107/131] (340s left) kms_psr (pr-cursor-blt)
[681.111898] Starting subtest: pr-cursor-blt
[681.116345] Subtest pr-cursor-blt: SKIP (0.000s)
[681.212568] [108/131] (340s left) kms_color (ctm-blue-to-red)
[681.310146] Starting subtest: ctm-blue-to-red
[681.312364] Starting dynamic subtest: pipe-A-eDP-1
[681.987160] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.675s)
[682.000148] Starting dynamic subtest: pipe-B-eDP-1
[683.406541] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.416s)
[683.418402] Starting dynamic subtest: pipe-C-eDP-1
[684.690281] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.281s)
[684.701971] Starting dynamic subtest: pipe-D-eDP-1
[686.043635] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.348s)
[686.046417] Subtest ctm-blue-to-red: SUCCESS (4.723s)
[686.912819] [109/131] (334s left) kms_flip (dpms-off-confusion)
[687.016089] Starting subtest: dpms-off-confusion
[687.018016] Starting dynamic subtest: A-eDP1
[695.683402] Dynamic subtest A-eDP1: SUCCESS (8.663s)
[695.695185] Starting dynamic subtest: B-eDP1
[704.313478] Dynamic subtest B-eDP1: SUCCESS (8.627s)
[704.325869] Starting dynamic subtest: C-eDP1
[712.945520] Dynamic subtest C-eDP1: SUCCESS (8.629s)
[712.957913] Starting dynamic subtest: D-eDP1
[721.582196] Dynamic subtest D-eDP1: SUCCESS (8.633s)
[721.587640] Subtest dpms-off-confusion: SUCCESS (34.561s)
[722.803566] [110/131] (298s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[722.955956] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[722.960642] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[723.140393] [111/131] (298s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move)
[723.274425] Starting subtest: psr-2p-scndscrn-cur-indfb-move
[723.278942] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[723.524682] [112/131] (297s left) syncobj_basic (bad-flags-handle-to-fd)
[723.580649] Starting subtest: bad-flags-handle-to-fd
[723.582939] Subtest bad-flags-handle-to-fd: SUCCESS (0.000s)
[723.698207] [113/131] (297s left) api_intel_allocator (gem-pool)
[723.755335] Starting subtest: gem-pool
[723.763473] Subtest gem-pool: SUCCESS (0.008s)
[723.935810] [114/131] (297s left) kms_invalid_mode (bad-vsync-end)
[724.023092] Starting subtest: bad-vsync-end
[724.025393] Starting dynamic subtest: pipe-A-eDP-1
[724.307524] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[724.317915] Starting dynamic subtest: pipe-B-eDP-1
[724.320010] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[724.329814] Starting dynamic subtest: pipe-C-eDP-1
[724.331982] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[724.341588] Starting dynamic subtest: pipe-D-eDP-1
[724.343555] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[724.345415] Subtest bad-vsync-end: SUCCESS (0.293s)
[725.206010] [115/131] (296s left) kms_psr (psr2-sprite-mmap-gtt)
[725.292227] Starting subtest: psr2-sprite-mmap-gtt
[725.294545] Starting dynamic subtest: eDP-1
[726.686224] Dynamic subtest eDP-1: SKIP (1.391s)
[726.690350] Subtest psr2-sprite-mmap-gtt: SKIP (1.393s)
[726.875551] [116/131] (294s left) gem_ctx_persistence (saturated-hostile-nopreempt)
[726.938243] Starting subtest: saturated-hostile-nopreempt
[726.940633] Starting dynamic subtest: rcs0
[727.026495] Dynamic subtest rcs0: SKIP (0.085s)
[727.039791] Starting dynamic subtest: bcs0
[727.052530] Dynamic subtest bcs0: SKIP (0.025s)
[727.067579] Starting dynamic subtest: vcs0
[727.079485] Dynamic subtest vcs0: SKIP (0.025s)
[727.089919] Starting dynamic subtest: vcs1
[727.107436] Dynamic subtest vcs1: SKIP (0.026s)
[727.117885] Starting dynamic subtest: vecs0
[727.126346] Dynamic subtest vecs0: SKIP (0.017s)
[727.137044] Starting dynamic subtest: ccs0
[727.144050] Dynamic subtest ccs0: SKIP (0.016s)
[727.148545] Subtest saturated-hostile-nopreempt: SKIP (0.204s)
[727.250076] [117/131] (294s left) kms_psr2_sf (pr-cursor-plane-update-sf)
[732.302210] Starting subtest: pr-cursor-plane-update-sf
[732.306597] Subtest pr-cursor-plane-update-sf: SKIP (0.002s)
[733.176088] [118/131] (288s left) kms_prop_blob (blob-prop-validate)
[733.237592] Starting subtest: blob-prop-validate
[733.239547] Subtest blob-prop-validate: SUCCESS (0.000s)
[733.348667] [119/131] (288s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180)
[733.447171] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180
[734.382477] Subtest x-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (0.934s)
[734.564283] [120/131] (287s left) kms_lease (setcrtc-implicit-plane)
[734.659050] Starting subtest: setcrtc-implicit-plane
[734.661000] Starting dynamic subtest: pipe-A-eDP-1
[735.120100] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.460s)
[735.130427] Starting dynamic subtest: pipe-B-eDP-1
[736.265161] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.146s)
[736.275638] Starting dynamic subtest: pipe-C-eDP-1
[737.379607] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.112s)
[737.391973] Starting dynamic subtest: pipe-D-eDP-1
[738.518846] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.135s)
[738.520755] Subtest setcrtc-implicit-plane: SUCCESS (3.858s)
[739.363443] [121/131] (282s left) kms_vblank (ts-continuation-idle-hang)
[739.459805] Starting subtest: ts-continuation-idle-hang
[739.461670] Starting dynamic subtest: pipe-A-eDP-1
[746.230613] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.767s)
[746.249022] Starting dynamic subtest: pipe-D-eDP-1
[752.176004] Dynamic subtest pipe-D-eDP-1: SUCCESS (5.940s)
[752.178219] Subtest ts-continuation-idle-hang: SUCCESS (12.711s)
[753.037017] [122/131] (268s left) perf_pmu (most-busy-check-all)
[753.081137] Starting subtest: most-busy-check-all
[753.083038] Starting dynamic subtest: rcs0
[754.887079] Dynamic subtest rcs0: SUCCESS (1.804s)
[754.898646] Starting dynamic subtest: bcs0
[756.870943] Dynamic subtest bcs0: SUCCESS (1.980s)
[756.884396] Starting dynamic subtest: vcs0
[758.855379] Dynamic subtest vcs0: SUCCESS (1.982s)
[758.867779] Starting dynamic subtest: vcs1
[760.902641] Dynamic subtest vcs1: SUCCESS (2.045s)
[760.916654] Starting dynamic subtest: vecs0
[762.887400] Dynamic subtest vecs0: SUCCESS (1.982s)
[762.901508] Starting dynamic subtest: ccs0
[764.871317] Dynamic subtest ccs0: SUCCESS (1.981s)
[764.874192] Subtest most-busy-check-all: SUCCESS (11.794s)
[765.001981] [123/131] (256s left) i915_pm_rc6_residency (rc6-idle)
[765.069635] Starting subtest: rc6-idle
[765.120662] Starting dynamic subtest: gt0-rcs0
[789.402495] Dynamic subtest gt0-rcs0: SUCCESS (24.284s)
[789.415710] Starting dynamic subtest: gt0-bcs0
[813.691419] Dynamic subtest gt0-bcs0: SUCCESS (24.284s)
[813.703675] Starting dynamic subtest: gt0-ccs0
[837.903859] Dynamic subtest gt0-ccs0: SUCCESS (24.204s)
[837.913790] Starting dynamic subtest: gt1-vcs0
[844.079587] Dynamic subtest gt1-vcs0: SUCCESS (6.170s)
[844.092723] Starting dynamic subtest: gt1-vecs0
[850.253322] Dynamic subtest gt1-vecs0: SUCCESS (6.169s)
[850.256238] Subtest rc6-idle: SUCCESS (85.177s)
[850.350922] [124/131] (171s left) gem_ctx_isolation (nonpriv-switch)
[850.415830] Starting subtest: nonpriv-switch
[850.418233] Starting dynamic subtest: rcs0
[850.741592] Dynamic subtest rcs0: SUCCESS (0.325s)
[850.752628] Starting dynamic subtest: bcs0
[851.126176] Dynamic subtest bcs0: SUCCESS (0.383s)
[851.139563] Starting dynamic subtest: vcs0
[851.476817] Dynamic subtest vcs0: SUCCESS (0.350s)
[851.489040] Starting dynamic subtest: vcs1
[853.174719] Dynamic subtest vcs1: SUCCESS (1.697s)
[853.187022] Starting dynamic subtest: vecs0
[855.245582] Dynamic subtest vecs0: SUCCESS (2.069s)
[855.259179] Starting dynamic subtest: ccs0
[857.227712] Dynamic subtest ccs0: SUCCESS (1.981s)
[857.230261] Subtest nonpriv-switch: SUCCESS (6.811s)
[857.503181] [125/131] (164s left) gem_exec_alignment (single)
[857.571585] Starting subtest: single
[857.577096] Subtest single: SUCCESS (0.004s)
[857.729468] [126/131] (164s left) perf (invalid-oa-format-id)
[857.877817] Starting subtest: invalid-oa-format-id
[857.891368] Subtest invalid-oa-format-id: SUCCESS (0.012s)
[857.940036] [127/131] (164s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[858.046395] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[858.858972] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.814s)
[859.081592] [128/131] (163s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[859.170827] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[859.174789] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[859.287836] [129/131] (162s left) gem_lmem_swapping (heavy-verify-random)
[859.329423] Subtest heavy-verify-random: SKIP (0.000s)
[859.372056] [130/131] (162s left) kms_chamelium_hpd (dp-hpd-after-suspend)
[859.759938] Subtest dp-hpd-after-suspend: SKIP (0.000s)
[860.548117] [131/131] (161s left) kms_big_fb (y-tiled-addfb-size-overflow)
[860.649872] Starting subtest: y-tiled-addfb-size-overflow
[860.654402] Subtest y-tiled-addfb-size-overflow: SKIP (0.000s)
[860.778904] Closing watchdogs
results: parsing output: 0/ for test: kms_ccs
results: parsing output: 1/ for test: kms_atomic
results: parsing output: 2/ for test: kms_properties
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_ccs
results: parsing output: 6/ for test: syncobj_timeline
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_big_fb
results: parsing output: 9/ for test: prime_mmap
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: syncobj_timeline
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: gem_exec_schedule
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: dmabuf_sync_file
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_dp_link_training
results: parsing output: 18/ for test: kms_properties
results: parsing output: 19/ for test: syncobj_eventfd
results: parsing output: 20/ for test: gem_exec_params
results: parsing output: 21/ for test: gem_mmap_offset
results: parsing output: 22/ for test: kms_content_protection
results: parsing output: 23/ for test: gem_exec_reloc
results: parsing output: 24/ for test: kms_cursor_crc
results: parsing output: 25/ for test: kms_vblank
results: parsing output: 26/ for test: syncobj_basic
results: parsing output: 27/ for test: kms_flip
results: parsing output: 28/ for test: kms_getfb
results: parsing output: 29/ for test: kms_rotation_crc
results: parsing output: 30/ for test: perf
results: parsing output: 31/ for test: prime_mmap
results: parsing output: 32/ for test: gem_mmap_gtt
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: kms_cursor_legacy
results: parsing output: 35/ for test: kms_pm_rpm
results: parsing output: 36/ for test: kms_atomic_interruptible
results: parsing output: 37/ for test: kms_psr
results: parsing output: 38/ for test: kms_plane_alpha_blend
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: gem_exec_balancer
results: parsing output: 41/ for test: i915_selftest
results: parsing output: 42/ for test: gem_eio
results: parsing output: 43/ for test: gem_exec_flush
results: parsing output: 44/ for test: kms_cursor_legacy
results: parsing output: 45/ for test: kms_psr2_sf
results: parsing output: 46/ for test: kms_cdclk
results: parsing output: 47/ for test: gem_mmap_offset
results: parsing output: 48/ for test: syncobj_wait
results: parsing output: 49/ for test: kms_busy
results: parsing output: 50/ for test: gem_render_copy
results: parsing output: 51/ for test: gem_exec_whisper
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_addfb_basic
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: syncobj_wait
results: parsing output: 56/ for test: kms_psr
results: parsing output: 57/ for test: kms_atomic_transition
results: parsing output: 58/ for test: syncobj_timeline
results: parsing output: 59/ for test: kms_pipe_b_c_ivb
results: parsing output: 60/ for test: gem_exec_reloc
results: parsing output: 61/ for test: vgem_basic
results: parsing output: 62/ for test: gem_create
results: parsing output: 63/ for test: gem_ccs
results: parsing output: 64/ for test: kms_ccs
results: parsing output: 65/ for test: gem_softpin
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: gem_flink_race
results: parsing output: 68/ for test: kms_ccs
results: parsing output: 69/ for test: gem_exec_reloc
results: parsing output: 70/ for test: kms_async_flips
results: parsing output: 71/ for test: kms_flip_scaled_crc
results: parsing output: 72/ for test: kms_cursor_legacy
results: parsing output: 73/ for test: gem_exec_fence
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: gem_exec_nop
results: parsing output: 76/ for test: gem_userptr_blits
results: parsing output: 77/ for test: kms_flip
results: parsing output: 78/ for test: syncobj_wait
results: parsing output: 79/ for test: api_intel_bb
results: parsing output: 80/ for test: kms_plane
results: parsing output: 81/ for test: gem_exec_create
results: parsing output: 82/ for test: syncobj_timeline
results: parsing output: 83/ for test: gem_render_copy
results: parsing output: 84/ for test: i915_pm_freq_api
results: parsing output: 85/ for test: kms_flip
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: gen9_exec_parse
results: parsing output: 88/ for test: gem_mmap_gtt
results: parsing output: 89/ for test: kms_mmap_write_crc
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: kms_content_protection
results: parsing output: 92/ for test: kms_fbcon_fbt
results: parsing output: 93/ for test: gem_softpin
results: parsing output: 94/ for test: i915_drm_fdinfo
results: parsing output: 95/ for test: gem_fence_thrash
results: parsing output: 96/ for test: gem_eio
results: parsing output: 97/ for test: kms_cursor_crc
results: parsing output: 98/ for test: gem_exec_schedule
results: parsing output: 99/ for test: sriov_basic
results: parsing output: 100/ for test: gem_exec_reloc
results: parsing output: 101/ for test: gem_mmap_gtt
results: parsing output: 102/ for test: kms_pm_backlight
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: gem_userptr_blits
results: parsing output: 105/ for test: gem_exec_fence
results: parsing output: 106/ for test: kms_psr
results: parsing output: 107/ for test: kms_color
results: parsing output: 108/ for test: kms_flip
results: parsing output: 109/ for test: kms_big_fb
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: syncobj_basic
results: parsing output: 112/ for test: api_intel_allocator
results: parsing output: 113/ for test: kms_invalid_mode
results: parsing output: 114/ for test: kms_psr
results: parsing output: 115/ for test: gem_ctx_persistence
results: parsing output: 116/ for test: kms_psr2_sf
results: parsing output: 117/ for test: kms_prop_blob
results: parsing output: 118/ for test: kms_big_fb
results: parsing output: 119/ for test: kms_lease
results: parsing output: 120/ for test: kms_vblank
results: parsing output: 121/ for test: perf_pmu
results: parsing output: 122/ for test: i915_pm_rc6_residency
results: parsing output: 123/ for test: gem_ctx_isolation
results: parsing output: 124/ for test: gem_exec_alignment
results: parsing output: 125/ for test: perf
results: parsing output: 126/ for test: kms_big_fb
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: gem_lmem_swapping
results: parsing output: 129/ for test: kms_chamelium_hpd
results: parsing output: 130/ for test: kms_big_fb
Done.