[57.145121] Initializing watchdogs
[57.145163]   /dev/watchdog0
[57.158453] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[57.162631] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.165121] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.168498] [001/131] (960s left) i915_pm_rc6_residency (media-rc6-accuracy)
[57.241137] Starting subtest: media-rc6-accuracy
[57.245366] Subtest media-rc6-accuracy: SKIP (0.000s)
[57.382125] [002/131] (960s left) kms_pm_rpm (modeset-lpsp-stress)
[59.031180] Starting subtest: modeset-lpsp-stress
[74.822163] Subtest modeset-lpsp-stress: SUCCESS (15.804s)
[74.933763] [003/131] (942s left) gem_mmap_gtt (big-bo-tiledx)
[74.991152] Subtest big-bo-tiledX: SKIP (0.000s)
[75.063364] [004/131] (942s left) kms_cursor_crc (cursor-offscreen-32x32)
[75.208652] Starting subtest: cursor-offscreen-32x32
[75.256826] Subtest cursor-offscreen-32x32: SKIP (0.045s)
[75.563258] [005/131] (942s left) syncobj_timeline (multi-wait-available-signaled)
[75.621721] Starting subtest: multi-wait-available-signaled
[75.624075] Subtest multi-wait-available-signaled: SUCCESS (0.000s)
[75.755143] [006/131] (942s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[75.852041] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[75.855438] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[75.960803] [007/131] (941s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[76.036523] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[76.038471] Starting dynamic subtest: pipe-A-eDP-1
[76.057890] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.019s)
[76.067955] Starting dynamic subtest: pipe-B-eDP-1
[76.085893] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.019s)
[76.094856] Starting dynamic subtest: pipe-C-eDP-1
[76.111158] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.020s)
[76.118120] Starting dynamic subtest: pipe-D-eDP-1
[76.134669] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.020s)
[76.136467] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.081s)
[78.465543] [008/131] (939s left) gem_mmap (bad-object)
[78.524521] Subtest bad-object: SKIP (0.000s)
[78.576336] [009/131] (939s left) kms_fb_coherency (memset-crc)
[78.663083] Starting subtest: memset-crc
[78.665454] Starting dynamic subtest: mmap-offset-wc
[79.340831] Dynamic subtest mmap-offset-wc: CRASH (0.151s)
[79.793050] Subtest memset-crc: CRASH (0.625s)
[79.825549] [010/131] (938s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[79.945365] Starting subtest: basic-busy-flip-before-cursor-legacy
[79.949351] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[80.111769] [011/131] (937s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs)
[80.209427] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs
[80.211470] Starting dynamic subtest: pipe-A-eDP-1
[80.232145] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[80.241048] Starting dynamic subtest: pipe-B-eDP-1
[80.260270] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[80.266430] Starting dynamic subtest: pipe-C-eDP-1
[80.286083] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[80.292532] Starting dynamic subtest: pipe-D-eDP-1
[80.311936] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[80.315195] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.003s)
[82.443901] [012/131] (935s left) syncobj_timeline (wait-delayed-signal)
[82.512136] Starting subtest: wait-delayed-signal
[82.616885] Subtest wait-delayed-signal: SUCCESS (0.103s)
[82.713063] [013/131] (935s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[82.847110] Starting subtest: protected-encrypted-src-copy-not-readible
[82.956847] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.111s)
[83.114969] [014/131] (935s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-wc)
[83.207646] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-wc
[87.439994] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (4.236s)
[88.631438] [015/131] (929s left) gem_exec_reloc (basic-wc-read)
[88.697242] Subtest basic-wc-read: SKIP (0.000s)
[88.782007] [016/131] (929s left) perf_pmu (rc6-suspend)
[88.820970] Starting subtest: rc6-suspend
[111.263737] Subtest rc6-suspend: SUCCESS (11.288s)
[112.158539] [017/131] (906s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[112.275593] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[112.277764] Starting dynamic subtest: pipe-A-default-mode
[115.058461] Dynamic subtest pipe-A-default-mode: SUCCESS (2.795s)
[115.060792] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.796s)
[115.908043] [018/131] (902s left) gem_exec_reloc (basic-write-read-active)
[115.977587] Subtest basic-write-read-active: SKIP (0.000s)
[116.045735] [019/131] (902s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[116.145331] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[116.149568] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[116.259813] [020/131] (902s left) gem_wait (wait)
[116.338991] Starting subtest: wait
[116.341210] Starting dynamic subtest: all-engines
[118.085489] Dynamic subtest all-engines: SUCCESS (1.753s)
[118.094115] Starting dynamic subtest: rcs0
[119.130229] Dynamic subtest rcs0: SUCCESS (1.048s)
[119.141111] Starting dynamic subtest: bcs0
[120.176999] Dynamic subtest bcs0: SUCCESS (1.048s)
[120.187899] Starting dynamic subtest: vcs0
[121.220432] Dynamic subtest vcs0: SUCCESS (1.045s)
[121.229918] Starting dynamic subtest: vcs1
[122.267013] Dynamic subtest vcs1: SUCCESS (1.046s)
[122.276352] Starting dynamic subtest: vecs0
[123.307168] Dynamic subtest vecs0: SUCCESS (1.044s)
[123.317859] Starting dynamic subtest: ccs0
[124.353003] Dynamic subtest ccs0: SUCCESS (1.047s)
[124.355851] Subtest wait: SUCCESS (8.037s)
[124.570366] [021/131] (893s left) gem_flink_basic (double-flink)
[124.627055] Starting subtest: double-flink
[124.629416] Subtest double-flink: SUCCESS (0.000s)
[124.767241] [022/131] (893s left) vgem_slow (nohang)
[124.842890] Starting subtest: nohang
[135.202963] Subtest nohang: SUCCESS (10.370s)
[135.290615] [FACT vgem_slow (nohang)] new: kernel.kmod_is_loaded.vgem: true
[135.293679] [023/131] (883s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling)
[135.404056] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling
[135.406389] Starting dynamic subtest: pipe-A-default-mode
[136.534099] Dynamic subtest pipe-A-default-mode: SKIP (1.129s)
[136.538630] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SKIP (1.130s)
[136.714971] [024/131] (881s left) gem_exec_schedule (wide)
[136.901227] Starting subtest: wide
[136.908490] Starting dynamic subtest: rcs0
[146.725691] Dynamic subtest rcs0: SUCCESS (9.824s)
[146.737774] Starting dynamic subtest: vcs0
[157.696119] Dynamic subtest vcs0: SUCCESS (10.973s)
[157.705121] Starting dynamic subtest: vcs1
[169.655362] Dynamic subtest vcs1: SUCCESS (11.962s)
[169.667907] Starting dynamic subtest: vecs0
[180.899116] Dynamic subtest vecs0: SUCCESS (11.247s)
[180.909051] Starting dynamic subtest: ccs0
[194.629418] Dynamic subtest ccs0: SUCCESS (13.736s)
[194.631829] Subtest wide: SUCCESS (57.743s)
[196.549344] [025/131] (822s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[196.654444] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[203.598724] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (6.948s)
[203.742297] [026/131] (814s left) gem_ctx_persistence (saturated-hostile)
[203.807133] Starting subtest: saturated-hostile
[203.809562] Starting dynamic subtest: rcs0
[204.660009] Dynamic subtest rcs0: SUCCESS (0.852s)
[204.672813] Starting dynamic subtest: bcs0
[205.449600] Dynamic subtest bcs0: SUCCESS (0.787s)
[205.462026] Starting dynamic subtest: vcs0
[206.247301] Dynamic subtest vcs0: SUCCESS (0.795s)
[206.259416] Starting dynamic subtest: vcs1
[207.061444] Dynamic subtest vcs1: SUCCESS (0.813s)
[207.073252] Starting dynamic subtest: vecs0
[207.859312] Dynamic subtest vecs0: SUCCESS (0.796s)
[207.870481] Starting dynamic subtest: ccs0
[208.716048] Dynamic subtest ccs0: SUCCESS (0.854s)
[208.718567] Subtest saturated-hostile: SUCCESS (4.906s)
[208.817849] [027/131] (809s left) gem_mmap_gtt (fault-concurrent-y)
[208.882732] Subtest fault-concurrent-Y: SKIP (0.000s)
[208.942090] [028/131] (809s left) i915_query (test-query-geometry-subslices)
[208.998245] Starting subtest: test-query-geometry-subslices
[209.000559] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[209.123965] [029/131] (809s left) perf (global-sseu-config-invalid)
[209.275217] Starting subtest: global-sseu-config-invalid
[209.279567] Subtest global-sseu-config-invalid: SKIP (0.000s)
[209.318979] [030/131] (809s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-render)
[209.431051] Starting subtest: fbcpsr-rgb565-draw-render
[216.512462] Subtest fbcpsr-rgb565-draw-render: SUCCESS (7.080s)
[216.680935] [031/131] (802s left) vgem_basic (dmabuf-fence-before)
[216.733322] Starting subtest: dmabuf-fence-before
[216.735563] Subtest dmabuf-fence-before: SUCCESS (0.001s)
[216.815031] [032/131] (802s left) gem_exec_params (secure-non-root)
[216.878359] Starting subtest: secure-non-root
[216.882374] Subtest secure-non-root: SKIP (0.000s)
[217.001634] [033/131] (801s left) sw_sync (sync_expired_merge)
[217.036471] Starting subtest: sync_expired_merge
[218.111002] Subtest sync_expired_merge: SUCCESS (1.074s)
[218.193820] [034/131] (800s left) prime_mmap (test_reprime)
[218.259184] Starting subtest: test_reprime
[218.261090] Starting dynamic subtest: test_reprime-smem
[218.287655] Dynamic subtest test_reprime-smem: SUCCESS (0.030s)
[218.290136] Subtest test_reprime: SUCCESS (0.030s)
[218.410318] [035/131] (800s left) gem_ctx_param (basic)
[218.460768] Starting subtest: basic
[218.463161] Subtest basic: SUCCESS (0.001s)
[218.596420] [036/131] (800s left) sysfs_heartbeat_interval (nopreempt)
[218.665131] Starting subtest: nopreempt
[218.667370] Starting dynamic subtest: vecs0
[228.105816] Dynamic subtest vecs0: SUCCESS (9.440s)
[228.116914] Starting dynamic subtest: ccs0
[232.127670] Dynamic subtest ccs0: SUCCESS (4.019s)
[232.139172] Starting dynamic subtest: vcs0
[242.138123] Dynamic subtest vcs0: SUCCESS (10.007s)
[242.150526] Starting dynamic subtest: bcs0
[246.105970] Dynamic subtest bcs0: SUCCESS (3.968s)
[246.119351] Starting dynamic subtest: rcs0
[250.183004] Dynamic subtest rcs0: SUCCESS (4.076s)
[250.195006] Starting dynamic subtest: vcs1
[260.131118] Dynamic subtest vcs1: SUCCESS (9.946s)
[260.133619] Subtest nopreempt: SUCCESS (41.466s)
[260.232320] [037/131] (758s left) kms_plane_multiple (2x-tiling-y)
[260.324667] Starting subtest: 2x-tiling-y
[260.329293] Subtest 2x-tiling-y: SKIP (0.000s)
[260.421326] [038/131] (758s left) gem_exec_balancer (bonded-semaphore)
[260.487784] Starting subtest: bonded-semaphore
[260.492273] Subtest bonded-semaphore: SKIP (0.000s)
[260.823604] [039/131] (758s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[260.921031] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[260.925519] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[261.038122] [040/131] (758s left) kms_cursor_crc (cursor-sliding-512x512)
[261.300505] Starting subtest: cursor-sliding-512x512
[261.304675] Subtest cursor-sliding-512x512: SKIP (0.001s)
[261.489364] [041/131] (757s left) kms_invalid_mode (bad-hsync-start)
[261.595385] Starting subtest: bad-hsync-start
[261.597589] Starting dynamic subtest: pipe-A-eDP-1
[261.894309] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.297s)
[261.906607] Starting dynamic subtest: pipe-B-eDP-1
[261.908621] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[261.917822] Starting dynamic subtest: pipe-C-eDP-1
[261.920017] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[261.928885] Starting dynamic subtest: pipe-D-eDP-1
[261.931130] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[261.933368] Subtest bad-hsync-start: SUCCESS (0.303s)
[262.763927] [042/131] (756s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-signaled)
[262.823109] Starting subtest: etime-multi-wait-all-available-unsubmitted-signaled
[262.929825] Subtest etime-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.107s)
[263.040724] [043/131] (756s left) kms_pm_rpm (i2c)
[265.259037] Starting subtest: i2c
[270.543035] Subtest i2c: SUCCESS (5.284s)
[270.642764] [044/131] (748s left) kms_atomic (atomic-plane-damage)
[270.743310] Starting subtest: atomic-plane-damage
[270.787148] Starting dynamic subtest: pipe-A-eDP-1
[271.305696] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.516s)
[271.307684] Subtest atomic-plane-damage: SUCCESS (0.563s)
[272.166907] [045/131] (747s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[272.274809] Starting subtest: 4-tiled-8bpp-rotate-270
[272.295486] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.020s)
[272.443546] [046/131] (746s left) kms_chamelium_hpd (dp-hpd-storm)
[272.840100] Subtest dp-hpd-storm: SKIP (0.000s)
[273.651939] [047/131] (745s left) kms_flip (2x-plain-flip-fb-recreate-interruptible)
[273.753782] Starting subtest: 2x-plain-flip-fb-recreate-interruptible
[273.764943] Subtest 2x-plain-flip-fb-recreate-interruptible: SKIP (0.010s)
[273.894758] [048/131] (745s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[273.990457] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[274.814869] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.826s)
[275.030178] [049/131] (744s left) kms_psr (psr-primary-page-flip)
[275.138722] Starting subtest: psr-primary-page-flip
[275.140923] Starting dynamic subtest: eDP-1
[276.879959] Dynamic subtest eDP-1: SUCCESS (1.740s)
[276.881851] Subtest psr-primary-page-flip: SUCCESS (1.741s)
[277.757607] [050/131] (741s left) prime_busy (hang)
[277.820169] Starting subtest: hang
[277.822516] Starting dynamic subtest: rcs0
[303.581834] Dynamic subtest rcs0: SUCCESS (25.764s)
[303.593128] Starting dynamic subtest: bcs0
[310.734525] Dynamic subtest bcs0: SUCCESS (7.156s)
[310.743351] Starting dynamic subtest: vcs0
[317.780947] Dynamic subtest vcs0: SUCCESS (7.045s)
[317.792124] Starting dynamic subtest: vcs1
[324.756167] Dynamic subtest vcs1: SUCCESS (6.976s)
[324.767470] Starting dynamic subtest: vecs0
[331.730539] Dynamic subtest vecs0: SUCCESS (6.974s)
[331.741945] Starting dynamic subtest: ccs0
[345.634030] Dynamic subtest ccs0: SUCCESS (13.898s)
[345.636286] Subtest hang: SUCCESS (67.820s)
[345.778298] [051/131] (673s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[345.891721] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[346.727393] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.836s)
[346.916392] [052/131] (672s left) kms_flip (flip-vs-modeset-vs-hang)
[347.013221] Starting subtest: flip-vs-modeset-vs-hang
[347.015546] Starting dynamic subtest: A-eDP1
[386.525727] Dynamic subtest A-eDP1: SUCCESS (39.504s)
[386.535111] Starting dynamic subtest: D-eDP1
[436.571139] Dynamic subtest D-eDP1: SUCCESS (50.045s)
[436.573765] Subtest flip-vs-modeset-vs-hang: SUCCESS (89.555s)
[437.005383] [053/131] (582s left) kms_psr (psr-primary-mmap-cpu)
[437.091434] Starting subtest: psr-primary-mmap-cpu
[437.093690] Starting dynamic subtest: eDP-1
[438.777719] Dynamic subtest eDP-1: SUCCESS (1.683s)
[438.780007] Subtest psr-primary-mmap-cpu: SUCCESS (1.684s)
[439.674256] [054/131] (580s left) kms_cursor_crc (cursor-random-32x32)
[439.819283] Starting subtest: cursor-random-32x32
[439.863390] Subtest cursor-random-32x32: SKIP (0.041s)
[440.189762] [055/131] (579s left) kms_selftest (drm_format_helper)
[440.228700] Starting subtest: drm_format_helper
[440.290312] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8
[440.430192] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.140s)
[440.439245] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332
[440.589188] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.159s)
[440.599534] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565
[440.724326] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.133s)
[440.733761] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555
[440.866263] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.143s)
[440.875256] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555
[440.999093] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.132s)
[441.009456] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551
[441.130602] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.130s)
[441.140140] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888
[441.245453] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.115s)
[441.254391] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888
[441.364260] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.116s)
[441.372874] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888
[441.480093] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.115s)
[441.488765] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010
[441.611202] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.130s)
[441.620255] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010
[441.758488] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.147s)
[441.767344] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono
[441.917091] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.157s)
[441.927888] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab
[442.059483] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.143s)
[442.068369] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888
[442.207121] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.146s)
[442.217618] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888
[442.356360] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.149s)
[442.366881] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset
[442.506212] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.148s)
[442.514792] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy
[442.638989] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.132s)
[442.641183] Subtest drm_format_helper: SUCCESS (2.413s)
[442.852031] [056/131] (576s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled)
[442.913048] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[442.915367] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[443.060711] [057/131] (576s left) kms_big_fb (y-tiled-16bpp-rotate-180)
[443.173720] Starting subtest: y-tiled-16bpp-rotate-180
[443.177842] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s)
[443.313092] [058/131] (576s left) gem_reg_read (timestamp-moving)
[443.377444] Starting subtest: timestamp-moving
[444.378109] Subtest timestamp-moving: SUCCESS (1.001s)
[444.477554] [059/131] (575s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[444.546806] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[444.611661] [060/131] (575s left) gem_exec_params (no-bsd)
[444.664446] Starting subtest: no-bsd
[444.666670] Subtest no-bsd: SUCCESS (0.002s)
[446.171756] [061/131] (573s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[446.271011] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[446.279443] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.010s)
[446.419948] [062/131] (573s left) kms_atomic_interruptible (universal-setplane-cursor)
[446.521196] Starting subtest: universal-setplane-cursor
[446.523494] Starting dynamic subtest: pipe-A-eDP-1
[453.960798] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.438s)
[453.962949] Subtest universal-setplane-cursor: SUCCESS (7.440s)
[454.837656] [063/131] (565s left) kms_lease (atomic-implicit-crtc)
[454.945392] Starting subtest: atomic-implicit-crtc
[454.947711] Starting dynamic subtest: pipe-A-eDP-1
[454.959156] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[454.970146] Starting dynamic subtest: pipe-B-eDP-1
[454.981274] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.009s)
[454.989931] Starting dynamic subtest: pipe-C-eDP-1
[455.000161] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.009s)
[455.008655] Starting dynamic subtest: pipe-D-eDP-1
[455.018973] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.009s)
[455.020857] Subtest atomic-implicit-crtc: SUCCESS (0.034s)
[455.116488] [064/131] (565s left) gem_exec_schedule (pi-common)
[455.299569] Starting subtest: pi-common
[455.301872] Starting dynamic subtest: rcs0
[455.323354] Dynamic subtest rcs0: SUCCESS (0.026s)
[455.337349] Starting dynamic subtest: bcs0
[455.349277] Dynamic subtest bcs0: SUCCESS (0.025s)
[455.362290] Starting dynamic subtest: vcs0
[455.376325] Dynamic subtest vcs0: SUCCESS (0.026s)
[455.390013] Starting dynamic subtest: vcs1
[455.403097] Dynamic subtest vcs1: SUCCESS (0.026s)
[455.416345] Starting dynamic subtest: vecs0
[455.429158] Dynamic subtest vecs0: SUCCESS (0.025s)
[455.442507] Starting dynamic subtest: ccs0
[455.456321] Dynamic subtest ccs0: SUCCESS (0.027s)
[455.458508] Subtest pi-common: SUCCESS (0.160s)
[455.703295] [065/131] (564s left) prime_mmap (test_correct)
[455.758388] Starting subtest: test_correct
[455.760633] Starting dynamic subtest: test_correct-smem
[455.785332] Dynamic subtest test_correct-smem: SUCCESS (0.029s)
[455.787725] Subtest test_correct: SUCCESS (0.030s)
[455.920655] [066/131] (564s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[456.027632] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[462.494429] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.467s)
[462.657839] [067/131] (557s left) sw_sync (sync_random_merge)
[462.689828] Starting subtest: sync_random_merge
[462.723216] Subtest sync_random_merge: SUCCESS (0.037s)
[462.837375] [068/131] (557s left) kms_psr (fbc-psr2-basic)
[462.941108] Starting subtest: fbc-psr2-basic
[462.943487] Starting dynamic subtest: eDP-1
[462.947706] Dynamic subtest eDP-1: SKIP (0.000s)
[462.951920] Subtest fbc-psr2-basic: SKIP (0.001s)
[463.039648] [069/131] (557s left) kms_psr (fbc-psr-primary-render)
[463.143465] Starting subtest: fbc-psr-primary-render
[463.145659] Starting dynamic subtest: eDP-1
[463.149647] Dynamic subtest eDP-1: SKIP (0.000s)
[463.153653] Subtest fbc-psr-primary-render: SKIP (0.001s)
[463.243406] [070/131] (557s left) gem_huc_copy (huc-copy)
[463.305265] Starting subtest: huc-copy
[463.307697] Subtest huc-copy: SUCCESS (0.003s)
[463.464484] [071/131] (557s left) kms_content_protection (lic-type-0)
[463.613205] Starting subtest: lic-type-0
[463.617103] Subtest lic-type-0: SKIP (0.000s)
[463.783660] [072/131] (556s left) gem_eio (reset-stress)
[463.994916] Starting subtest: reset-stress
[463.996524] Starting dynamic subtest: render
[468.810108] Dynamic subtest render: SUCCESS (4.813s)
[468.824942] Starting dynamic subtest: bsd1
[486.574902] Dynamic subtest bsd1: SUCCESS (17.767s)
[486.591738] Starting dynamic subtest: bsd2
[504.558146] Dynamic subtest bsd2: SUCCESS (17.985s)
[504.573999] Starting dynamic subtest: blt
[504.578426] Dynamic subtest blt: SKIP (0.000s)
[504.587614] Starting dynamic subtest: vebox
[522.623581] Dynamic subtest vebox: SUCCESS (18.067s)
[522.626020] Subtest reset-stress: SUCCESS (58.637s)
[524.167193] [073/131] (496s left) kms_vblank (wait-forked-busy-hang)
[524.271757] Starting subtest: wait-forked-busy-hang
[524.273580] Starting dynamic subtest: pipe-A-eDP-1
[526.168024] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.894s)
[526.183474] Starting dynamic subtest: pipe-D-eDP-1
[528.773897] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.606s)
[528.776260] Subtest wait-forked-busy-hang: SUCCESS (4.505s)
[529.595003] [074/131] (491s left) kms_plane_scaling (2x-scaler-multi-pipe)
[529.699042] Starting subtest: 2x-scaler-multi-pipe
[529.703182] Subtest 2x-scaler-multi-pipe: SKIP (0.001s)
[529.852828] [075/131] (490s left) gem_render_copy (y-tiled-to-vebox-yf-tiled)
[529.909127] Starting subtest: y-tiled-to-vebox-yf-tiled
[529.913729] Subtest y-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[530.116660] [076/131] (490s left) gem_create (create-ext-placement-all)
[530.286841] Starting subtest: create-ext-placement-all
[530.289694] Subtest create-ext-placement-all: SUCCESS (0.000s)
[530.422315] [077/131] (490s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling)
[530.514795] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-downscaling
[530.517181] Starting dynamic subtest: pipe-A-default-mode
[530.804826] Dynamic subtest pipe-A-default-mode: SKIP (0.288s)
[530.809190] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SKIP (0.290s)
[531.634377] [078/131] (489s left) gen7_exec_parse (cmd-crossing-page)
[531.690042] Subtest cmd-crossing-page: SKIP (0.000s)
[531.771725] [079/131] (489s left) gem_shrink (reclaim)
[531.835637] Starting subtest: reclaim
[534.270675] Subtest reclaim: SUCCESS (2.431s)
[534.407526] [080/131] (486s left) kms_frontbuffer_tracking (fbc-tiling-4)
[534.514467] Starting subtest: fbc-tiling-4
[538.734625] Subtest fbc-tiling-4: SUCCESS (4.224s)
[539.926440] [081/131] (481s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc)
[540.025287] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc
[540.027140] Starting dynamic subtest: pipe-A-eDP-1
[540.171849] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.137s)
[540.183247] Starting dynamic subtest: pipe-B-eDP-1
[540.201490] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.009s)
[540.210787] Starting dynamic subtest: pipe-C-eDP-1
[540.230749] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.010s)
[540.242081] Starting dynamic subtest: pipe-D-eDP-1
[540.261193] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.010s)
[540.263346] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.172s)
[542.470798] [082/131] (478s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[542.872794] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[543.657947] [083/131] (477s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[543.754622] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[543.758966] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[543.869166] [084/131] (477s left) i915_drm_fdinfo (all-busy-check-all)
[543.910642] Starting subtest: all-busy-check-all
[543.914881] Subtest all-busy-check-all: SKIP (0.004s)
[544.001481] [085/131] (477s left) gem_ctx_shared (q-out-order)
[544.115649] Starting subtest: Q-out-order
[544.117950] Starting dynamic subtest: rcs0
[544.211603] Dynamic subtest rcs0: SUCCESS (0.095s)
[544.227648] Starting dynamic subtest: vcs0
[544.289600] Dynamic subtest vcs0: SUCCESS (0.077s)
[544.305086] Starting dynamic subtest: vcs1
[544.363962] Dynamic subtest vcs1: SUCCESS (0.075s)
[544.380354] Starting dynamic subtest: vecs0
[544.438760] Dynamic subtest vecs0: SUCCESS (0.073s)
[544.456310] Starting dynamic subtest: ccs0
[544.526613] Dynamic subtest ccs0: SUCCESS (0.087s)
[544.529089] Subtest Q-out-order: SUCCESS (0.411s)
[546.235610] [086/131] (474s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs)
[546.335956] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs
[546.338308] Starting dynamic subtest: pipe-A-eDP-1
[546.347350] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[546.358407] Starting dynamic subtest: pipe-B-eDP-1
[546.367592] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[546.377378] Starting dynamic subtest: pipe-C-eDP-1
[546.385893] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[546.395699] Starting dynamic subtest: pipe-D-eDP-1
[546.404293] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[546.408566] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs: SKIP (0.005s)
[548.568389] [087/131] (472s left) gem_exec_flush (basic-wb-ro-default)
[548.633964] Starting subtest: basic-wb-ro-default
[554.082484] Subtest basic-wb-ro-default: SUCCESS (5.450s)
[554.298693] [088/131] (466s left) gem_busy (extended)
[554.486535] Starting subtest: extended
[554.489158] Starting dynamic subtest: rcs0
[554.608053] Dynamic subtest rcs0: SUCCESS (0.122s)
[554.620498] Starting dynamic subtest: bcs0
[554.651852] Dynamic subtest bcs0: SUCCESS (0.042s)
[554.662963] Starting dynamic subtest: vcs0
[556.101843] Dynamic subtest vcs0: SUCCESS (1.446s)
[556.118271] Starting dynamic subtest: vcs1
[558.086161] Dynamic subtest vcs1: SUCCESS (1.982s)
[558.097134] Starting dynamic subtest: vecs0
[560.069582] Dynamic subtest vecs0: SUCCESS (1.981s)
[560.082087] Starting dynamic subtest: ccs0
[560.115079] Dynamic subtest ccs0: SUCCESS (0.045s)
[560.117482] Subtest extended: SUCCESS (5.631s)
[560.393644] [089/131] (460s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-pwrite)
[560.496391] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-pwrite
[560.500441] Subtest fbc-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[560.638384] [090/131] (460s left) api_intel_allocator (two-level-inception-interruptible)
[560.707699] Starting subtest: two-level-inception-interruptible
[566.109725] Subtest two-level-inception-interruptible: SUCCESS (5.402s)
[566.265536] [091/131] (455s left) gem_exec_balancer (waits)
[566.326601] Starting subtest: waits
[572.829809] Subtest waits: SUCCESS (6.503s)
[573.173536] [092/131] (448s left) kms_ccs (crc-primary-basic-4-tiled-lnl-ccs)
[573.273881] Starting subtest: crc-primary-basic-4-tiled-lnl-ccs
[573.278473] Subtest crc-primary-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[574.389306] [093/131] (447s left) gem_softpin (allocator-nopin-reserve)
[574.443374] Starting subtest: allocator-nopin-reserve
[574.537000] Subtest allocator-nopin-reserve: SUCCESS (0.093s)
[574.689180] [094/131] (446s left) gem_exec_reloc (basic-cpu)
[574.752099] Subtest basic-cpu: SKIP (0.000s)
[574.839714] [095/131] (446s left) kms_debugfs (display-on-read-all)
[574.934542] Starting subtest: display-on-read-all
[575.138597] Subtest display-on-read-all: SUCCESS (0.204s)
[575.305208] [096/131] (446s left) kms_plane (plane-position-hole-dpms)
[575.397670] Starting subtest: plane-position-hole-dpms
[575.939280] Starting dynamic subtest: pipe-A-plane-1
[578.335402] Dynamic subtest pipe-A-plane-1: SUCCESS (2.395s)
[578.346448] Starting dynamic subtest: pipe-A-plane-2
[580.679499] Dynamic subtest pipe-A-plane-2: SUCCESS (2.343s)
[580.691001] Starting dynamic subtest: pipe-A-plane-3
[583.011962] Dynamic subtest pipe-A-plane-3: SUCCESS (2.331s)
[583.021607] Starting dynamic subtest: pipe-A-plane-4
[585.420284] Dynamic subtest pipe-A-plane-4: SUCCESS (2.410s)
[585.430766] Starting dynamic subtest: pipe-A-plane-5
[585.447266] Dynamic subtest pipe-A-plane-5: SUCCESS (0.023s)
[586.601656] Starting dynamic subtest: pipe-B-plane-1
[589.066874] Dynamic subtest pipe-B-plane-1: SUCCESS (2.478s)
[589.077215] Starting dynamic subtest: pipe-B-plane-2
[591.492001] Dynamic subtest pipe-B-plane-2: SUCCESS (2.423s)
[591.502110] Starting dynamic subtest: pipe-B-plane-3
[593.862035] Dynamic subtest pipe-B-plane-3: SUCCESS (2.370s)
[593.872300] Starting dynamic subtest: pipe-B-plane-4
[596.213497] Dynamic subtest pipe-B-plane-4: SUCCESS (2.349s)
[596.223573] Starting dynamic subtest: pipe-B-plane-5
[596.235956] Dynamic subtest pipe-B-plane-5: SUCCESS (0.022s)
[596.238203] Subtest plane-position-hole-dpms: SUCCESS (20.842s)
[597.045729] [097/131] (424s left) gem_lmem_swapping (parallel-random-verify)
[597.092661] Subtest parallel-random-verify: SKIP (0.000s)
[597.136325] [098/131] (424s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[597.231444] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[604.034445] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.806s)
[604.194366] [099/131] (417s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[604.303820] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[604.308091] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[604.425446] [100/131] (417s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-gtt)
[604.520564] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-gtt
[604.524908] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[604.640162] [101/131] (417s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[604.742701] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[604.747103] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[604.890741] [102/131] (416s left) gem_flink_basic (bad-open)
[604.943677] Starting subtest: bad-open
[604.946039] Subtest bad-open: SUCCESS (0.000s)
[605.078435] [103/131] (416s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[605.178540] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[605.182355] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[605.311832] [104/131] (416s left) gem_exec_reloc (basic-gtt-wc-noreloc)
[605.384214] Subtest basic-gtt-wc-noreloc: SKIP (0.000s)
[605.470521] [105/131] (416s left) kms_cursor_legacy (cursor-vs-flip-legacy)
[605.585215] Starting subtest: cursor-vs-flip-legacy
[634.816661] Subtest cursor-vs-flip-legacy: SUCCESS (29.236s)
[635.734655] [106/131] (386s left) gem_exec_schedule (preempt-queue-contexts-chain)
[635.816150] Subtest preempt-queue-contexts-chain: SKIP (0.000s)
[636.124504] [107/131] (385s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[636.226327] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[640.679149] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (4.458s)
[641.842017] [108/131] (380s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[641.951276] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc
[641.955198] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[642.094267] [109/131] (380s left) gem_exec_fence (syncobj-invalid-wait)
[642.526177] Starting subtest: syncobj-invalid-wait
[642.528662] Subtest syncobj-invalid-wait: SUCCESS (0.000s)
[644.236217] [110/131] (377s left) kms_psr (fbc-pr-cursor-blt)
[644.335278] Starting subtest: fbc-pr-cursor-blt
[644.339535] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[644.434261] [111/131] (377s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[644.547127] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[651.492098] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (6.948s)
[651.625610] [112/131] (370s left) kms_psr (psr2-basic)
[651.721805] Starting subtest: psr2-basic
[651.724006] Starting dynamic subtest: eDP-1
[653.300683] Dynamic subtest eDP-1: SUCCESS (1.580s)
[653.302897] Subtest psr2-basic: SUCCESS (1.581s)
[654.124013] [113/131] (368s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[654.173454] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[654.175582] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[654.318460] [114/131] (367s left) gem_ctx_param (invalid-set-no-zeromap)
[654.361936] Starting subtest: invalid-set-no-zeromap
[654.364358] Subtest invalid-set-no-zeromap: SUCCESS (0.000s)
[654.450104] [115/131] (367s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[654.563619] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[655.243452] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.681s)
[655.455151] [116/131] (366s left) drm_buddy (drm_buddy)
[655.496518] Starting subtest: drm_buddy
[655.509034] Starting dynamic subtest: drm_test_buddy_alloc_limit
[655.629252] Dynamic subtest drm_test_buddy_alloc_limit: SUCCESS (0.119s)
[655.640357] Starting dynamic subtest: drm_test_buddy_alloc_optimistic
[655.769145] Dynamic subtest drm_test_buddy_alloc_optimistic: SUCCESS (0.138s)
[655.780213] Starting dynamic subtest: drm_test_buddy_alloc_pessimistic
[655.889540] Dynamic subtest drm_test_buddy_alloc_pessimistic: SUCCESS (0.120s)
[655.898663] Starting dynamic subtest: drm_test_buddy_alloc_pathological
[656.001509] Dynamic subtest drm_test_buddy_alloc_pathological: SUCCESS (0.111s)
[656.012127] Starting dynamic subtest: drm_test_buddy_alloc_contiguous
[656.108128] Dynamic subtest drm_test_buddy_alloc_contiguous: SUCCESS (0.108s)
[656.119370] Starting dynamic subtest: drm_test_buddy_alloc_clear
[656.244033] Dynamic subtest drm_test_buddy_alloc_clear: SUCCESS (0.135s)
[656.253587] Starting dynamic subtest: drm_test_buddy_alloc_range_bias
[656.362503] Dynamic subtest drm_test_buddy_alloc_range_bias: SUCCESS (0.116s)
[656.373008] Starting dynamic subtest: drm_test_buddy_fragmentation_performance
[660.572518] Dynamic subtest drm_test_buddy_fragmentation_performance: SUCCESS (4.209s)
[660.574387] Subtest drm_buddy: SUCCESS (5.077s)
[660.780804] [117/131] (361s left) syncobj_timeline (multi-wait-available-submitted-signaled)
[660.841848] Starting subtest: multi-wait-available-submitted-signaled
[660.844377] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.000s)
[660.962553] [118/131] (361s left) kms_flip (2x-flip-vs-modeset)
[661.062007] Starting subtest: 2x-flip-vs-modeset
[661.071448] Subtest 2x-flip-vs-modeset: SKIP (0.011s)
[661.227362] [119/131] (361s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[661.319687] Starting subtest: compare-crc-sanitycheck-xr24
[661.321995] Starting dynamic subtest: pipe-A-eDP-1
[661.947018] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.626s)
[661.962837] Starting dynamic subtest: pipe-B-eDP-1
[663.149982] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.203s)
[663.161125] Starting dynamic subtest: pipe-C-eDP-1
[664.318023] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.166s)
[664.327719] Starting dynamic subtest: pipe-D-eDP-1
[665.561328] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.242s)
[665.563653] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.245s)
[666.428479] [120/131] (356s left) gem_exec_reloc (basic-gtt-cpu)
[666.489666] Subtest basic-gtt-cpu: SKIP (0.000s)
[666.578681] [121/131] (356s left) gem_exec_reloc (basic-active)
[666.643404] Subtest basic-active: SKIP (0.000s)
[666.726816] [122/131] (355s left) gem_pread (exhaustion)
[666.789334] Subtest exhaustion: SKIP (0.000s)
[666.874678] [123/131] (355s left) gem_userptr_blits (unsync-unmap)
[666.941558] Subtest unsync-unmap: SKIP (0.000s)
[667.125542] [124/131] (355s left) i915_hangman (engine-engine-error)
[667.185407] Starting subtest: engine-engine-error
[667.187554] Starting dynamic subtest: rcs0
[669.091626] Dynamic subtest rcs0: SUCCESS (1.907s)
[669.103999] Starting dynamic subtest: bcs0
[671.076136] Dynamic subtest bcs0: SUCCESS (1.982s)
[671.089715] Starting dynamic subtest: vcs0
[673.058861] Dynamic subtest vcs0: SUCCESS (1.981s)
[673.070136] Starting dynamic subtest: vcs1
[675.043815] Dynamic subtest vcs1: SUCCESS (1.983s)
[675.060013] Starting dynamic subtest: vecs0
[677.028659] Dynamic subtest vecs0: SUCCESS (1.982s)
[677.041828] Starting dynamic subtest: ccs0
[679.074499] Dynamic subtest ccs0: SUCCESS (2.044s)
[679.077125] Subtest engine-engine-error: SUCCESS (11.894s)
[679.182437] [125/131] (343s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[684.184025] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[684.188621] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.002s)
[685.061529] [126/131] (337s left) kms_flip (2x-flip-vs-wf_vblank)
[685.166170] Starting subtest: 2x-flip-vs-wf_vblank
[685.177457] Subtest 2x-flip-vs-wf_vblank: SKIP (0.011s)
[685.322247] [127/131] (337s left) api_intel_bb (lot-of-buffers)
[685.380133] Starting subtest: lot-of-buffers
[686.372553] Subtest lot-of-buffers: SUCCESS (0.993s)
[686.933752] [128/131] (335s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf)
[691.905973] Starting subtest: pr-overlay-plane-move-continuous-sf
[691.910463] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.002s)
[692.779646] [129/131] (330s left) intel_hwmon (hwmon-read)
[692.847342] Subtest hwmon-read: SKIP (0.000s)
[692.910876] [130/131] (330s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[693.004277] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[693.008370] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[693.109945] [131/131] (329s left) kms_plane_scaling (planes-scaler-unity-scaling)
[693.189879] Starting subtest: planes-scaler-unity-scaling
[693.192056] Starting dynamic subtest: pipe-A
[693.252245] Dynamic subtest pipe-A: SUCCESS (0.063s)
[693.266869] Starting dynamic subtest: pipe-B
[694.373836] Dynamic subtest pipe-B: SUCCESS (1.119s)
[694.384877] Starting dynamic subtest: pipe-C
[695.472129] Dynamic subtest pipe-C: SUCCESS (1.097s)
[695.481730] Starting dynamic subtest: pipe-D
[696.601834] Dynamic subtest pipe-D: SUCCESS (1.129s)
[696.604373] Subtest planes-scaler-unity-scaling: SUCCESS (3.416s)
[697.781879] Closing watchdogs
results: parsing output: 0/ for test: i915_pm_rc6_residency
results: parsing output: 1/ for test: kms_pm_rpm
results: parsing output: 2/ for test: gem_mmap_gtt
results: parsing output: 3/ for test: kms_cursor_crc
results: parsing output: 4/ for test: syncobj_timeline
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_ccs
results: parsing output: 7/ for test: gem_mmap
results: parsing output: 8/ for test: kms_fb_coherency
results: parsing output: 9/ for test: kms_cursor_legacy
results: parsing output: 10/ for test: kms_ccs
results: parsing output: 11/ for test: syncobj_timeline
results: parsing output: 12/ for test: gem_pxp
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: gem_exec_reloc
results: parsing output: 15/ for test: perf_pmu
results: parsing output: 16/ for test: kms_flip_scaled_crc
results: parsing output: 17/ for test: gem_exec_reloc
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: gem_wait
results: parsing output: 20/ for test: gem_flink_basic
results: parsing output: 21/ for test: vgem_slow
results: parsing output: 22/ for test: kms_flip_scaled_crc
results: parsing output: 23/ for test: gem_exec_schedule
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: gem_ctx_persistence
results: parsing output: 26/ for test: gem_mmap_gtt
results: parsing output: 27/ for test: i915_query
results: parsing output: 28/ for test: perf
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: vgem_basic
results: parsing output: 31/ for test: gem_exec_params
results: parsing output: 32/ for test: sw_sync
results: parsing output: 33/ for test: prime_mmap
results: parsing output: 34/ for test: gem_ctx_param
results: parsing output: 35/ for test: sysfs_heartbeat_interval
results: parsing output: 36/ for test: kms_plane_multiple
results: parsing output: 37/ for test: gem_exec_balancer
results: parsing output: 38/ for test: kms_big_fb
results: parsing output: 39/ for test: kms_cursor_crc
results: parsing output: 40/ for test: kms_invalid_mode
results: parsing output: 41/ for test: syncobj_timeline
results: parsing output: 42/ for test: kms_pm_rpm
results: parsing output: 43/ for test: kms_atomic
results: parsing output: 44/ for test: kms_big_fb
results: parsing output: 45/ for test: kms_chamelium_hpd
results: parsing output: 46/ for test: kms_flip
results: parsing output: 47/ for test: kms_big_fb
results: parsing output: 48/ for test: kms_psr
results: parsing output: 49/ for test: prime_busy
results: parsing output: 50/ for test: kms_big_fb
results: parsing output: 51/ for test: kms_flip
results: parsing output: 52/ for test: kms_psr
results: parsing output: 53/ for test: kms_cursor_crc
results: parsing output: 54/ for test: kms_selftest
results: parsing output: 55/ for test: syncobj_wait
results: parsing output: 56/ for test: kms_big_fb
results: parsing output: 57/ for test: gem_reg_read
results: parsing output: 58/ for test: kms_pipe_b_c_ivb
results: parsing output: 59/ for test: gem_exec_params
results: parsing output: 60/ for test: kms_flip
results: parsing output: 61/ for test: kms_atomic_interruptible
results: parsing output: 62/ for test: kms_lease
results: parsing output: 63/ for test: gem_exec_schedule
results: parsing output: 64/ for test: prime_mmap
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: sw_sync
results: parsing output: 67/ for test: kms_psr
results: parsing output: 68/ for test: kms_psr
results: parsing output: 69/ for test: gem_huc_copy
results: parsing output: 70/ for test: kms_content_protection
results: parsing output: 71/ for test: gem_eio
results: parsing output: 72/ for test: kms_vblank
results: parsing output: 73/ for test: kms_plane_scaling
results: parsing output: 74/ for test: gem_render_copy
results: parsing output: 75/ for test: gem_create
results: parsing output: 76/ for test: kms_flip_scaled_crc
results: parsing output: 77/ for test: gen7_exec_parse
results: parsing output: 78/ for test: gem_shrink
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: kms_ccs
results: parsing output: 81/ for test: kms_chamelium_edid
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: i915_drm_fdinfo
results: parsing output: 84/ for test: gem_ctx_shared
results: parsing output: 85/ for test: kms_ccs
results: parsing output: 86/ for test: gem_exec_flush
results: parsing output: 87/ for test: gem_busy
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: api_intel_allocator
results: parsing output: 90/ for test: gem_exec_balancer
results: parsing output: 91/ for test: kms_ccs
results: parsing output: 92/ for test: gem_softpin
results: parsing output: 93/ for test: gem_exec_reloc
results: parsing output: 94/ for test: kms_debugfs
results: parsing output: 95/ for test: kms_plane
results: parsing output: 96/ for test: gem_lmem_swapping
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: gem_flink_basic
results: parsing output: 102/ for test: kms_big_fb
results: parsing output: 103/ for test: gem_exec_reloc
results: parsing output: 104/ for test: kms_cursor_legacy
results: parsing output: 105/ for test: gem_exec_schedule
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: gem_exec_fence
results: parsing output: 109/ for test: kms_psr
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_psr
results: parsing output: 112/ for test: syncobj_timeline
results: parsing output: 113/ for test: gem_ctx_param
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: drm_buddy
results: parsing output: 116/ for test: syncobj_timeline
results: parsing output: 117/ for test: kms_flip
results: parsing output: 118/ for test: kms_pipe_crc_basic
results: parsing output: 119/ for test: gem_exec_reloc
results: parsing output: 120/ for test: gem_exec_reloc
results: parsing output: 121/ for test: gem_pread
results: parsing output: 122/ for test: gem_userptr_blits
results: parsing output: 123/ for test: i915_hangman
results: parsing output: 124/ for test: kms_psr2_sf
results: parsing output: 125/ for test: kms_flip
results: parsing output: 126/ for test: api_intel_bb
results: parsing output: 127/ for test: kms_psr2_sf
results: parsing output: 128/ for test: intel_hwmon
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: kms_plane_scaling
Done.