[60.013186] Initializing watchdogs
[60.013247]   /dev/watchdog0
[60.032452] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[60.043051] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[60.046727] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.049605] [001/134] (960s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)
[60.243694] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt
[63.103887] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (2.861s)
[63.326856] [002/134] (957s left) gem_ccs (block-multicopy-inplace)
[63.410313] Starting subtest: block-multicopy-inplace
[63.411227] Starting dynamic subtest: linear-compressed-compfmt0-smem-lmem0-multicopy
[63.458221] Dynamic subtest linear-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.047s)
[63.465992] Starting dynamic subtest: linear-compressed-compfmt0-lmem0-lmem0-multicopy
[63.558183] Dynamic subtest linear-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.100s)
[63.565743] Starting dynamic subtest: xmajor-compressed-compfmt0-smem-lmem0-multicopy
[63.573974] Dynamic subtest xmajor-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.015s)
[63.582183] Starting dynamic subtest: xmajor-compressed-compfmt0-lmem0-lmem0-multicopy
[63.673800] Dynamic subtest xmajor-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.100s)
[63.681509] Starting dynamic subtest: tile4-compressed-compfmt0-smem-lmem0-multicopy
[63.690035] Dynamic subtest tile4-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.016s)
[63.697747] Starting dynamic subtest: tile4-compressed-compfmt0-lmem0-lmem0-multicopy
[63.802208] Dynamic subtest tile4-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.112s)
[63.809985] Starting dynamic subtest: tile64-compressed-compfmt0-smem-lmem0-multicopy
[63.816788] Dynamic subtest tile64-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.014s)
[63.824502] Starting dynamic subtest: tile64-compressed-compfmt0-lmem0-lmem0-multicopy
[63.916051] Dynamic subtest tile64-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.099s)
[63.916992] Subtest block-multicopy-inplace: SUCCESS (0.506s)
[64.079553] [003/134] (956s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[64.285008] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[64.286972] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[64.480155] [004/134] (956s left) gem_exec_schedule (preempt-other-chain)
[64.566155] Starting subtest: preempt-other-chain
[64.566990] Starting dynamic subtest: rcs0
[65.219923] Dynamic subtest rcs0: SUCCESS (0.654s)
[65.228312] Starting dynamic subtest: bcs0
[65.863553] Dynamic subtest bcs0: SUCCESS (0.644s)
[65.871643] Starting dynamic subtest: vcs0
[66.477854] Dynamic subtest vcs0: SUCCESS (0.614s)
[66.486767] Starting dynamic subtest: vcs1
[67.163360] Dynamic subtest vcs1: SUCCESS (0.685s)
[67.171616] Starting dynamic subtest: vecs0
[67.860150] Dynamic subtest vecs0: SUCCESS (0.697s)
[67.870177] Starting dynamic subtest: vecs1
[68.495792] Dynamic subtest vecs1: SUCCESS (0.634s)
[68.504165] Starting dynamic subtest: ccs0
[69.121211] Dynamic subtest ccs0: SUCCESS (0.625s)
[69.122344] Subtest preempt-other-chain: SUCCESS (4.556s)
[69.511134] [005/134] (951s left) kms_cursor_crc (cursor-random-128x128)
[69.876505] Starting subtest: cursor-random-128x128
[69.880868] Starting dynamic subtest: pipe-A-DP-3
[74.528676] Dynamic subtest pipe-A-DP-3: SUCCESS (4.647s)
[74.578561] Starting dynamic subtest: pipe-D-DP-3
[79.127987] Dynamic subtest pipe-D-DP-3: SUCCESS (4.556s)
[79.129058] Subtest cursor-random-128x128: SUCCESS (9.250s)
[79.600715] [006/134] (941s left) gem_userptr_blits (userfault)
[79.680294] Starting subtest: userfault
[79.682738] Subtest userfault: SUCCESS (0.004s)
[79.891866] [007/134] (941s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[79.961970] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[80.070500] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.106s)
[80.232062] [008/134] (940s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt)
[80.415294] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt
[80.416971] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[80.584644] [009/134] (940s left) gem_exec_capture (userptr)
[80.663627] Starting subtest: userptr
[81.620205] Subtest userptr: SUCCESS (0.956s)
[81.785770] [010/134] (939s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[81.967324] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc
[81.969061] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[82.148440] [011/134] (939s left) sysfs_timeslice_duration (timeout)
[82.220117] Starting subtest: timeout
[82.221057] Starting dynamic subtest: vecs0
[84.006218] Dynamic subtest vecs0: SUCCESS (1.785s)
[84.014661] Starting dynamic subtest: ccs0
[85.731304] Dynamic subtest ccs0: SUCCESS (1.725s)
[85.740391] Starting dynamic subtest: vcs0
[87.402131] Dynamic subtest vcs0: SUCCESS (1.670s)
[87.410561] Starting dynamic subtest: bcs0
[88.526309] Dynamic subtest bcs0: SUCCESS (1.124s)
[88.535223] Starting dynamic subtest: vecs1
[90.302185] Dynamic subtest vecs1: SUCCESS (1.775s)
[90.310551] Starting dynamic subtest: rcs0
[92.001990] Dynamic subtest rcs0: SUCCESS (1.699s)
[92.010476] Starting dynamic subtest: vcs1
[93.751284] Dynamic subtest vcs1: SUCCESS (1.749s)
[93.752407] Subtest timeout: SUCCESS (11.530s)
[93.896490] [012/134] (927s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs-cc)
[94.075201] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs-cc
[94.076147] Starting dynamic subtest: pipe-A-DP-3
[94.084984] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[94.093499] Starting dynamic subtest: pipe-B-DP-3
[94.101926] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[94.110384] Starting dynamic subtest: pipe-C-DP-3
[94.118471] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[94.126478] Starting dynamic subtest: pipe-D-DP-3
[94.134916] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[94.137009] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[94.543241] [013/134] (926s left) kms_chamelium_frames (hdmi-crc-multiple)
[94.809342] Subtest hdmi-crc-multiple: SKIP (0.000s)
[94.957710] [014/134] (926s left) gem_exec_fence (syncobj-timeline-wait)
[95.700233] Starting subtest: syncobj-timeline-wait
[95.817781] Subtest syncobj-timeline-wait: SUCCESS (0.127s)
[96.119453] [FACT gem_exec_fence (syncobj-timeline-wait)] new: kernel.kmod_is_loaded.vgem: true
[96.121182] [015/134] (925s left) kms_psr (pr-primary-render)
[96.311342] Subtest pr-primary-render: SKIP (0.000s)
[96.396627] [016/134] (925s left) kms_big_fb (y-tiled-64bpp-rotate-180)
[96.594078] Starting subtest: y-tiled-64bpp-rotate-180
[96.595933] Subtest y-tiled-64bpp-rotate-180: SKIP (0.000s)
[96.788148] [017/134] (924s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[96.980411] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-wc
[96.982114] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[97.174962] [018/134] (924s left) kms_big_fb (4-tiled-addfb)
[97.377575] Starting subtest: 4-tiled-addfb
[97.378452] Subtest 4-tiled-addfb: SUCCESS (0.000s)
[97.575226] [019/134] (924s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-render)
[97.767438] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-render
[97.769117] Subtest fbc-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[97.955694] [020/134] (923s left) kms_plane_cursor (primary)
[98.145942] Starting subtest: primary
[98.147702] Starting dynamic subtest: pipe-A-DP-3-size-64
[101.258556] Dynamic subtest pipe-A-DP-3-size-64: SUCCESS (3.111s)
[101.316230] Starting dynamic subtest: pipe-A-DP-3-size-128
[104.392095] Dynamic subtest pipe-A-DP-3-size-128: SUCCESS (3.084s)
[104.449813] Starting dynamic subtest: pipe-A-DP-3-size-256
[107.542122] Dynamic subtest pipe-A-DP-3-size-256: SUCCESS (3.100s)
[107.696384] Starting dynamic subtest: pipe-B-DP-3-size-64
[110.856192] Dynamic subtest pipe-B-DP-3-size-64: SUCCESS (3.170s)
[110.924505] Starting dynamic subtest: pipe-B-DP-3-size-128
[114.056484] Dynamic subtest pipe-B-DP-3-size-128: SUCCESS (3.166s)
[114.120227] Starting dynamic subtest: pipe-B-DP-3-size-256
[117.238918] Dynamic subtest pipe-B-DP-3-size-256: SUCCESS (3.150s)
[117.344555] Starting dynamic subtest: pipe-C-DP-3-size-64
[120.544690] Dynamic subtest pipe-C-DP-3-size-64: SUCCESS (3.211s)
[120.589011] Starting dynamic subtest: pipe-C-DP-3-size-128
[123.711581] Dynamic subtest pipe-C-DP-3-size-128: SUCCESS (3.133s)
[123.751390] Starting dynamic subtest: pipe-C-DP-3-size-256
[126.828110] Dynamic subtest pipe-C-DP-3-size-256: SUCCESS (3.084s)
[126.959450] Starting dynamic subtest: pipe-D-DP-3-size-64
[130.121211] Dynamic subtest pipe-D-DP-3-size-64: SUCCESS (3.176s)
[130.184896] Starting dynamic subtest: pipe-D-DP-3-size-128
[133.320207] Dynamic subtest pipe-D-DP-3-size-128: SUCCESS (3.166s)
[133.366042] Starting dynamic subtest: pipe-D-DP-3-size-256
[136.471492] Dynamic subtest pipe-D-DP-3-size-256: SUCCESS (3.116s)
[136.583113] Subtest primary: SUCCESS (38.437s)
[136.895822] [021/134] (885s left) sw_sync (sync_merge)
[136.942386] Starting subtest: sync_merge
[136.943265] Subtest sync_merge: SUCCESS (0.000s)
[137.072515] [022/134] (884s left) drm_read (invalid-buffer)
[137.329797] Starting subtest: invalid-buffer
[137.330679] Subtest invalid-buffer: SUCCESS (0.000s)
[137.615183] [023/134] (884s left) gem_exec_flush (basic-uc-prw-default)
[137.697990] Subtest basic-uc-prw-default: SKIP (0.000s)
[137.772174] [024/134] (884s left) gem_cs_tlb (engines)
[137.865374] Starting subtest: engines
[137.866290] Starting dynamic subtest: rcs0
[140.019756] Dynamic subtest rcs0: SUCCESS (2.153s)
[140.029280] Starting dynamic subtest: bcs0
[142.174266] Dynamic subtest bcs0: SUCCESS (2.154s)
[142.183377] Starting dynamic subtest: vcs0
[144.326933] Dynamic subtest vcs0: SUCCESS (2.152s)
[144.336139] Starting dynamic subtest: vcs1
[146.480290] Dynamic subtest vcs1: SUCCESS (2.153s)
[146.490072] Starting dynamic subtest: vecs0
[148.632527] Dynamic subtest vecs0: SUCCESS (2.152s)
[148.641526] Starting dynamic subtest: vecs1
[150.785888] Dynamic subtest vecs1: SUCCESS (2.153s)
[150.795048] Starting dynamic subtest: ccs0
[152.938293] Dynamic subtest ccs0: SUCCESS (2.152s)
[152.939238] Subtest engines: SUCCESS (15.071s)
[153.118806] [025/134] (869s left) kms_big_fb (linear-16bpp-rotate-270)
[153.314504] Starting subtest: linear-16bpp-rotate-270
[153.382155] Subtest linear-16bpp-rotate-270: SKIP (0.067s)
[153.592085] [026/134] (868s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-onoff)
[153.784581] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-onoff
[153.786234] Subtest fbcpsr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[153.989755] [027/134] (868s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[154.185407] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[154.187125] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[154.355540] [028/134] (868s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area)
[154.559984] Subtest psr2-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[154.606780] [029/134] (867s left) kms_chamelium_audio (hdmi-audio-edid)
[154.875192] Subtest hdmi-audio-edid: SKIP (0.000s)
[155.028213] [030/134] (867s left) gem_tiled_wb
[155.212888] [031/134] (867s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[155.401036] Starting subtest: plane-upscale-20x20-with-rotation
[155.401751] Starting dynamic subtest: pipe-A
[155.789129] Dynamic subtest pipe-A: SUCCESS (0.388s)
[155.807067] Starting dynamic subtest: pipe-B
[156.267549] Dynamic subtest pipe-B: SUCCESS (0.478s)
[156.287497] Starting dynamic subtest: pipe-C
[156.747651] Dynamic subtest pipe-C: SUCCESS (0.479s)
[156.768922] Starting dynamic subtest: pipe-D
[157.227390] Dynamic subtest pipe-D: SUCCESS (0.479s)
[157.228317] Subtest plane-upscale-20x20-with-rotation: SUCCESS (1.828s)
[157.569657] [032/134] (865s left) gem_ctx_persistence (engines-hostile-preempt)
[157.659304] Starting subtest: engines-hostile-preempt
[157.660208] Starting dynamic subtest: rcs0
[157.772424] Dynamic subtest rcs0: SUCCESS (0.113s)
[157.786969] Starting dynamic subtest: bcs0
[157.828142] Dynamic subtest bcs0: SUCCESS (0.054s)
[157.841381] Starting dynamic subtest: vcs0
[157.889492] Dynamic subtest vcs0: SUCCESS (0.060s)
[157.905211] Starting dynamic subtest: vcs1
[157.960215] Dynamic subtest vcs1: SUCCESS (0.069s)
[157.997936] Starting dynamic subtest: vecs0
[158.042949] Dynamic subtest vecs0: SUCCESS (0.081s)
[158.078438] Starting dynamic subtest: vecs1
[158.104384] Dynamic subtest vecs1: SUCCESS (0.060s)
[158.121856] Starting dynamic subtest: ccs0
[158.155509] Dynamic subtest ccs0: SUCCESS (0.050s)
[158.156666] Subtest engines-hostile-preempt: SUCCESS (0.497s)
[158.388791] [033/134] (864s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-pwrite)
[158.577762] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-pwrite
[158.579443] Subtest fbc-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[158.742692] [034/134] (864s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-sf)
[158.939567] Subtest fbc-pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[158.997295] [035/134] (863s left) vgem_basic (debugfs)
[159.057862] Starting subtest: debugfs
[159.058687] Subtest debugfs: SUCCESS (0.000s)
[159.229618] [036/134] (863s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-blt)
[159.423964] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-blt
[161.628805] Subtest fbc-1p-offscreen-pri-indfb-draw-blt: SUCCESS (2.205s)
[161.856326] [037/134] (861s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[162.048140] Starting subtest: flip-vs-cursor-legacy
[171.684118] Subtest flip-vs-cursor-legacy: SUCCESS (9.636s)
[171.994630] [038/134] (851s left) kms_cursor_legacy (cursora-vs-flipb-toggle)
[172.183033] Starting subtest: cursorA-vs-flipB-toggle
[172.184842] Subtest cursorA-vs-flipB-toggle: SKIP (0.001s)
[172.337867] [039/134] (850s left) kms_ccs (crc-primary-basic-yf-tiled-ccs)
[172.529362] Starting subtest: crc-primary-basic-yf-tiled-ccs
[172.530263] Starting dynamic subtest: pipe-A-DP-3
[172.538705] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[172.547465] Starting dynamic subtest: pipe-B-DP-3
[172.555637] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[172.564365] Starting dynamic subtest: pipe-C-DP-3
[172.572594] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[172.581268] Starting dynamic subtest: pipe-D-DP-3
[172.590398] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[172.592385] Subtest crc-primary-basic-yf-tiled-ccs: SKIP (0.007s)
[172.995570] [040/134] (850s left) gem_lmem_swapping (parallel-random-engines)
[175.718408] Starting subtest: parallel-random-engines
[175.721051] Starting dynamic subtest: lmem0
[217.990535] Dynamic subtest lmem0: SUCCESS (42.272s)
[217.991546] Subtest parallel-random-engines: SUCCESS (42.273s)
[219.054746] [FACT gem_lmem_swapping (parallel-random-engines)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[219.055967] [FACT gem_lmem_swapping (parallel-random-engines)] deleted: kernel.kmod_is_loaded.i915: true
[219.057669] [041/134] (804s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)
[220.654395] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[220.655156] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[220.731721] [FACT syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[220.734114] [FACT syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)] new: kernel.kmod_is_loaded.i915: true
[220.736555] [042/134] (802s left) kms_flip (2x-flip-vs-fences-interruptible)
[220.929269] Starting subtest: 2x-flip-vs-fences-interruptible
[220.930983] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.000s)
[221.146860] [043/134] (802s left) syncobj_basic (illegal-fd-to-handle)
[221.224253] Starting subtest: illegal-fd-to-handle
[221.225163] Subtest illegal-fd-to-handle: SUCCESS (0.000s)
[221.372678] [044/134] (802s left) kms_pm_rpm (dpms-lpsp)
[222.911973] Starting subtest: dpms-lpsp
[222.914415] Subtest dpms-lpsp: SKIP (0.000s)
[223.382258] [045/134] (800s left) perf_pmu (interrupts-sync)
[223.456111] Starting subtest: interrupts-sync
[224.597503] Subtest interrupts-sync: SUCCESS (1.140s)
[224.785751] [046/134] (798s left) kms_plane (pixel-format-yf-tiled-ccs-modifier)
[224.983148] Starting subtest: pixel-format-yf-tiled-ccs-modifier
[225.021736] Starting dynamic subtest: pipe-A-plane-0
[225.023570] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[225.033523] Starting dynamic subtest: pipe-A-plane-3
[225.035776] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[225.045290] Starting dynamic subtest: pipe-A-plane-5
[225.047126] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[225.250315] Starting dynamic subtest: pipe-B-plane-0
[225.252363] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[225.269365] Starting dynamic subtest: pipe-B-plane-3
[225.271269] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[225.284655] Starting dynamic subtest: pipe-B-plane-5
[225.286463] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[225.342938] Subtest pixel-format-yf-tiled-ccs-modifier: SKIP (0.359s)
[225.621916] [047/134] (798s left) kms_psr (fbc-psr2-primary-render)
[225.810478] Subtest fbc-psr2-primary-render: SKIP (0.000s)
[225.888775] [048/134] (797s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions-varying-size)
[226.074927] Starting subtest: cursor-vs-flip-atomic-transitions-varying-size
[259.396589] Subtest cursor-vs-flip-atomic-transitions-varying-size: SUCCESS (33.321s)
[259.691524] [049/134] (764s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen)
[259.885698] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen
[259.887415] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[260.075487] [050/134] (763s left) kms_pm_rpm (modeset-non-lpsp)
[261.982687] Starting subtest: modeset-non-lpsp
[262.545335] Subtest modeset-non-lpsp: SUCCESS (0.562s)
[262.825035] [051/134] (761s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[263.010849] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[263.013177] Starting dynamic subtest: pipe-A-DP-3
[263.021584] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[263.031276] Starting dynamic subtest: pipe-B-DP-3
[263.039464] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[263.048975] Starting dynamic subtest: pipe-C-DP-3
[263.057110] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[263.066739] Starting dynamic subtest: pipe-D-DP-3
[263.076950] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[263.079045] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SKIP (0.006s)
[263.505688] [052/134] (760s left) syncobj_wait (wait-all-delayed-signal)
[263.586406] Starting subtest: wait-all-delayed-signal
[263.689085] Subtest wait-all-delayed-signal: SUCCESS (0.102s)
[263.810134] [053/134] (760s left) perf_pmu (idle-no-semaphores)
[263.881664] Starting subtest: idle-no-semaphores
[263.882537] Starting dynamic subtest: rcs0
[264.428109] Dynamic subtest rcs0: SUCCESS (0.545s)
[264.441495] Starting dynamic subtest: bcs0
[264.944361] Dynamic subtest bcs0: SUCCESS (0.512s)
[264.958147] Starting dynamic subtest: vcs0
[265.462412] Dynamic subtest vcs0: SUCCESS (0.514s)
[265.476225] Starting dynamic subtest: vcs1
[265.979532] Dynamic subtest vcs1: SUCCESS (0.513s)
[265.993602] Starting dynamic subtest: vecs0
[266.493472] Dynamic subtest vecs0: SUCCESS (0.510s)
[266.507075] Starting dynamic subtest: vecs1
[267.008329] Dynamic subtest vecs1: SUCCESS (0.511s)
[267.021809] Starting dynamic subtest: ccs0
[267.523297] Dynamic subtest ccs0: SUCCESS (0.511s)
[267.525273] Subtest idle-no-semaphores: SUCCESS (3.643s)
[267.720445] [054/134] (756s left) i915_pm_rps (thresholds-idle)
[267.805984] Starting subtest: thresholds-idle
[267.809018] Subtest thresholds-idle: SKIP (0.000s)
[267.984044] [055/134] (756s left) kms_psr (psr-primary-blt)
[268.167325] Subtest psr-primary-blt: SKIP (0.000s)
[268.232227] [056/134] (756s left) gem_tiled_blits (interruptible)
[268.316172] Subtest interruptible: SKIP (0.000s)
[268.401772] [057/134] (756s left) i915_drm_fdinfo (busy-hang)
[268.472202] Starting subtest: busy-hang
[268.473273] Starting dynamic subtest: rcs0
[268.495212] Dynamic subtest rcs0: SKIP (0.023s)
[268.504745] Starting dynamic subtest: bcs0
[268.506559] Dynamic subtest bcs0: SKIP (0.001s)
[268.516035] Starting dynamic subtest: vcs0
[268.518351] Dynamic subtest vcs0: SKIP (0.000s)
[268.527808] Starting dynamic subtest: vcs1
[268.530218] Dynamic subtest vcs1: SKIP (0.001s)
[268.539804] Starting dynamic subtest: vecs0
[268.542108] Dynamic subtest vecs0: SKIP (0.000s)
[268.551623] Starting dynamic subtest: vecs1
[268.553725] Dynamic subtest vecs1: SKIP (0.000s)
[268.563356] Starting dynamic subtest: ccs0
[268.565622] Dynamic subtest ccs0: SKIP (0.000s)
[268.567820] Subtest busy-hang: SKIP (0.031s)
[268.620091] [058/134] (755s left) kms_color (ctm-0-50)
[268.804807] Starting subtest: ctm-0-50
[268.805669] Starting dynamic subtest: pipe-A-DP-3
[270.553627] Dynamic subtest pipe-A-DP-3: SUCCESS (1.746s)
[270.577965] Starting dynamic subtest: pipe-B-DP-3
[272.159406] Dynamic subtest pipe-B-DP-3: SUCCESS (1.605s)
[272.170551] Starting dynamic subtest: pipe-C-DP-3
[273.796475] Dynamic subtest pipe-C-DP-3: SUCCESS (1.635s)
[273.812018] Starting dynamic subtest: pipe-D-DP-3
[275.417640] Dynamic subtest pipe-D-DP-3: SUCCESS (1.620s)
[275.418615] Subtest ctm-0-50: SUCCESS (6.612s)
[275.734309] [059/134] (748s left) gem_render_copy (linear)
[275.819695] Starting subtest: linear
[275.820572] Starting dynamic subtest: smem
[275.931274] Dynamic subtest smem: SUCCESS (0.111s)
[275.941243] Starting dynamic subtest: lmem0
[276.239207] Dynamic subtest lmem0: SUCCESS (0.307s)
[276.240172] Subtest linear: SUCCESS (0.420s)
[276.524787] [060/134] (748s left) api_intel_allocator (two-level-inception-interruptible)
[276.600414] Starting subtest: two-level-inception-interruptible
[282.024815] Subtest two-level-inception-interruptible: SUCCESS (5.425s)
[282.266951] [061/134] (742s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-downscaling)
[282.450411] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-downscaling
[282.451305] Starting dynamic subtest: pipe-A-valid-mode
[285.137832] Dynamic subtest pipe-A-valid-mode: SUCCESS (2.686s)
[285.142796] Subtest flip-64bpp-xtile-to-16bpp-xtile-downscaling: SUCCESS (2.690s)
[285.442449] [062/134] (739s left) gem_ctx_shared (exec-shared-gtt)
[285.535586] Starting subtest: exec-shared-gtt
[285.536480] Starting dynamic subtest: rcs0
[285.547104] Dynamic subtest rcs0: SUCCESS (0.011s)
[285.558870] Starting dynamic subtest: bcs0
[285.559739] Dynamic subtest bcs0: SUCCESS (0.008s)
[285.570176] Starting dynamic subtest: vcs0
[285.571336] Dynamic subtest vcs0: SUCCESS (0.007s)
[285.582046] Starting dynamic subtest: vcs1
[285.582953] Dynamic subtest vcs1: SUCCESS (0.007s)
[285.593404] Starting dynamic subtest: vecs0
[285.594325] Dynamic subtest vecs0: SUCCESS (0.007s)
[285.604855] Starting dynamic subtest: vecs1
[285.606094] Dynamic subtest vecs1: SUCCESS (0.006s)
[285.616899] Starting dynamic subtest: ccs0
[285.618082] Dynamic subtest ccs0: SUCCESS (0.007s)
[285.619184] Subtest exec-shared-gtt: SUCCESS (0.059s)
[285.876140] [063/134] (739s left) gem_pxp (regular-baseline-src-copy-readible)
[288.486552] Starting subtest: regular-baseline-src-copy-readible
[288.488817] Subtest regular-baseline-src-copy-readible: SKIP (0.000s)
[288.620582] [064/134] (736s left) kms_big_fb (x-tiled-32bpp-rotate-270)
[288.821825] Starting subtest: x-tiled-32bpp-rotate-270
[288.874381] Subtest x-tiled-32bpp-rotate-270: SKIP (0.052s)
[289.107166] [065/134] (736s left) core_getstats (basic)
[289.188228] Starting subtest: basic
[289.189192] Subtest basic: SUCCESS (0.000s)
[289.376836] [066/134] (735s left) kms_joiner (invalid-modeset-big-joiner)
[289.566046] Starting subtest: invalid-modeset-big-joiner
[289.567824] Subtest invalid-modeset-big-joiner: SKIP (0.000s)
[289.691065] [067/134] (735s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-render)
[289.883013] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-render
[289.884767] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-render: SKIP (0.000s)
[290.072391] [068/134] (735s left) gem_exec_schedule (u-semaphore-noskip)
[290.167231] Starting subtest: u-semaphore-noskip
[291.057219] Subtest u-semaphore-noskip: SUCCESS (0.889s)
[291.540538] [069/134] (733s left) gem_exec_flush (basic-uc-rw-default)
[291.626225] Subtest basic-uc-rw-default: SKIP (0.000s)
[291.731626] [070/134] (733s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt)
[291.921046] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt
[291.922814] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[292.125082] [071/134] (733s left) gem_mmap_gtt (basic-read)
[292.201168] Subtest basic-read: SKIP (0.000s)
[292.271841] [072/134] (733s left) kms_async_flips (invalid-async-flip-atomic)
[292.461322] Starting subtest: invalid-async-flip-atomic
[292.694795] Starting dynamic subtest: pipe-A-DP-3
[293.084546] Dynamic subtest pipe-A-DP-3: SUCCESS (0.390s)
[293.289498] Starting dynamic subtest: pipe-B-DP-3
[293.436515] Dynamic subtest pipe-B-DP-3: SUCCESS (0.157s)
[293.636461] Starting dynamic subtest: pipe-C-DP-3
[293.783731] Dynamic subtest pipe-C-DP-3: SUCCESS (0.158s)
[293.983537] Starting dynamic subtest: pipe-D-DP-3
[294.138564] Dynamic subtest pipe-D-DP-3: SUCCESS (0.166s)
[294.139626] Subtest invalid-async-flip-atomic: SUCCESS (1.679s)
[294.630977] [073/134] (731s left) gen7_exec_parse (basic-rejected)
[294.720511] Subtest basic-rejected: SKIP (0.000s)
[294.821953] [074/134] (730s left) syncobj_timeline (multi-wait-all-for-submit-signaled)
[294.897472] Starting subtest: multi-wait-all-for-submit-signaled
[294.898363] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.001s)
[295.036793] [075/134] (730s left) kms_busy (basic-hang)
[295.230736] Starting subtest: basic-hang
[295.233022] Starting dynamic subtest: flip-pipe-A
[295.831493] Dynamic subtest flip-pipe-A: SUCCESS (0.598s)
[295.855273] Starting dynamic subtest: modeset-pipe-A
[296.764531] Dynamic subtest modeset-pipe-A: SUCCESS (0.931s)
[296.785725] Starting dynamic subtest: flip-pipe-D
[297.306536] Dynamic subtest flip-pipe-D: SUCCESS (0.537s)
[297.320301] Starting dynamic subtest: modeset-pipe-D
[298.173158] Dynamic subtest modeset-pipe-D: SUCCESS (0.865s)
[298.175473] Subtest basic-hang: SUCCESS (2.943s)
[298.475476] [076/134] (727s left) kms_cursor_legacy (flip-vs-cursor-toggle)
[298.662913] Starting subtest: flip-vs-cursor-toggle
[310.680223] Subtest flip-vs-cursor-toggle: SUCCESS (12.017s)
[310.937341] [077/134] (715s left) kms_tiled_display (basic-test-pattern)
[311.198318] Subtest basic-test-pattern: SKIP (0.000s)
[311.258120] [078/134] (714s left) kms_plane (planar-pixel-format-settings)
[311.445282] Starting subtest: planar-pixel-format-settings
[311.576380] Subtest planar-pixel-format-settings: SUCCESS (0.131s)
[311.795774] [079/134] (714s left) gem_exec_create (basic)
[311.881962] Starting subtest: basic
[311.882901] Starting dynamic subtest: smem
[313.976121] Dynamic subtest smem: SUCCESS (2.093s)
[313.989118] Starting dynamic subtest: lmem0
[316.076109] Dynamic subtest lmem0: SUCCESS (2.099s)
[316.077067] Subtest basic: SUCCESS (4.195s)
[316.315164] [080/134] (709s left) gem_exec_fence (syncobj-channel)
[316.868393] Starting subtest: syncobj-channel
[317.888964] Subtest syncobj-channel: SUCCESS (1.019s)
[318.279870] [081/134] (707s left) gem_ctx_persistence (legacy-engines-persistence)
[318.365574] Starting subtest: legacy-engines-persistence
[318.366497] Starting dynamic subtest: render
[319.261111] Dynamic subtest render: SUCCESS (0.894s)
[319.275612] Starting dynamic subtest: bsd1
[320.056284] Dynamic subtest bsd1: SUCCESS (0.790s)
[320.070997] Starting dynamic subtest: bsd2
[320.833302] Dynamic subtest bsd2: SUCCESS (0.772s)
[320.847865] Starting dynamic subtest: blt
[321.593303] Dynamic subtest blt: SUCCESS (0.755s)
[321.608449] Starting dynamic subtest: vebox
[322.382255] Dynamic subtest vebox: SUCCESS (0.783s)
[322.387378] Subtest legacy-engines-persistence: SUCCESS (4.018s)
[322.704173] [082/134] (703s left) sw_sync (sync_merge_same)
[322.751884] Starting subtest: sync_merge_same
[322.752798] Subtest sync_merge_same: SUCCESS (0.000s)
[322.872919] [083/134] (703s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions)
[323.069453] Starting subtest: cursorA-vs-flipA-atomic-transitions
[334.039127] Subtest cursorA-vs-flipA-atomic-transitions: SUCCESS (10.970s)
[334.334681] [084/134] (692s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c)
[334.423232] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s)
[334.492378] [085/134] (692s left) kms_frontbuffer_tracking (psr-1p-rte)
[334.702228] Starting subtest: psr-1p-rte
[334.703963] Subtest psr-1p-rte: SKIP (0.000s)
[334.869550] [086/134] (691s left) syncobj_timeline (wait-all-complex)
[334.952478] Starting subtest: wait-all-complex
[335.175795] Subtest wait-all-complex: SUCCESS (0.216s)
[335.315385] [087/134] (691s left) gem_render_copy (y-tiled-to-vebox-yf-tiled)
[335.400769] Starting subtest: y-tiled-to-vebox-yf-tiled
[335.402905] Subtest y-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[335.666562] [088/134] (691s left) gem_exec_params (dr1-dirt)
[335.746830] Starting subtest: DR1-dirt
[335.747742] Subtest DR1-dirt: SUCCESS (0.000s)
[335.911544] [089/134] (691s left) kms_addfb_basic (bad-pitch-1024)
[335.995731] Starting subtest: bad-pitch-1024
[335.996565] Subtest bad-pitch-1024: SUCCESS (0.000s)
[336.269513] [090/134] (690s left) prime_vgem (basic-fence-flip)
[336.383467] Starting subtest: basic-fence-flip
[336.501586] Subtest basic-fence-flip: SKIP (0.119s)
[336.714886] [091/134] (690s left) gem_ctx_param (non-root-set)
[336.792917] Starting subtest: non-root-set
[336.810266] Subtest non-root-set: SUCCESS (0.017s)
[336.983354] [092/134] (690s left) gem_mmap_gtt (ptrace)
[337.062230] Subtest ptrace: SKIP (0.000s)
[337.146403] [093/134] (690s left) gem_exec_capture (capture-invisible)
[337.234373] Starting subtest: capture-invisible
[337.235295] Starting dynamic subtest: lmem0
[337.237145] Dynamic subtest lmem0: SKIP (0.000s)
[337.248184] Starting dynamic subtest: smem0
[337.250212] Dynamic subtest smem0: SKIP (0.000s)
[337.252619] Subtest capture-invisible: SKIP (0.002s)
[337.430886] [094/134] (689s left) syncobj_timeline (etime-multi-wait-all-submitted)
[337.508530] Starting subtest: etime-multi-wait-all-submitted
[337.612856] Subtest etime-multi-wait-all-submitted: SUCCESS (0.104s)
[337.797625] [095/134] (689s left) syncobj_wait (wait-any-snapshot)
[337.876577] Starting subtest: wait-any-snapshot
[337.959274] Subtest wait-any-snapshot: SUCCESS (0.082s)
[338.086038] [096/134] (689s left) syncobj_timeline (multi-wait-for-submit-available-signaled)
[338.160467] Starting subtest: multi-wait-for-submit-available-signaled
[338.161393] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.001s)
[338.315471] [097/134] (689s left) kms_draw_crc (draw-method-mmap-wc)
[338.499439] Starting subtest: draw-method-mmap-wc
[338.501246] Subtest draw-method-mmap-wc: SKIP (0.000s)
[338.715973] [098/134] (688s left) kms_vrr (negative-basic)
[338.901424] Starting subtest: negative-basic
[338.904038] Starting dynamic subtest: pipe-A-DP-3
[344.333175] Dynamic subtest pipe-A-DP-3: SUCCESS (5.429s)
[344.412573] Subtest negative-basic: SUCCESS (5.512s)
[344.739927] [099/134] (682s left) kms_setmode (basic)
[344.820515] Starting subtest: basic
[344.974517] Starting dynamic subtest: pipe-A-DP-3
[347.133393] Dynamic subtest pipe-A-DP-3: SUCCESS (2.156s)
[347.271174] Starting dynamic subtest: pipe-B-DP-3
[349.417446] Dynamic subtest pipe-B-DP-3: SUCCESS (2.153s)
[349.493147] Subtest basic: SUCCESS (4.670s)
[349.814433] [100/134] (677s left) gem_madvise (dontneed-before-mmap)
[349.861261] Starting subtest: dontneed-before-mmap
[349.909441] Subtest dontneed-before-mmap: SUCCESS (0.048s)
[350.097376] [101/134] (677s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[350.289210] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[350.340333] [102/134] (677s left) syncobj_wait (single-wait-for-submit-submitted)
[350.422660] Starting subtest: single-wait-for-submit-submitted
[350.524947] Subtest single-wait-for-submit-submitted: SUCCESS (0.102s)
[350.683037] [103/134] (677s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-pwrite)
[350.876274] Starting subtest: psr-1p-primscrn-cur-indfb-draw-pwrite
[350.878162] Subtest psr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[351.063435] [104/134] (677s left) gem_mmap_offset (perf)
[351.141754] Starting subtest: perf
[351.142596] Starting dynamic subtest: lmem0
[351.417584] Dynamic subtest lmem0: SUCCESS (0.276s)
[351.428668] Starting dynamic subtest: smem0
[351.433817] Dynamic subtest smem0: SUCCESS (0.003s)
[351.434775] Subtest perf: SUCCESS (0.281s)
[351.581792] [105/134] (676s left) gem_lmem_swapping (massive-random)
[354.213909] Starting subtest: massive-random
[354.215866] Starting dynamic subtest: lmem0
[354.402978] Dynamic subtest lmem0: SUCCESS (0.190s)
[354.404010] Subtest massive-random: SUCCESS (0.191s)
[358.140115] [FACT gem_lmem_swapping (massive-random)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[358.141050] [FACT gem_lmem_swapping (massive-random)] deleted: kernel.kmod_is_loaded.i915: true
[358.143097] [106/134] (670s left) kms_cursor_legacy (torture-move)
[359.837324] Starting subtest: torture-move
[359.838238] Starting dynamic subtest: pipe-A
[365.278215] Dynamic subtest pipe-A: SUCCESS (5.440s)
[365.288687] Starting dynamic subtest: pipe-B
[370.717555] Dynamic subtest pipe-B: SUCCESS (5.438s)
[370.727359] Starting dynamic subtest: pipe-C
[376.148851] Dynamic subtest pipe-C: SUCCESS (5.430s)
[376.159199] Starting dynamic subtest: pipe-D
[381.582316] Dynamic subtest pipe-D: SUCCESS (5.432s)
[381.592907] Starting dynamic subtest: all-pipes
[387.032706] Dynamic subtest all-pipes: SUCCESS (5.447s)
[387.033577] Subtest torture-move: SUCCESS (27.194s)
[387.206835] [FACT kms_cursor_legacy (torture-move)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[387.209396] [FACT kms_cursor_legacy (torture-move)] new: kernel.kmod_is_loaded.i915: true
[387.212558] [107/134] (641s left) prime_busy (after)
[387.302316] Starting subtest: after
[387.305750] Starting dynamic subtest: rcs0
[387.378399] Dynamic subtest rcs0: SUCCESS (0.073s)
[387.391350] Starting dynamic subtest: bcs0
[387.430290] Dynamic subtest bcs0: SUCCESS (0.051s)
[387.445208] Starting dynamic subtest: vcs0
[387.477439] Dynamic subtest vcs0: SUCCESS (0.045s)
[387.507572] Starting dynamic subtest: vcs1
[387.518991] Dynamic subtest vcs1: SUCCESS (0.039s)
[387.535182] Starting dynamic subtest: vecs0
[387.559853] Dynamic subtest vecs0: SUCCESS (0.039s)
[387.572332] Starting dynamic subtest: vecs1
[387.599613] Dynamic subtest vecs1: SUCCESS (0.039s)
[387.615501] Starting dynamic subtest: ccs0
[387.640962] Dynamic subtest ccs0: SUCCESS (0.040s)
[387.748943] Subtest after: SUCCESS (0.448s)
[387.992676] [108/134] (640s left) kms_vrr (flip-basic)
[388.179270] Starting subtest: flip-basic
[388.181806] Subtest flip-basic: SKIP (0.000s)
[388.325465] [109/134] (640s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180)
[388.524631] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180
[389.831648] Subtest x-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.307s)
[390.060588] [110/134] (638s left) prime_vgem (basic-write)
[390.151177] Starting subtest: basic-write
[390.157082] Subtest basic-write: SKIP (0.005s)
[390.347700] [111/134] (638s left) kms_cursor_crc (cursor-onscreen-512x512)
[390.816941] Starting subtest: cursor-onscreen-512x512
[390.818730] Subtest cursor-onscreen-512x512: SKIP (0.001s)
[391.078106] [112/134] (637s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-pgflip-blt)
[391.269918] Starting subtest: fbcpsr-2p-scndscrn-indfb-pgflip-blt
[391.271586] Subtest fbcpsr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[391.431525] [113/134] (637s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[391.623256] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[391.624174] Starting dynamic subtest: pipe-A-valid-mode
[394.274983] Dynamic subtest pipe-A-valid-mode: SUCCESS (2.649s)
[394.276729] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (2.653s)
[394.575470] [114/134] (634s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[394.846672] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[394.994104] [115/134] (633s left) kms_hdr (static-swap)
[395.180263] Starting subtest: static-swap
[395.731683] Starting dynamic subtest: pipe-A-DP-3
[396.885516] Dynamic subtest pipe-A-DP-3: SUCCESS (1.154s)
[396.891368] Subtest static-swap: SUCCESS (1.708s)
[397.236433] [116/134] (631s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-cpu)
[397.422901] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-cpu
[399.933530] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (2.511s)
[400.165930] [117/134] (628s left) api_intel_bb (render)
[400.245438] Starting subtest: render
[400.246365] Starting dynamic subtest: render-none-512
[400.293058] Dynamic subtest render-none-512: SUCCESS (0.047s)
[400.303175] Starting dynamic subtest: render-none-1024
[400.369930] Dynamic subtest render-none-1024: SUCCESS (0.076s)
[400.380218] Starting dynamic subtest: render-x-512
[400.390112] Dynamic subtest render-x-512: SUCCESS (0.019s)
[400.402114] Starting dynamic subtest: render-x-1024
[400.456637] Dynamic subtest render-x-1024: SUCCESS (0.065s)
[400.468234] Starting dynamic subtest: render-y-512
[400.476528] Dynamic subtest render-y-512: SUCCESS (0.019s)
[400.488070] Starting dynamic subtest: render-y-1024
[400.536086] Dynamic subtest render-y-1024: SUCCESS (0.058s)
[400.537039] Subtest render: SUCCESS (0.291s)
[400.746686] [118/134] (628s left) kms_selftest (drm_damage_helper)
[400.797261] Starting subtest: drm_damage_helper
[400.809155] Starting dynamic subtest: drm_test_damage_iter_no_damage
[400.896772] Dynamic subtest drm_test_damage_iter_no_damage: SUCCESS (0.087s)
[400.910901] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src
[400.986107] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src: SUCCESS (0.085s)
[401.028343] Starting dynamic subtest: drm_test_damage_iter_no_damage_src_moved
[401.098959] Dynamic subtest drm_test_damage_iter_no_damage_src_moved: SUCCESS (0.107s)
[401.142949] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src_moved
[401.179292] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src_moved: SUCCESS (0.076s)
[401.201560] Starting dynamic subtest: drm_test_damage_iter_no_damage_not_visible
[401.267071] Dynamic subtest drm_test_damage_iter_no_damage_not_visible: SUCCESS (0.085s)
[401.308971] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_crtc
[401.345330] Dynamic subtest drm_test_damage_iter_no_damage_no_crtc: SUCCESS (0.073s)
[401.367470] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_fb
[401.442113] Dynamic subtest drm_test_damage_iter_no_damage_no_fb: SUCCESS (0.094s)
[401.484042] Starting dynamic subtest: drm_test_damage_iter_simple_damage
[401.531780] Dynamic subtest drm_test_damage_iter_simple_damage: SUCCESS (0.084s)
[401.564549] Starting dynamic subtest: drm_test_damage_iter_single_damage
[401.599269] Dynamic subtest drm_test_damage_iter_single_damage: SUCCESS (0.064s)
[401.621321] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_src
[401.682035] Dynamic subtest drm_test_damage_iter_single_damage_intersect_src: SUCCESS (0.081s)
[401.723903] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_src
[401.770815] Dynamic subtest drm_test_damage_iter_single_damage_outside_src: SUCCESS (0.084s)
[401.803876] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src
[401.843429] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src: SUCCESS (0.070s)
[401.877158] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_fractional_src
[401.920618] Dynamic subtest drm_test_damage_iter_single_damage_intersect_fractional_src: SUCCESS (0.073s)
[401.938036] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_fractional_src
[401.984233] Dynamic subtest drm_test_damage_iter_single_damage_outside_fractional_src: SUCCESS (0.062s)
[402.014947] Starting dynamic subtest: drm_test_damage_iter_single_damage_src_moved
[402.075343] Dynamic subtest drm_test_damage_iter_single_damage_src_moved: SUCCESS (0.088s)
[402.118763] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src_moved
[402.151818] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src_moved: SUCCESS (0.072s)
[402.170757] Starting dynamic subtest: drm_test_damage_iter_damage
[402.246111] Dynamic subtest drm_test_damage_iter_damage: SUCCESS (0.091s)
[402.258868] Starting dynamic subtest: drm_test_damage_iter_damage_one_intersect
[402.340477] Dynamic subtest drm_test_damage_iter_damage_one_intersect: SUCCESS (0.091s)
[402.381178] Starting dynamic subtest: drm_test_damage_iter_damage_one_outside
[402.424468] Dynamic subtest drm_test_damage_iter_damage_one_outside: SUCCESS (0.079s)
[402.458238] Starting dynamic subtest: drm_test_damage_iter_damage_src_moved
[402.508497] Dynamic subtest drm_test_damage_iter_damage_src_moved: SUCCESS (0.082s)
[402.519733] Starting dynamic subtest: drm_test_damage_iter_damage_not_visible
[402.587140] Dynamic subtest drm_test_damage_iter_damage_not_visible: SUCCESS (0.076s)
[402.593129] Subtest drm_damage_helper: SUCCESS (1.792s)
[402.832447] [119/134] (626s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-mc-ccs)
[403.022652] Starting subtest: crc-primary-suspend-4-tiled-mtl-mc-ccs
[403.025057] Starting dynamic subtest: pipe-A-DP-3
[403.028656] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[403.038934] Starting dynamic subtest: pipe-B-DP-3
[403.042433] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[403.052366] Starting dynamic subtest: pipe-C-DP-3
[403.055899] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[403.065866] Starting dynamic subtest: pipe-D-DP-3
[403.072040] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[403.073769] Subtest crc-primary-suspend-4-tiled-mtl-mc-ccs: SKIP (0.007s)
[403.492366] [120/134] (625s left) kms_lease (empty-lease)
[403.684262] Starting subtest: empty-lease
[403.685172] Starting dynamic subtest: pipe-A-DP-3
[403.687556] Dynamic subtest pipe-A-DP-3: SUCCESS (0.002s)
[403.699461] Starting dynamic subtest: pipe-B-DP-3
[403.700370] Dynamic subtest pipe-B-DP-3: SUCCESS (0.002s)
[403.710795] Starting dynamic subtest: pipe-C-DP-3
[403.711984] Dynamic subtest pipe-C-DP-3: SUCCESS (0.002s)
[403.722103] Starting dynamic subtest: pipe-D-DP-3
[403.723181] Dynamic subtest pipe-D-DP-3: SUCCESS (0.002s)
[403.724381] Subtest empty-lease: SUCCESS (0.015s)
[403.879892] [121/134] (625s left) kms_content_protection (atomic-dpms-hdcp14)
[404.134374] Starting subtest: atomic-dpms-hdcp14
[404.159272] Starting dynamic subtest: pipe-A-DP-3
[525.361776] Dynamic subtest pipe-A-DP-3: FAIL (121.020s)
[525.363076] Subtest atomic-dpms-hdcp14: FAIL (121.185s)
[525.637522] [122/134] (503s left) syncobj_wait (invalid-multi-wait-unsubmitted)
[525.713377] Starting subtest: invalid-multi-wait-unsubmitted
[525.714259] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[525.885986] [123/134] (503s left) gem_exec_store (dword)
[525.974567] Starting subtest: dword
[525.975492] Starting dynamic subtest: rcs0
[526.066734] Dynamic subtest rcs0: SUCCESS (0.091s)
[526.087479] Starting dynamic subtest: bcs0
[526.111896] Dynamic subtest bcs0: SUCCESS (0.043s)
[526.127012] Starting dynamic subtest: vcs0
[526.156620] Dynamic subtest vcs0: SUCCESS (0.042s)
[526.179908] Starting dynamic subtest: vcs1
[526.203169] Dynamic subtest vcs1: SUCCESS (0.045s)
[526.227181] Starting dynamic subtest: vecs0
[526.249861] Dynamic subtest vecs0: SUCCESS (0.045s)
[526.269738] Starting dynamic subtest: vecs1
[526.295346] Dynamic subtest vecs1: SUCCESS (0.044s)
[526.317833] Starting dynamic subtest: ccs0
[526.339886] Dynamic subtest ccs0: SUCCESS (0.043s)
[526.341051] Subtest dword: SUCCESS (0.366s)
[526.655910] [124/134] (502s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier)
[526.844406] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier
[526.870449] Starting dynamic subtest: pipe-A-plane-0
[526.872241] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[526.882821] Starting dynamic subtest: pipe-A-plane-3
[526.885164] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[526.895294] Starting dynamic subtest: pipe-A-plane-5
[526.897031] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[527.103041] Starting dynamic subtest: pipe-B-plane-0
[527.105042] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[527.121344] Starting dynamic subtest: pipe-B-plane-3
[527.123281] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[527.135630] Starting dynamic subtest: pipe-B-plane-5
[527.137414] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[527.194870] Subtest pixel-format-4-tiled-bmg-ccs-modifier: SKIP (0.350s)
[527.465221] [125/134] (502s left) gem_exec_balancer (nop)
[527.554147] Starting subtest: nop
[577.066493] Subtest nop: SUCCESS (49.511s)
[577.442146] [126/134] (452s left) i915_drm_fdinfo (virtual-busy-idle)
[577.513301] Starting subtest: virtual-busy-idle
[577.515067] Subtest virtual-busy-idle: SKIP (0.000s)
[577.644502] [127/134] (452s left) i915_pm_rpm (gem-idle)
[580.049625] Starting subtest: gem-idle
[585.481412] Subtest gem-idle: SUCCESS (5.436s)
[585.785978] [128/134] (444s left) kms_fbcon_fbt (psr)
[585.872741] Starting subtest: psr
[585.874518] Subtest psr: SKIP (0.000s)
[586.078341] [129/134] (443s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-move)
[586.272403] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-move
[586.274037] Subtest fbcpsr-1p-primscrn-spr-indfb-move: SKIP (0.000s)
[586.474639] [130/134] (443s left) gem_softpin (full)
[586.561381] Starting subtest: full
[586.581449] Subtest full: SUCCESS (0.020s)
[586.758577] [131/134] (443s left) kms_psr (fbc-psr-basic)
[586.945462] Subtest fbc-psr-basic: SKIP (0.000s)
[587.002613] [132/134] (443s left) kms_async_flips (alternate-sync-async-flip-atomic)
[587.188452] Starting subtest: alternate-sync-async-flip-atomic
[587.402314] Starting dynamic subtest: pipe-A-DP-3
[589.719025] Dynamic subtest pipe-A-DP-3: SUCCESS (2.317s)
[589.967209] Starting dynamic subtest: pipe-B-DP-3
[592.089096] Dynamic subtest pipe-B-DP-3: SUCCESS (2.133s)
[592.302565] Starting dynamic subtest: pipe-C-DP-3
[594.418534] Dynamic subtest pipe-C-DP-3: SUCCESS (2.125s)
[594.643624] Starting dynamic subtest: pipe-D-DP-3
[596.726573] Dynamic subtest pipe-D-DP-3: SUCCESS (2.092s)
[596.729452] Subtest alternate-sync-async-flip-atomic: SUCCESS (9.541s)
[597.301215] [133/134] (432s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[597.494183] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[597.495941] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[597.685580] [134/134] (432s left) kms_cursor_crc (cursor-sliding-max-size)
[598.190267] Starting subtest: cursor-sliding-max-size
[598.195808] Subtest cursor-sliding-max-size: SKIP (0.000s)
[598.401770] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: gem_ccs
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: gem_exec_schedule
results: parsing output: 4/ for test: kms_cursor_crc
results: parsing output: 5/ for test: gem_userptr_blits
results: parsing output: 6/ for test: syncobj_timeline
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: gem_exec_capture
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: sysfs_timeslice_duration
results: parsing output: 11/ for test: kms_ccs
results: parsing output: 12/ for test: kms_chamelium_frames
results: parsing output: 13/ for test: gem_exec_fence
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: kms_big_fb
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_big_fb
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: kms_plane_cursor
results: parsing output: 20/ for test: sw_sync
results: parsing output: 21/ for test: drm_read
results: parsing output: 22/ for test: gem_exec_flush
results: parsing output: 23/ for test: gem_cs_tlb
results: parsing output: 24/ for test: kms_big_fb
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: kms_psr2_sf
results: parsing output: 28/ for test: kms_chamelium_audio
results: parsing output: 29/ for test: gem_tiled_wb
results: parsing output: 30/ for test: kms_plane_scaling
results: parsing output: 31/ for test: gem_ctx_persistence
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_psr2_sf
results: parsing output: 34/ for test: vgem_basic
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: kms_cursor_legacy
results: parsing output: 37/ for test: kms_cursor_legacy
results: parsing output: 38/ for test: kms_ccs
results: parsing output: 39/ for test: gem_lmem_swapping
results: parsing output: 40/ for test: syncobj_wait
results: parsing output: 41/ for test: kms_flip
results: parsing output: 42/ for test: syncobj_basic
results: parsing output: 43/ for test: kms_pm_rpm
results: parsing output: 44/ for test: perf_pmu
results: parsing output: 45/ for test: kms_plane
results: parsing output: 46/ for test: kms_psr
results: parsing output: 47/ for test: kms_cursor_legacy
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_pm_rpm
results: parsing output: 50/ for test: kms_ccs
results: parsing output: 51/ for test: syncobj_wait
results: parsing output: 52/ for test: perf_pmu
results: parsing output: 53/ for test: i915_pm_rps
results: parsing output: 54/ for test: kms_psr
results: parsing output: 55/ for test: gem_tiled_blits
results: parsing output: 56/ for test: i915_drm_fdinfo
results: parsing output: 57/ for test: kms_color
results: parsing output: 58/ for test: gem_render_copy
results: parsing output: 59/ for test: api_intel_allocator
results: parsing output: 60/ for test: kms_flip_scaled_crc
results: parsing output: 61/ for test: gem_ctx_shared
results: parsing output: 62/ for test: gem_pxp
results: parsing output: 63/ for test: kms_big_fb
results: parsing output: 64/ for test: core_getstats
results: parsing output: 65/ for test: kms_joiner
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: gem_exec_schedule
results: parsing output: 68/ for test: gem_exec_flush
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_mmap_gtt
results: parsing output: 71/ for test: kms_async_flips
results: parsing output: 72/ for test: gen7_exec_parse
results: parsing output: 73/ for test: syncobj_timeline
results: parsing output: 74/ for test: kms_busy
results: parsing output: 75/ for test: kms_cursor_legacy
results: parsing output: 76/ for test: kms_tiled_display
results: parsing output: 77/ for test: kms_plane
results: parsing output: 78/ for test: gem_exec_create
results: parsing output: 79/ for test: gem_exec_fence
results: parsing output: 80/ for test: gem_ctx_persistence
results: parsing output: 81/ for test: sw_sync
results: parsing output: 82/ for test: kms_cursor_legacy
results: parsing output: 83/ for test: kms_pipe_b_c_ivb
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: syncobj_timeline
results: parsing output: 86/ for test: gem_render_copy
results: parsing output: 87/ for test: gem_exec_params
results: parsing output: 88/ for test: kms_addfb_basic
results: parsing output: 89/ for test: prime_vgem
results: parsing output: 90/ for test: gem_ctx_param
results: parsing output: 91/ for test: gem_mmap_gtt
results: parsing output: 92/ for test: gem_exec_capture
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: syncobj_wait
results: parsing output: 95/ for test: syncobj_timeline
results: parsing output: 96/ for test: kms_draw_crc
results: parsing output: 97/ for test: kms_vrr
results: parsing output: 98/ for test: kms_setmode
results: parsing output: 99/ for test: gem_madvise
results: parsing output: 100/ for test: kms_psr2_sf
results: parsing output: 101/ for test: syncobj_wait
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: gem_mmap_offset
results: parsing output: 104/ for test: gem_lmem_swapping
results: parsing output: 105/ for test: kms_cursor_legacy
results: parsing output: 106/ for test: prime_busy
results: parsing output: 107/ for test: kms_vrr
results: parsing output: 108/ for test: kms_big_fb
results: parsing output: 109/ for test: prime_vgem
results: parsing output: 110/ for test: kms_cursor_crc
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_flip_scaled_crc
results: parsing output: 113/ for test: kms_chamelium_hpd
results: parsing output: 114/ for test: kms_hdr
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: api_intel_bb
results: parsing output: 117/ for test: kms_selftest
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: kms_lease
results: parsing output: 120/ for test: kms_content_protection
results: parsing output: 121/ for test: syncobj_wait
results: parsing output: 122/ for test: gem_exec_store
results: parsing output: 123/ for test: kms_plane
results: parsing output: 124/ for test: gem_exec_balancer
results: parsing output: 125/ for test: i915_drm_fdinfo
results: parsing output: 126/ for test: i915_pm_rpm
results: parsing output: 127/ for test: kms_fbcon_fbt
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: gem_softpin
results: parsing output: 130/ for test: kms_psr
results: parsing output: 131/ for test: kms_async_flips
results: parsing output: 132/ for test: kms_frontbuffer_tracking
results: parsing output: 133/ for test: kms_cursor_crc
Done.