[62.320959] Initializing watchdogs
[62.321030]   /dev/watchdog0
[62.340744] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[62.351270] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[62.355609] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[62.358092] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[62.564227] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt
[62.565945] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[62.757250] [002/133] (960s left) kms_frontbuffer_tracking (fbcpsr-1p-shrfb-fliptrack-mmap-gtt)
[62.944578] Starting subtest: fbcpsr-1p-shrfb-fliptrack-mmap-gtt
[62.946235] Subtest fbcpsr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[63.125352] [003/133] (959s left) kms_cursor_crc (cursor-offscreen-128x42)
[63.515290] Starting subtest: cursor-offscreen-128x42
[63.531115] Starting dynamic subtest: pipe-A-DP-3
[66.116796] Dynamic subtest pipe-A-DP-3: SUCCESS (2.585s)
[66.161925] Starting dynamic subtest: pipe-D-DP-3
[68.597786] Dynamic subtest pipe-D-DP-3: SUCCESS (2.442s)
[68.598844] Subtest cursor-offscreen-128x42: SUCCESS (5.082s)
[69.040491] [004/133] (954s left) i915_suspend (forcewake)
[69.120034] Starting subtest: forcewake
[109.885420] Subtest forcewake: SUCCESS (11.236s)
[110.007237] [005/133] (913s left) gem_partial_pwrite_pread (writes-after-reads-uncached)
[110.088217] Subtest writes-after-reads-uncached: SKIP (0.000s)
[110.173080] [006/133] (913s left) i915_drm_fdinfo (virtual-busy-hang-all)
[110.234039] Starting subtest: virtual-busy-hang-all
[110.235834] Subtest virtual-busy-hang-all: SKIP (0.000s)
[110.386464] [007/133] (912s left) kms_plane (pixel-format-y-tiled-modifier)
[110.563514] Starting subtest: pixel-format-y-tiled-modifier
[110.565153] Subtest pixel-format-y-tiled-modifier: SKIP (0.000s)
[110.736615] [008/133] (912s left) gem_mmap_gtt (fault-concurrent)
[110.806731] Subtest fault-concurrent: SKIP (0.000s)
[110.866821] [009/133] (912s left) kms_flip_tiling (flip-change-tiling)
[111.044681] Starting subtest: flip-change-tiling
[111.045540] Starting dynamic subtest: pipe-A-DP-3-4-to-4
[111.292000] Dynamic subtest pipe-A-DP-3-4-to-4: SUCCESS (0.249s)
[111.312957] Starting dynamic subtest: pipe-A-DP-3-4-to-x
[111.491222] Dynamic subtest pipe-A-DP-3-4-to-x: SUCCESS (0.200s)
[111.531834] Starting dynamic subtest: pipe-A-DP-3-4-to-linear
[111.706473] Dynamic subtest pipe-A-DP-3-4-to-linear: SUCCESS (0.216s)
[111.744994] Starting dynamic subtest: pipe-A-DP-3-x-to-4
[111.921818] Dynamic subtest pipe-A-DP-3-x-to-4: SUCCESS (0.216s)
[111.935336] Starting dynamic subtest: pipe-A-DP-3-x-to-x
[112.070230] Dynamic subtest pipe-A-DP-3-x-to-x: SUCCESS (0.149s)
[112.103586] Starting dynamic subtest: pipe-A-DP-3-x-to-linear
[112.286336] Dynamic subtest pipe-A-DP-3-x-to-linear: SUCCESS (0.216s)
[112.300288] Starting dynamic subtest: pipe-A-DP-3-linear-to-4
[112.483923] Dynamic subtest pipe-A-DP-3-linear-to-4: SUCCESS (0.199s)
[112.503225] Starting dynamic subtest: pipe-A-DP-3-linear-to-x
[112.683859] Dynamic subtest pipe-A-DP-3-linear-to-x: SUCCESS (0.200s)
[112.697249] Starting dynamic subtest: pipe-A-DP-3-linear-to-linear
[112.832418] Dynamic subtest pipe-A-DP-3-linear-to-linear: SUCCESS (0.149s)
[112.895493] Starting dynamic subtest: pipe-B-DP-3-4-to-4
[113.210054] Dynamic subtest pipe-B-DP-3-4-to-4: SUCCESS (0.327s)
[113.248505] Starting dynamic subtest: pipe-B-DP-3-4-to-x
[113.374809] Dynamic subtest pipe-B-DP-3-4-to-x: SUCCESS (0.166s)
[113.394426] Starting dynamic subtest: pipe-B-DP-3-4-to-linear
[113.523984] Dynamic subtest pipe-B-DP-3-4-to-linear: SUCCESS (0.150s)
[113.551772] Starting dynamic subtest: pipe-B-DP-3-x-to-4
[113.689840] Dynamic subtest pipe-B-DP-3-x-to-4: SUCCESS (0.166s)
[113.717175] Starting dynamic subtest: pipe-B-DP-3-x-to-x
[113.839321] Dynamic subtest pipe-B-DP-3-x-to-x: SUCCESS (0.149s)
[113.872766] Starting dynamic subtest: pipe-B-DP-3-x-to-linear
[114.005096] Dynamic subtest pipe-B-DP-3-x-to-linear: SUCCESS (0.166s)
[114.039444] Starting dynamic subtest: pipe-B-DP-3-linear-to-4
[114.170782] Dynamic subtest pipe-B-DP-3-linear-to-4: SUCCESS (0.166s)
[114.198178] Starting dynamic subtest: pipe-B-DP-3-linear-to-x
[114.336658] Dynamic subtest pipe-B-DP-3-linear-to-x: SUCCESS (0.166s)
[114.359617] Starting dynamic subtest: pipe-B-DP-3-linear-to-linear
[114.485898] Dynamic subtest pipe-B-DP-3-linear-to-linear: SUCCESS (0.149s)
[114.529866] Starting dynamic subtest: pipe-C-DP-3-4-to-4
[114.848096] Dynamic subtest pipe-C-DP-3-4-to-4: SUCCESS (0.329s)
[114.862014] Starting dynamic subtest: pipe-C-DP-3-4-to-x
[114.997283] Dynamic subtest pipe-C-DP-3-4-to-x: SUCCESS (0.149s)
[115.034626] Starting dynamic subtest: pipe-C-DP-3-4-to-linear
[115.162545] Dynamic subtest pipe-C-DP-3-4-to-linear: SUCCESS (0.166s)
[115.181763] Starting dynamic subtest: pipe-C-DP-3-x-to-4
[115.311819] Dynamic subtest pipe-C-DP-3-x-to-4: SUCCESS (0.149s)
[115.322757] Starting dynamic subtest: pipe-C-DP-3-x-to-x
[115.444873] Dynamic subtest pipe-C-DP-3-x-to-x: SUCCESS (0.133s)
[115.472185] Starting dynamic subtest: pipe-C-DP-3-x-to-linear
[115.594918] Dynamic subtest pipe-C-DP-3-x-to-linear: SUCCESS (0.150s)
[115.631587] Starting dynamic subtest: pipe-C-DP-3-linear-to-4
[115.760116] Dynamic subtest pipe-C-DP-3-linear-to-4: SUCCESS (0.165s)
[115.773003] Starting dynamic subtest: pipe-C-DP-3-linear-to-x
[115.892979] Dynamic subtest pipe-C-DP-3-linear-to-x: SUCCESS (0.133s)
[115.904633] Starting dynamic subtest: pipe-C-DP-3-linear-to-linear
[116.025924] Dynamic subtest pipe-C-DP-3-linear-to-linear: SUCCESS (0.133s)
[116.069717] Starting dynamic subtest: pipe-D-DP-3-4-to-4
[116.388263] Dynamic subtest pipe-D-DP-3-4-to-4: SUCCESS (0.329s)
[116.402300] Starting dynamic subtest: pipe-D-DP-3-4-to-x
[116.520219] Dynamic subtest pipe-D-DP-3-4-to-x: SUCCESS (0.132s)
[116.532816] Starting dynamic subtest: pipe-D-DP-3-4-to-linear
[116.653137] Dynamic subtest pipe-D-DP-3-4-to-linear: SUCCESS (0.133s)
[116.680179] Starting dynamic subtest: pipe-D-DP-3-x-to-4
[116.819270] Dynamic subtest pipe-D-DP-3-x-to-4: SUCCESS (0.166s)
[116.832541] Starting dynamic subtest: pipe-D-DP-3-x-to-x
[116.952583] Dynamic subtest pipe-D-DP-3-x-to-x: SUCCESS (0.133s)
[116.974876] Starting dynamic subtest: pipe-D-DP-3-x-to-linear
[117.101533] Dynamic subtest pipe-D-DP-3-x-to-linear: SUCCESS (0.149s)
[117.123234] Starting dynamic subtest: pipe-D-DP-3-linear-to-4
[117.251094] Dynamic subtest pipe-D-DP-3-linear-to-4: SUCCESS (0.150s)
[117.263130] Starting dynamic subtest: pipe-D-DP-3-linear-to-x
[117.384168] Dynamic subtest pipe-D-DP-3-linear-to-x: SUCCESS (0.133s)
[117.411390] Starting dynamic subtest: pipe-D-DP-3-linear-to-linear
[117.533379] Dynamic subtest pipe-D-DP-3-linear-to-linear: SUCCESS (0.149s)
[117.566416] Subtest flip-change-tiling: SUCCESS (6.556s)
[117.941744] [010/133] (905s left) vgem_basic (unload)
[117.984619] Starting subtest: unload
[147.066685] Subtest unload: SUCCESS (29.103s)
[147.226078] [FACT vgem_basic (unload)] new: kernel.kmod_is_loaded.vgem: true
[147.228083] [011/133] (876s left) gem_mmap_gtt (basic-write-read)
[147.303567] Subtest basic-write-read: SKIP (0.000s)
[147.365292] [012/133] (876s left) kms_pm_rpm (modeset-lpsp-stress-no-wait)
[149.586352] Starting subtest: modeset-lpsp-stress-no-wait
[149.769479] Subtest modeset-lpsp-stress-no-wait: SKIP (0.182s)
[150.021396] [013/133] (873s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions)
[150.210603] Starting subtest: short-flip-after-cursor-atomic-transitions
[151.259853] Subtest short-flip-after-cursor-atomic-transitions: SUCCESS (1.049s)
[151.597292] [014/133] (872s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[151.782642] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling
[151.783591] Starting dynamic subtest: pipe-A-valid-mode
[154.146647] Dynamic subtest pipe-A-valid-mode: SUCCESS (2.361s)
[154.147999] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SUCCESS (2.363s)
[154.469199] [015/133] (869s left) kms_psr (fbc-psr2-sprite-plane-onoff)
[154.655102] Subtest fbc-psr2-sprite-plane-onoff: SKIP (0.000s)
[154.721714] [016/133] (869s left) syncobj_basic (bad-fd-to-handle)
[154.801677] Starting subtest: bad-fd-to-handle
[154.802555] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[154.940162] [017/133] (869s left) syncobj_wait (multi-wait-submitted-signaled)
[155.020693] Starting subtest: multi-wait-submitted-signaled
[155.021642] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[155.192187] [018/133] (868s left) kms_color (invalid-ctm-matrix-sizes)
[155.379552] Starting subtest: invalid-ctm-matrix-sizes
[155.380426] Starting dynamic subtest: pipe-A
[155.382868] Dynamic subtest pipe-A: SUCCESS (0.003s)
[155.392622] Starting dynamic subtest: pipe-B
[155.393517] Dynamic subtest pipe-B: SUCCESS (0.004s)
[155.403338] Starting dynamic subtest: pipe-C
[155.404476] Dynamic subtest pipe-C: SUCCESS (0.006s)
[155.414120] Starting dynamic subtest: pipe-D
[155.415349] Dynamic subtest pipe-D: SUCCESS (0.006s)
[155.416492] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.019s)
[155.565406] [019/133] (868s left) kms_big_fb (yf-tiled-64bpp-rotate-0)
[155.770060] Starting subtest: yf-tiled-64bpp-rotate-0
[155.771884] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s)
[155.936134] [020/133] (868s left) gen7_exec_parse (batch-without-end)
[156.023890] Subtest batch-without-end: SKIP (0.000s)
[156.137280] [021/133] (868s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[156.338445] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[157.029889] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.692s)
[157.309931] [022/133] (867s left) gem_ctx_persistence (heartbeat-stop)
[157.396996] Starting subtest: heartbeat-stop
[157.398920] Subtest heartbeat-stop: SKIP (0.000s)
[157.610620] [023/133] (866s left) gem_userptr_blits (mmap-offset-banned)
[157.703186] Starting subtest: mmap-offset-banned
[157.704123] Starting dynamic subtest: fixed
[157.704975] Dynamic subtest fixed: SUCCESS (0.000s)
[157.705872] Subtest mmap-offset-banned: SUCCESS (0.000s)
[157.911765] [024/133] (866s left) kms_big_fb (4-tiled-8bpp-rotate-90)
[158.103998] Starting subtest: 4-tiled-8bpp-rotate-90
[158.163947] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.060s)
[158.396711] [025/133] (866s left) gem_exec_whisper (basic-fds)
[158.483055] Starting subtest: basic-fds
[167.817956] Subtest basic-fds: SUCCESS (9.334s)
[168.106393] [026/133] (856s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-blt)
[168.292460] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-blt
[168.294059] Subtest fbc-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[168.474531] [027/133] (856s left) gem_mmap_wc (close)
[168.553627] Subtest close: SKIP (0.000s)
[168.621414] [028/133] (856s left) kms_async_flips (async-flip-hang)
[168.808762] Starting subtest: async-flip-hang
[169.036706] Starting dynamic subtest: pipe-A-DP-3
[195.016046] Dynamic subtest pipe-A-DP-3: SUCCESS (25.980s)
[195.233551] Starting dynamic subtest: pipe-B-DP-3
[221.007203] Dynamic subtest pipe-B-DP-3: SUCCESS (25.784s)
[221.179110] Starting dynamic subtest: pipe-C-DP-3
[246.016949] Dynamic subtest pipe-C-DP-3: SUCCESS (24.847s)
[246.196945] Starting dynamic subtest: pipe-D-DP-3
[260.990747] Dynamic subtest pipe-D-DP-3: SUCCESS (14.805s)
[260.991688] Subtest async-flip-hang: SUCCESS (92.182s)
[261.482366] [029/133] (763s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[261.670061] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[261.671759] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[261.864993] [030/133] (763s left) perf (enable-disable)
[262.264370] Starting subtest: enable-disable
[262.265181] Starting dynamic subtest: 0-rcs0
[264.516375] Dynamic subtest 0-rcs0: SUCCESS (2.252s)
[264.517218] Subtest enable-disable: SUCCESS (2.252s)
[264.580468] [031/133] (760s left) gem_mmap (basic)
[264.660897] Subtest basic: SKIP (0.000s)
[264.768587] [032/133] (760s left) gem_exec_balancer (fairslice)
[264.859168] Starting subtest: fairslice
[270.431347] Subtest fairslice: SUCCESS (5.572s)
[270.848493] [033/133] (754s left) gem_exec_reloc (basic-wc-cpu-active)
[270.932014] Subtest basic-wc-cpu-active: SKIP (0.000s)
[271.013241] [034/133] (754s left) kms_big_fb (y-tiled-64bpp-rotate-90)
[271.208785] Starting subtest: y-tiled-64bpp-rotate-90
[271.210652] Subtest y-tiled-64bpp-rotate-90: SKIP (0.000s)
[271.419175] [035/133] (753s left) kms_flip (2x-flip-vs-dpms-on-nop-interruptible)
[271.615617] Starting subtest: 2x-flip-vs-dpms-on-nop-interruptible
[271.630065] Subtest 2x-flip-vs-dpms-on-nop-interruptible: SKIP (0.014s)
[271.751431] [036/133] (753s left) gem_spin_batch (legacy)
[271.837338] Starting subtest: legacy
[271.838209] Starting dynamic subtest: default
[275.104093] Dynamic subtest default: SUCCESS (3.263s)
[275.117371] Starting dynamic subtest: render
[278.340818] Dynamic subtest render: SUCCESS (3.235s)
[278.355615] Starting dynamic subtest: bsd
[281.580212] Dynamic subtest bsd: SUCCESS (3.237s)
[281.591829] Starting dynamic subtest: bsd1
[284.815015] Dynamic subtest bsd1: SUCCESS (3.232s)
[284.857172] Starting dynamic subtest: bsd2
[288.056055] Dynamic subtest bsd2: SUCCESS (3.239s)
[288.070841] Starting dynamic subtest: blt
[291.294100] Dynamic subtest blt: SUCCESS (3.235s)
[291.308825] Starting dynamic subtest: vebox
[294.532634] Dynamic subtest vebox: SUCCESS (3.235s)
[294.534601] Subtest legacy: SUCCESS (22.694s)
[294.784723] [037/133] (730s left) kms_flip (flip-vs-panning)
[294.980728] Starting subtest: flip-vs-panning
[294.984854] Starting dynamic subtest: A-DP3
[302.831987] Dynamic subtest A-DP3: SUCCESS (7.846s)
[302.872264] Starting dynamic subtest: B-DP3
[310.659250] Dynamic subtest B-DP3: SUCCESS (7.824s)
[310.695408] Starting dynamic subtest: C-DP3
[318.482201] Dynamic subtest C-DP3: SUCCESS (7.820s)
[318.518337] Starting dynamic subtest: D-DP3
[326.307267] Dynamic subtest D-DP3: SUCCESS (7.822s)
[326.314587] Subtest flip-vs-panning: SUCCESS (31.334s)
[326.712241] [038/133] (698s left) kms_lease (implicit-plane-lease)
[326.898477] Starting subtest: implicit-plane-lease
[326.902609] Subtest implicit-plane-lease: SUCCESS (0.004s)
[327.074486] [039/133] (698s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render)
[327.270555] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render
[327.272254] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[327.471346] [040/133] (698s left) kms_selftest (drm_dp_mst_helper)
[327.519276] Starting subtest: drm_dp_mst_helper
[327.553986] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[327.645835] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.092s)
[327.657988] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[327.755481] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.109s)
[327.776673] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[327.872293] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.114s)
[327.873952] Subtest drm_dp_mst_helper: SUCCESS (0.352s)
[328.098808] [041/133] (697s left) i915_query (query-topology-unsupported)
[328.176950] Starting subtest: query-topology-unsupported
[328.178854] Subtest query-topology-unsupported: SKIP (0.000s)
[328.372845] [042/133] (697s left) gem_eio (in-flight-10ms)
[328.692825] Starting subtest: in-flight-10ms
[333.768046] Subtest in-flight-10ms: SUCCESS (5.075s)
[334.005472] [043/133] (691s left) kms_busy (extended-modeset-hang-oldfb-with-reset)
[334.208989] Starting subtest: extended-modeset-hang-oldfb-with-reset
[334.209885] Starting dynamic subtest: pipe-A
[344.829261] Dynamic subtest pipe-A: SUCCESS (10.618s)
[344.852324] Starting dynamic subtest: pipe-D
[355.521568] Dynamic subtest pipe-D: SUCCESS (10.685s)
[355.522918] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (21.313s)
[355.793703] [044/133] (670s left) kms_psr (psr-sprite-render)
[355.982757] Subtest psr-sprite-render: SKIP (0.000s)
[356.042010] [045/133] (670s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move)
[356.230451] Starting subtest: psr-1p-primscrn-cur-indfb-move
[356.231934] Subtest psr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[356.410638] [046/133] (669s left) gem_mmap_offset (blt-coherency)
[356.484756] Starting subtest: blt-coherency
[356.520924] Subtest blt-coherency: SUCCESS (0.036s)
[356.694531] [047/133] (669s left) kms_cursor_edge_walk (256x256-top-bottom)
[356.880117] Starting subtest: 256x256-top-bottom
[356.882085] Starting dynamic subtest: pipe-A-DP-3
[360.333936] Dynamic subtest pipe-A-DP-3: SUCCESS (3.451s)
[360.347273] Starting dynamic subtest: pipe-D-DP-3
[363.692523] Dynamic subtest pipe-D-DP-3: SUCCESS (3.356s)
[363.693892] Subtest 256x256-top-bottom: SUCCESS (6.812s)
[364.028260] [048/133] (662s left) gem_reg_read (timestamp-moving)
[364.105193] Starting subtest: timestamp-moving
[365.105931] Subtest timestamp-moving: SUCCESS (1.001s)
[365.257542] [049/133] (661s left) kms_feature_discovery (display-1x)
[365.448993] Starting subtest: display-1x
[365.449899] Subtest display-1x: SUCCESS (0.000s)
[365.582625] [050/133] (660s left) gem_eio (wait-wedge-immediate)
[365.885852] Starting subtest: wait-wedge-immediate
[367.383922] Subtest wait-wedge-immediate: SUCCESS (1.499s)
[367.638943] [051/133] (658s left) gem_fence_thrash (bo-copy)
[367.685252] Starting subtest: bo-copy
[367.716856] Subtest bo-copy: SKIP (0.031s)
[367.785933] [052/133] (658s left) gem_partial_pwrite_pread (write)
[367.871278] Subtest write: SKIP (0.000s)
[367.951885] [053/133] (658s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-pwrite)
[368.141076] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-pwrite
[368.142745] Subtest psr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[368.323639] [054/133] (658s left) gem_mmap_gtt (basic-small-bo-tiledy)
[368.400838] Subtest basic-small-bo-tiledY: SKIP (0.000s)
[368.504226] [055/133] (658s left) gem_exec_schedule (fifo)
[368.608632] Starting subtest: fifo
[368.609687] Starting dynamic subtest: rcs0
[368.891320] Dynamic subtest rcs0: SUCCESS (0.282s)
[368.903068] Starting dynamic subtest: bcs0
[369.096653] Dynamic subtest bcs0: SUCCESS (0.201s)
[369.108853] Starting dynamic subtest: vcs0
[369.299666] Dynamic subtest vcs0: SUCCESS (0.206s)
[369.310914] Starting dynamic subtest: vcs1
[369.504688] Dynamic subtest vcs1: SUCCESS (0.204s)
[369.516546] Starting dynamic subtest: vecs0
[369.711890] Dynamic subtest vecs0: SUCCESS (0.206s)
[369.723739] Starting dynamic subtest: vecs1
[369.920337] Dynamic subtest vecs1: SUCCESS (0.208s)
[369.932328] Starting dynamic subtest: ccs0
[370.131704] Dynamic subtest ccs0: SUCCESS (0.211s)
[370.132859] Subtest fifo: SUCCESS (1.523s)
[370.690462] [056/133] (656s left) i915_pm_rpm (gem-execbuf)
[372.610850] Starting subtest: gem-execbuf
[372.612076] Starting dynamic subtest: lmem0
[376.723797] Dynamic subtest lmem0: SUCCESS (4.112s)
[376.742865] Starting dynamic subtest: smem0
[377.978512] Dynamic subtest smem0: SUCCESS (1.250s)
[377.983922] Subtest gem-execbuf: SUCCESS (5.372s)
[378.445546] [057/133] (648s left) i915_drm_fdinfo (memory-info-active)
[378.515264] Starting subtest: memory-info-active
[378.516160] Starting dynamic subtest: lmem0
[382.209236] Dynamic subtest lmem0: SUCCESS (3.692s)
[382.247012] Starting dynamic subtest: smem0
[386.229514] Dynamic subtest smem0: SUCCESS (4.006s)
[386.230786] Subtest memory-info-active: SUCCESS (7.705s)
[386.349814] [058/133] (640s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[386.626391] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[386.784997] [059/133] (640s left) gem_fence_thrash (bo-write-verify-threaded-none)
[386.830634] Starting subtest: bo-write-verify-threaded-none
[386.865854] Subtest bo-write-verify-threaded-none: SKIP (0.034s)
[386.945525] [060/133] (640s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move)
[387.135655] Starting subtest: psr-2p-scndscrn-cur-indfb-move
[387.137146] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[387.327753] [061/133] (639s left) gem_ctx_param (invalid-set-ringsize)
[387.405279] Starting subtest: invalid-set-ringsize
[387.406202] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[387.560225] [062/133] (639s left) kms_plane_multiple (tiling-x)
[387.744604] Starting subtest: tiling-x
[387.746945] Starting dynamic subtest: pipe-A-DP-3
[388.869747] Dynamic subtest pipe-A-DP-3: SUCCESS (1.123s)
[388.887024] Starting dynamic subtest: pipe-B-DP-3
[389.984330] Dynamic subtest pipe-B-DP-3: SUCCESS (1.113s)
[389.998142] Starting dynamic subtest: pipe-C-DP-3
[391.038756] Dynamic subtest pipe-C-DP-3: SUCCESS (1.052s)
[391.051276] Starting dynamic subtest: pipe-D-DP-3
[392.112882] Dynamic subtest pipe-D-DP-3: SUCCESS (1.072s)
[392.113759] Subtest tiling-x: SUCCESS (4.368s)
[392.402204] [063/133] (634s left) kms_chamelium_hpd (hdmi-hpd-enable-disable-mode)
[392.677821] Subtest hdmi-hpd-enable-disable-mode: SKIP (0.000s)
[392.832433] [064/133] (634s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset)
[393.020115] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset
[393.035431] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset: SKIP (0.014s)
[393.188187] [065/133] (634s left) syncobj_timeline (multi-wait-signaled)
[393.269094] Starting subtest: multi-wait-signaled
[393.269994] Subtest multi-wait-signaled: SUCCESS (0.001s)
[393.467173] [066/133] (634s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite)
[393.659881] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite
[393.661602] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[393.859078] [067/133] (633s left) syncobj_wait (multi-wait-for-submit-signaled)
[393.937146] Starting subtest: multi-wait-for-submit-signaled
[393.938113] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s)
[394.095173] [068/133] (633s left) gem_exec_schedule (preempt-queue-contexts-chain)
[394.193214] Subtest preempt-queue-contexts-chain: SKIP (0.000s)
[394.590315] [069/133] (633s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-onoff)
[394.784846] Starting subtest: psr-2p-scndscrn-spr-indfb-onoff
[394.786590] Subtest psr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[394.975355] [070/133] (632s left) gem_gpgpu_fill (basic)
[395.051895] Starting subtest: basic
[395.052867] Starting dynamic subtest: smem
[395.085956] Dynamic subtest smem: SUCCESS (0.034s)
[395.099849] Starting dynamic subtest: lmem0
[395.100729] Dynamic subtest lmem0: SUCCESS (0.013s)
[395.101619] Subtest basic: SUCCESS (0.049s)
[395.311169] [071/133] (632s left) prime_busy (hang)
[395.395999] Starting subtest: hang
[395.397099] Starting dynamic subtest: rcs0
[422.025476] Dynamic subtest rcs0: SUCCESS (26.627s)
[422.037867] Starting dynamic subtest: bcs0
[429.185649] Dynamic subtest bcs0: SUCCESS (7.160s)
[429.198185] Starting dynamic subtest: vcs0
[436.160466] Dynamic subtest vcs0: SUCCESS (6.974s)
[436.172937] Starting dynamic subtest: vcs1
[443.150140] Dynamic subtest vcs1: SUCCESS (6.987s)
[443.162528] Starting dynamic subtest: vecs0
[450.186940] Dynamic subtest vecs0: SUCCESS (7.035s)
[450.199355] Starting dynamic subtest: vecs1
[457.160211] Dynamic subtest vecs1: SUCCESS (6.974s)
[457.173690] Starting dynamic subtest: ccs0
[471.051321] Dynamic subtest ccs0: SUCCESS (13.888s)
[471.052158] Subtest hang: SUCCESS (75.655s)
[471.240499] [072/133] (556s left) kms_atomic (atomic-invalid-params)
[471.425979] Starting subtest: atomic-invalid-params
[471.426882] Starting dynamic subtest: pipe-A-DP-3
[471.989889] Dynamic subtest pipe-A-DP-3: SUCCESS (0.563s)
[471.990904] Subtest atomic-invalid-params: SUCCESS (0.565s)
[472.319060] [073/133] (555s left) gem_exec_reloc (basic-write-wc-active)
[472.405589] Subtest basic-write-wc-active: SKIP (0.000s)
[472.483813] [074/133] (555s left) gem_userptr_blits (invalid-null-pointer)
[472.566873] Starting subtest: invalid-null-pointer
[472.567799] Subtest invalid-null-pointer: SUCCESS (0.001s)
[472.738250] [075/133] (555s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area-big-fb)
[472.932553] Subtest pr-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s)
[472.983688] [076/133] (555s left) kms_ccs (random-ccs-data-y-tiled-ccs)
[473.166437] Starting subtest: random-ccs-data-y-tiled-ccs
[473.168894] Starting dynamic subtest: pipe-A-DP-3
[473.177948] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[473.190074] Starting dynamic subtest: pipe-B-DP-3
[473.199498] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[473.211259] Starting dynamic subtest: pipe-C-DP-3
[473.220191] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[473.232314] Starting dynamic subtest: pipe-D-DP-3
[473.244232] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[473.246160] Subtest random-ccs-data-y-tiled-ccs: SKIP (0.007s)
[473.666204] [077/133] (554s left) kms_addfb_basic (invalid-get-prop-any)
[473.745455] Starting subtest: invalid-get-prop-any
[473.746269] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[474.018341] [078/133] (554s left) perf_pmu (busy-idle-check-all)
[474.089972] Starting subtest: busy-idle-check-all
[474.090921] Starting dynamic subtest: rcs0
[474.777926] Dynamic subtest rcs0: SUCCESS (0.687s)
[474.795179] Starting dynamic subtest: bcs0
[475.436219] Dynamic subtest bcs0: SUCCESS (0.656s)
[475.458104] Starting dynamic subtest: vcs0
[476.098935] Dynamic subtest vcs0: SUCCESS (0.658s)
[476.121139] Starting dynamic subtest: vcs1
[476.760953] Dynamic subtest vcs1: SUCCESS (0.658s)
[476.778502] Starting dynamic subtest: vecs0
[477.421152] Dynamic subtest vecs0: SUCCESS (0.658s)
[477.442970] Starting dynamic subtest: vecs1
[478.084301] Dynamic subtest vecs1: SUCCESS (0.658s)
[478.106934] Starting dynamic subtest: ccs0
[478.747174] Dynamic subtest ccs0: SUCCESS (0.658s)
[478.752869] Subtest busy-idle-check-all: SUCCESS (4.659s)
[478.942143] [079/133] (549s left) gem_exec_schedule (preempt-queue-contexts)
[479.042064] Subtest preempt-queue-contexts: SKIP (0.000s)
[479.418575] [080/133] (549s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs)
[479.604471] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs
[479.606872] Starting dynamic subtest: pipe-A-DP-3
[479.614760] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[479.627443] Starting dynamic subtest: pipe-B-DP-3
[479.635166] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[479.647656] Starting dynamic subtest: pipe-C-DP-3
[479.655594] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[479.668138] Starting dynamic subtest: pipe-D-DP-3
[479.678073] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[479.680197] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SKIP (0.007s)
[480.079742] [081/133] (548s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[480.469018] Starting subtest: cursor-rapid-movement-128x42
[480.472720] Starting dynamic subtest: pipe-A-DP-3
[480.940181] Dynamic subtest pipe-A-DP-3: SUCCESS (0.467s)
[480.990079] Starting dynamic subtest: pipe-D-DP-3
[481.383597] Dynamic subtest pipe-D-DP-3: SUCCESS (0.405s)
[481.384532] Subtest cursor-rapid-movement-128x42: SUCCESS (0.916s)
[481.837253] [082/133] (546s left) perf (gen12-group-exclusive-stream-sample-oa)
[482.094268] Starting subtest: gen12-group-exclusive-stream-sample-oa
[482.116096] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.020s)
[482.179413] [083/133] (546s left) kms_plane (pixel-format-linear-modifier-source-clamping)
[482.371497] Starting subtest: pixel-format-linear-modifier-source-clamping
[482.397683] Starting dynamic subtest: pipe-A-plane-0
[488.547806] Dynamic subtest pipe-A-plane-0: SUCCESS (6.150s)
[488.580869] Starting dynamic subtest: pipe-A-plane-3
[491.797632] Dynamic subtest pipe-A-plane-3: SUCCESS (3.248s)
[492.049552] Starting dynamic subtest: pipe-B-plane-0
[498.126348] Dynamic subtest pipe-B-plane-0: SUCCESS (6.099s)
[498.144250] Starting dynamic subtest: pipe-B-plane-3
[501.093052] Dynamic subtest pipe-B-plane-3: SUCCESS (2.965s)
[501.183860] Subtest pixel-format-linear-modifier-source-clamping: SUCCESS (18.812s)
[501.561976] [084/133] (527s left) kms_psr (pr-cursor-mmap-cpu)
[501.746899] Subtest pr-cursor-mmap-cpu: SKIP (0.000s)
[501.806636] [085/133] (527s left) gem_exec_fence (basic-await)
[502.014077] Starting subtest: basic-await
[502.015002] Starting dynamic subtest: rcs0
[502.122862] Dynamic subtest rcs0: SUCCESS (0.114s)
[502.135955] Starting dynamic subtest: bcs0
[502.207485] Dynamic subtest bcs0: SUCCESS (0.084s)
[502.225467] Starting dynamic subtest: vcs0
[502.297689] Dynamic subtest vcs0: SUCCESS (0.089s)
[502.315219] Starting dynamic subtest: vcs1
[502.387094] Dynamic subtest vcs1: SUCCESS (0.088s)
[502.405535] Starting dynamic subtest: vecs0
[502.479090] Dynamic subtest vecs0: SUCCESS (0.091s)
[502.496348] Starting dynamic subtest: vecs1
[502.568436] Dynamic subtest vecs1: SUCCESS (0.088s)
[502.586037] Starting dynamic subtest: ccs0
[502.658302] Dynamic subtest ccs0: SUCCESS (0.089s)
[502.659261] Subtest basic-await: SUCCESS (0.651s)
[503.496787] [086/133] (525s left) syncobj_timeline (signal-point-0)
[503.574167] Starting subtest: signal-point-0
[503.575167] Subtest signal-point-0: SUCCESS (0.000s)
[503.741474] [087/133] (525s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[503.929863] Starting subtest: psr-farfromfence-mmap-gtt
[503.931615] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[504.110343] [088/133] (525s left) dumb_buffer (map-uaf)
[504.188209] Starting subtest: map-uaf
[504.208413] Subtest map-uaf: SUCCESS (0.021s)
[504.434944] [089/133] (524s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip)
[504.633973] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip
[504.635861] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[504.827025] [090/133] (524s left) sysfs_heartbeat_interval (precise)
[504.910867] Starting subtest: precise
[504.911858] Starting dynamic subtest: vecs0
[506.544926] Dynamic subtest vecs0: SUCCESS (1.633s)
[506.559457] Starting dynamic subtest: ccs0
[509.791891] Dynamic subtest ccs0: SUCCESS (3.246s)
[509.806522] Starting dynamic subtest: vcs0
[511.278966] Dynamic subtest vcs0: SUCCESS (1.486s)
[511.293074] Starting dynamic subtest: bcs0
[512.740985] Dynamic subtest bcs0: SUCCESS (1.461s)
[512.755752] Starting dynamic subtest: vecs1
[514.276056] Dynamic subtest vecs1: SUCCESS (1.534s)
[514.292736] Starting dynamic subtest: rcs0
[515.764785] Dynamic subtest rcs0: SUCCESS (1.487s)
[515.778264] Starting dynamic subtest: vcs1
[517.271830] Dynamic subtest vcs1: SUCCESS (1.506s)
[517.272753] Subtest precise: SUCCESS (12.361s)
[517.445200] [091/133] (511s left) kms_addfb_basic (too-high)
[517.633966] Starting subtest: too-high
[517.634802] Subtest too-high: SUCCESS (0.001s)
[517.797494] [092/133] (511s left) gem_ctx_engines (execute-one)
[517.892984] Starting subtest: execute-one
[521.249831] Subtest execute-one: SUCCESS (3.358s)
[521.576174] [093/133] (507s left) gem_mmap_offset (ptrace)
[521.653207] Starting subtest: ptrace
[521.655991] Starting dynamic subtest: lmem0-fixed
[521.780430] Dynamic subtest lmem0-fixed: SUCCESS (0.124s)
[521.796036] Starting dynamic subtest: smem0-fixed
[521.799284] Dynamic subtest smem0-fixed: SUCCESS (0.015s)
[521.800129] Subtest ptrace: SUCCESS (0.148s)
[521.992584] [094/133] (507s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render)
[522.182740] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render
[522.184449] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[522.353626] [095/133] (507s left) api_intel_bb (object-reloc-keep-cache)
[522.429301] Starting subtest: object-reloc-keep-cache
[522.431051] Subtest object-reloc-keep-cache: SKIP (0.002s)
[522.604564] [096/133] (507s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[522.792116] Starting subtest: basic-flip-before-cursor-atomic
[523.830663] Subtest basic-flip-before-cursor-atomic: SUCCESS (1.038s)
[524.179178] [097/133] (505s left) gem_render_copy (yf-tiled-ccs-to-y-tiled)
[524.263347] Starting subtest: yf-tiled-ccs-to-y-tiled
[524.265125] Subtest yf-tiled-ccs-to-y-tiled: SKIP (0.000s)
[524.545794] [098/133] (505s left) gem_exec_fence (syncobj-timeline-export)
[525.244886] Starting subtest: syncobj-timeline-export
[525.269377] Subtest syncobj-timeline-export: SUCCESS (0.032s)
[525.611591] [099/133] (504s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[525.802721] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu
[525.804285] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[525.995586] [100/133] (504s left) kms_psr (psr2-primary-page-flip)
[526.204146] Subtest psr2-primary-page-flip: SKIP (0.000s)
[526.272817] [101/133] (503s left) syncobj_eventfd (invalid-bad-pad)
[526.353994] Starting subtest: invalid-bad-pad
[526.354918] Subtest invalid-bad-pad: SUCCESS (0.000s)
[526.561266] [102/133] (503s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs)
[526.746947] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs
[526.747870] Starting dynamic subtest: pipe-A-DP-3
[526.755949] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[526.768873] Starting dynamic subtest: pipe-B-DP-3
[526.777110] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[526.789705] Starting dynamic subtest: pipe-C-DP-3
[526.797821] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[526.810454] Starting dynamic subtest: pipe-D-DP-3
[526.822043] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[526.824158] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SKIP (0.009s)
[527.231348] [103/133] (503s left) testdisplay
[546.495625] [104/133] (484s left) kms_pipe_crc_basic (disable-crc-after-crtc)
[546.688978] Starting subtest: disable-crc-after-crtc
[546.689867] Starting dynamic subtest: pipe-A-DP-3
[547.427618] Dynamic subtest pipe-A-DP-3: SUCCESS (0.738s)
[547.448282] Starting dynamic subtest: pipe-B-DP-3
[548.059040] Dynamic subtest pipe-B-DP-3: SUCCESS (0.628s)
[548.075547] Starting dynamic subtest: pipe-C-DP-3
[548.672629] Dynamic subtest pipe-C-DP-3: SUCCESS (0.611s)
[548.687614] Starting dynamic subtest: pipe-D-DP-3
[549.306033] Dynamic subtest pipe-D-DP-3: SUCCESS (0.630s)
[549.307215] Subtest disable-crc-after-crtc: SUCCESS (2.617s)
[549.613684] [105/133] (480s left) syncobj_wait (wait-for-submit-complex)
[549.707130] Starting subtest: wait-for-submit-complex
[549.770469] Subtest wait-for-submit-complex: SUCCESS (0.063s)
[549.897840] [106/133] (480s left) gem_lmem_swapping (verify-random)
[552.652916] Starting subtest: verify-random
[552.653832] Starting dynamic subtest: lmem0
[561.704469] Dynamic subtest lmem0: SUCCESS (9.052s)
[561.705236] Subtest verify-random: SUCCESS (9.054s)
[562.793607] [FACT gem_lmem_swapping (verify-random)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[562.794620] [FACT gem_lmem_swapping (verify-random)] deleted: kernel.kmod_is_loaded.i915: true
[562.796545] [107/133] (467s left) gem_close_race (basic-process)
[564.469547] Starting subtest: basic-process
[564.533031] Subtest basic-process: SUCCESS (0.063s)
[564.791561] [FACT gem_close_race (basic-process)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[564.793855] [FACT gem_close_race (basic-process)] new: kernel.kmod_is_loaded.i915: true
[564.796671] [108/133] (465s left) gem_sync (basic-many-each)
[564.887269] Starting subtest: basic-many-each
[567.257109] Subtest basic-many-each: SUCCESS (2.370s)
[567.531206] [109/133] (463s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled)
[567.608153] Starting subtest: multi-wait-all-for-submit-available-signaled
[567.609077] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.001s)
[567.816626] [110/133] (463s left) syncobj_timeline (etime-single-wait-all-available-unsubmitted)
[567.896162] Starting subtest: etime-single-wait-all-available-unsubmitted
[568.006147] Subtest etime-single-wait-all-available-unsubmitted: SUCCESS (0.108s)
[568.163559] [111/133] (462s left) kms_plane_scaling (plane-upscale-factor-0-25-with-rotation)
[568.357004] Starting subtest: plane-upscale-factor-0-25-with-rotation
[568.357846] Starting dynamic subtest: pipe-A
[568.766896] Dynamic subtest pipe-A: SUCCESS (0.410s)
[568.796532] Starting dynamic subtest: pipe-B
[569.246131] Dynamic subtest pipe-B: SUCCESS (0.477s)
[569.265388] Starting dynamic subtest: pipe-C
[569.709076] Dynamic subtest pipe-C: SUCCESS (0.461s)
[569.728089] Starting dynamic subtest: pipe-D
[570.173202] Dynamic subtest pipe-D: SUCCESS (0.463s)
[570.174289] Subtest plane-upscale-factor-0-25-with-rotation: SUCCESS (1.818s)
[570.553535] [112/133] (460s left) gem_fence_thrash (bo-write-verify-none)
[570.600864] Starting subtest: bo-write-verify-none
[570.635984] Subtest bo-write-verify-none: SKIP (0.034s)
[570.704167] [113/133] (460s left) kms_vblank (wait-busy)
[570.890115] Starting subtest: wait-busy
[570.890994] Starting dynamic subtest: pipe-A-DP-3
[573.389819] Dynamic subtest pipe-A-DP-3: SUCCESS (2.499s)
[573.415763] Starting dynamic subtest: pipe-D-DP-3
[575.854025] Dynamic subtest pipe-D-DP-3: SUCCESS (2.456s)
[575.855080] Subtest wait-busy: SUCCESS (4.965s)
[576.137804] [114/133] (455s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[576.327568] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[576.329237] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[576.536054] [115/133] (454s left) kms_psr (fbc-pr-primary-render)
[576.720870] Subtest fbc-pr-primary-render: SKIP (0.000s)
[576.779615] [116/133] (454s left) kms_ccs (crc-primary-suspend-4-tiled-lnl-ccs)
[576.965459] Starting subtest: crc-primary-suspend-4-tiled-lnl-ccs
[576.967179] Subtest crc-primary-suspend-4-tiled-lnl-ccs: SKIP (0.000s)
[577.300933] [117/133] (454s left) gem_exec_reloc (basic-wc-cpu)
[577.384170] Subtest basic-wc-cpu: SKIP (0.000s)
[577.463944] [118/133] (454s left) kms_prop_blob (invalid-get-prop-any)
[577.539241] Starting subtest: invalid-get-prop-any
[577.540230] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[577.678529] [119/133] (453s left) kms_dirtyfb (drrs-dirtyfb-ioctl)
[577.863670] Starting subtest: drrs-dirtyfb-ioctl
[577.868854] Subtest drrs-dirtyfb-ioctl: SKIP (0.001s)
[578.052211] [120/133] (453s left) gem_ctx_shared (single-timeline)
[578.143690] Starting subtest: single-timeline
[578.185631] Subtest single-timeline: SUCCESS (0.040s)
[578.503118] [121/133] (453s left) kms_content_protection (legacy-hdcp14)
[578.757370] Starting subtest: legacy-hdcp14
[579.038895] Starting dynamic subtest: pipe-A-DP-3
[700.269611] Dynamic subtest pipe-A-DP-3: FAIL (120.963s)
[700.270558] Subtest legacy-hdcp14: FAIL (121.342s)
[700.434141] [122/133] (331s left) kms_ccs (random-ccs-data-4-tiled-dg2-mc-ccs)
[700.618481] Starting subtest: random-ccs-data-4-tiled-dg2-mc-ccs
[700.620726] Starting dynamic subtest: pipe-A-DP-3
[700.629863] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[700.641616] Starting dynamic subtest: pipe-B-DP-3
[700.650818] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[700.662527] Starting dynamic subtest: pipe-C-DP-3
[700.671419] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[700.683024] Starting dynamic subtest: pipe-D-DP-3
[700.694174] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[700.696163] Subtest random-ccs-data-4-tiled-dg2-mc-ccs: SKIP (0.007s)
[701.122110] [123/133] (330s left) prime_udl
[701.239643] [124/133] (330s left) kms_hdr (static-toggle)
[701.422558] Starting subtest: static-toggle
[705.122275] Starting dynamic subtest: pipe-A-DP-3
[706.259831] Dynamic subtest pipe-A-DP-3: SUCCESS (1.137s)
[706.265306] Subtest static-toggle: SUCCESS (4.839s)
[706.640768] [125/133] (325s left) dmabuf_sync_file (import-multiple-read-write)
[706.705608] Starting subtest: import-multiple-read-write
[706.709358] Subtest import-multiple-read-write: SUCCESS (0.004s)
[706.820602] [126/133] (325s left) syncobj_wait (reset-signaled)
[706.895449] Starting subtest: reset-signaled
[706.896289] Subtest reset-signaled: SUCCESS (0.000s)
[707.054010] [127/133] (325s left) kms_pm_dc (dc5-dpms)
[708.250970] Starting subtest: dc5-dpms
[709.655603] Subtest dc5-dpms: SUCCESS (1.404s)
[709.769494] [128/133] (322s left) gem_gtt_cpu_tlb
[709.929656] [129/133] (322s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[710.120752] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc
[710.122457] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[710.318685] [130/133] (322s left) kms_psr2_su (frontbuffer-xrgb8888)
[710.396975] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[710.462268] [131/133] (321s left) gem_render_copy (yf-tiled-ccs-to-linear)
[710.546611] Starting subtest: yf-tiled-ccs-to-linear
[710.549095] Subtest yf-tiled-ccs-to-linear: SKIP (0.000s)
[710.839083] [132/133] (321s left) api_intel_allocator (reopen)
[710.918215] Starting subtest: reopen
[710.948262] Subtest reopen: SUCCESS (0.031s)
[711.116089] [133/133] (321s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[711.311837] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[712.518824] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (1.206s)
[712.787077] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_cursor_crc
results: parsing output: 3/ for test: i915_suspend
results: parsing output: 4/ for test: gem_partial_pwrite_pread
results: parsing output: 5/ for test: i915_drm_fdinfo
results: parsing output: 6/ for test: kms_plane
results: parsing output: 7/ for test: gem_mmap_gtt
results: parsing output: 8/ for test: kms_flip_tiling
results: parsing output: 9/ for test: vgem_basic
results: parsing output: 10/ for test: gem_mmap_gtt
results: parsing output: 11/ for test: kms_pm_rpm
results: parsing output: 12/ for test: kms_cursor_legacy
results: parsing output: 13/ for test: kms_flip_scaled_crc
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: syncobj_basic
results: parsing output: 16/ for test: syncobj_wait
results: parsing output: 17/ for test: kms_color
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: gen7_exec_parse
results: parsing output: 20/ for test: kms_big_fb
results: parsing output: 21/ for test: gem_ctx_persistence
results: parsing output: 22/ for test: gem_userptr_blits
results: parsing output: 23/ for test: kms_big_fb
results: parsing output: 24/ for test: gem_exec_whisper
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: gem_mmap_wc
results: parsing output: 27/ for test: kms_async_flips
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: perf
results: parsing output: 30/ for test: gem_mmap
results: parsing output: 31/ for test: gem_exec_balancer
results: parsing output: 32/ for test: gem_exec_reloc
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: kms_flip
results: parsing output: 35/ for test: gem_spin_batch
results: parsing output: 36/ for test: kms_flip
results: parsing output: 37/ for test: kms_lease
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: kms_selftest
results: parsing output: 40/ for test: i915_query
results: parsing output: 41/ for test: gem_eio
results: parsing output: 42/ for test: kms_busy
results: parsing output: 43/ for test: kms_psr
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: gem_mmap_offset
results: parsing output: 46/ for test: kms_cursor_edge_walk
results: parsing output: 47/ for test: gem_reg_read
results: parsing output: 48/ for test: kms_feature_discovery
results: parsing output: 49/ for test: gem_eio
results: parsing output: 50/ for test: gem_fence_thrash
results: parsing output: 51/ for test: gem_partial_pwrite_pread
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: gem_mmap_gtt
results: parsing output: 54/ for test: gem_exec_schedule
results: parsing output: 55/ for test: i915_pm_rpm
results: parsing output: 56/ for test: i915_drm_fdinfo
results: parsing output: 57/ for test: kms_chamelium_edid
results: parsing output: 58/ for test: gem_fence_thrash
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: gem_ctx_param
results: parsing output: 61/ for test: kms_plane_multiple
results: parsing output: 62/ for test: kms_chamelium_hpd
results: parsing output: 63/ for test: kms_flip
results: parsing output: 64/ for test: syncobj_timeline
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: syncobj_wait
results: parsing output: 67/ for test: gem_exec_schedule
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: gem_gpgpu_fill
results: parsing output: 70/ for test: prime_busy
results: parsing output: 71/ for test: kms_atomic
results: parsing output: 72/ for test: gem_exec_reloc
results: parsing output: 73/ for test: gem_userptr_blits
results: parsing output: 74/ for test: kms_psr2_sf
results: parsing output: 75/ for test: kms_ccs
results: parsing output: 76/ for test: kms_addfb_basic
results: parsing output: 77/ for test: perf_pmu
results: parsing output: 78/ for test: gem_exec_schedule
results: parsing output: 79/ for test: kms_ccs
results: parsing output: 80/ for test: kms_cursor_crc
results: parsing output: 81/ for test: perf
results: parsing output: 82/ for test: kms_plane
results: parsing output: 83/ for test: kms_psr
results: parsing output: 84/ for test: gem_exec_fence
results: parsing output: 85/ for test: syncobj_timeline
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: dumb_buffer
results: parsing output: 88/ for test: kms_big_fb
results: parsing output: 89/ for test: sysfs_heartbeat_interval
results: parsing output: 90/ for test: kms_addfb_basic
results: parsing output: 91/ for test: gem_ctx_engines
results: parsing output: 92/ for test: gem_mmap_offset
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: api_intel_bb
results: parsing output: 95/ for test: kms_cursor_legacy
results: parsing output: 96/ for test: gem_render_copy
results: parsing output: 97/ for test: gem_exec_fence
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_psr
results: parsing output: 100/ for test: syncobj_eventfd
results: parsing output: 101/ for test: kms_ccs
results: parsing output: 102/ for test: testdisplay
results: parsing output: 103/ for test: kms_pipe_crc_basic
results: parsing output: 104/ for test: syncobj_wait
results: parsing output: 105/ for test: gem_lmem_swapping
results: parsing output: 106/ for test: gem_close_race
results: parsing output: 107/ for test: gem_sync
results: parsing output: 108/ for test: syncobj_timeline
results: parsing output: 109/ for test: syncobj_timeline
results: parsing output: 110/ for test: kms_plane_scaling
results: parsing output: 111/ for test: gem_fence_thrash
results: parsing output: 112/ for test: kms_vblank
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_psr
results: parsing output: 115/ for test: kms_ccs
results: parsing output: 116/ for test: gem_exec_reloc
results: parsing output: 117/ for test: kms_prop_blob
results: parsing output: 118/ for test: kms_dirtyfb
results: parsing output: 119/ for test: gem_ctx_shared
results: parsing output: 120/ for test: kms_content_protection
results: parsing output: 121/ for test: kms_ccs
results: parsing output: 122/ for test: prime_udl
results: parsing output: 123/ for test: kms_hdr
results: parsing output: 124/ for test: dmabuf_sync_file
results: parsing output: 125/ for test: syncobj_wait
results: parsing output: 126/ for test: kms_pm_dc
results: parsing output: 127/ for test: gem_gtt_cpu_tlb
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_psr2_su
results: parsing output: 130/ for test: gem_render_copy
results: parsing output: 131/ for test: api_intel_allocator
results: parsing output: 132/ for test: kms_big_fb
Done.