[57.452126] Initializing watchdogs
[57.452271]   /dev/watchdog0
[57.467507] [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.471498] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.473580] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.476848] [001/131] (960s left) i915_pm_rc6_residency (media-rc6-accuracy)
[57.554921] Starting subtest: media-rc6-accuracy
[57.559505] Subtest media-rc6-accuracy: SKIP (0.000s)
[57.693775] [002/131] (960s left) kms_pm_rpm (modeset-lpsp-stress)
[59.244613] Starting subtest: modeset-lpsp-stress
[74.724471] Subtest modeset-lpsp-stress: SUCCESS (15.490s)
[74.834069] [003/131] (943s left) gem_mmap_gtt (big-bo-tiledx)
[74.889093] Subtest big-bo-tiledX: SKIP (0.000s)
[74.944258] [004/131] (943s left) kms_cursor_crc (cursor-offscreen-32x32)
[75.075196] Starting subtest: cursor-offscreen-32x32
[75.124903] Subtest cursor-offscreen-32x32: SKIP (0.045s)
[75.441592] [005/131] (942s left) syncobj_timeline (multi-wait-available-signaled)
[75.509844] Starting subtest: multi-wait-available-signaled
[75.512234] Subtest multi-wait-available-signaled: SUCCESS (0.000s)
[75.650123] [006/131] (942s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[75.752168] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[75.755596] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[75.890943] [007/131] (942s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[75.991076] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[75.992987] Starting dynamic subtest: pipe-A-eDP-1
[76.011343] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.020s)
[76.018172] Starting dynamic subtest: pipe-B-eDP-1
[76.034309] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.020s)
[76.041120] Starting dynamic subtest: pipe-C-eDP-1
[76.057082] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.020s)
[76.065030] Starting dynamic subtest: pipe-D-eDP-1
[76.081201] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.019s)
[76.082953] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.082s)
[78.370737] [008/131] (939s left) gem_mmap (bad-object)
[78.436431] Subtest bad-object: SKIP (0.000s)
[78.501608] [009/131] (939s left) kms_fb_coherency (memset-crc)
[78.594678] Starting subtest: memset-crc
[78.596569] Starting dynamic subtest: mmap-offset-wc
[79.245888] Dynamic subtest mmap-offset-wc: CRASH (0.146s)
[79.690560] Subtest memset-crc: CRASH (0.599s)
[79.722049] [010/131] (938s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[79.833500] Starting subtest: basic-busy-flip-before-cursor-legacy
[79.837092] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[79.999696] [011/131] (938s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs)
[80.091937] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs
[80.093775] Starting dynamic subtest: pipe-A-eDP-1
[80.114069] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[80.121719] Starting dynamic subtest: pipe-B-eDP-1
[80.140290] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[80.147145] Starting dynamic subtest: pipe-C-eDP-1
[80.165882] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[80.172751] Starting dynamic subtest: pipe-D-eDP-1
[80.192050] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[80.195383] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.003s)
[82.422142] [012/131] (935s left) syncobj_timeline (wait-delayed-signal)
[82.484229] Starting subtest: wait-delayed-signal
[82.588727] Subtest wait-delayed-signal: SUCCESS (0.103s)
[82.686088] [013/131] (935s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[82.818078] Starting subtest: protected-encrypted-src-copy-not-readible
[82.930134] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.113s)
[83.108608] [014/131] (935s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-wc)
[83.220102] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-wc
[87.441877] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (4.228s)
[88.639863] [015/131] (929s left) gem_exec_reloc (basic-wc-read)
[88.705089] Subtest basic-wc-read: SKIP (0.000s)
[88.768644] [016/131] (929s left) perf_pmu (rc6-suspend)
[88.810402] Starting subtest: rc6-suspend
[111.186320] Subtest rc6-suspend: SUCCESS (11.177s)
[112.220106] [017/131] (906s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[112.342184] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[112.344511] Starting dynamic subtest: pipe-A-default-mode
[115.098382] Dynamic subtest pipe-A-default-mode: SUCCESS (2.763s)
[115.101135] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.764s)
[115.948104] [018/131] (902s left) gem_exec_reloc (basic-write-read-active)
[116.016624] Subtest basic-write-read-active: SKIP (0.000s)
[116.093139] [019/131] (902s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[116.196660] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[116.202077] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[116.340622] [020/131] (902s left) gem_wait (wait)
[116.408845] Starting subtest: wait
[116.411863] Starting dynamic subtest: all-engines
[118.123548] Dynamic subtest all-engines: SUCCESS (1.717s)
[118.135847] Starting dynamic subtest: rcs0
[119.171195] Dynamic subtest rcs0: SUCCESS (1.050s)
[119.182844] Starting dynamic subtest: bcs0
[120.221483] Dynamic subtest bcs0: SUCCESS (1.051s)
[120.233827] Starting dynamic subtest: vcs0
[121.268828] Dynamic subtest vcs0: SUCCESS (1.047s)
[121.280825] Starting dynamic subtest: vcs1
[122.318120] Dynamic subtest vcs1: SUCCESS (1.050s)
[122.329711] Starting dynamic subtest: vecs0
[123.364973] Dynamic subtest vecs0: SUCCESS (1.047s)
[123.376160] Starting dynamic subtest: ccs0
[124.417580] Dynamic subtest ccs0: SUCCESS (1.053s)
[124.420670] Subtest wait: SUCCESS (8.022s)
[124.638002] [021/131] (894s left) gem_flink_basic (double-flink)
[124.709675] Starting subtest: double-flink
[124.712495] Subtest double-flink: SUCCESS (0.000s)
[124.844123] [022/131] (893s left) vgem_slow (nohang)
[124.919400] Starting subtest: nohang
[135.237860] Subtest nohang: SUCCESS (10.330s)
[135.326105] [FACT vgem_slow (nohang)] new: kernel.kmod_is_loaded.vgem: true
[135.329810] [023/131] (883s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling)
[135.441353] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling
[135.444104] Starting dynamic subtest: pipe-A-default-mode
[136.566567] Dynamic subtest pipe-A-default-mode: SKIP (1.128s)
[136.571204] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SKIP (1.129s)
[136.767644] [024/131] (882s left) gem_exec_schedule (wide)
[136.965128] Starting subtest: wide
[136.971348] Starting dynamic subtest: rcs0
[147.600042] Dynamic subtest rcs0: SUCCESS (10.638s)
[147.612972] Starting dynamic subtest: vcs0
[158.449631] Dynamic subtest vcs0: SUCCESS (10.855s)
[158.461378] Starting dynamic subtest: vcs1
[170.200631] Dynamic subtest vcs1: SUCCESS (11.756s)
[170.216807] Starting dynamic subtest: vecs0
[179.643008] Dynamic subtest vecs0: SUCCESS (9.447s)
[179.653522] Starting dynamic subtest: ccs0
[192.964478] Dynamic subtest ccs0: SUCCESS (13.327s)
[192.967619] Subtest wide: SUCCESS (56.025s)
[194.312358] [025/131] (824s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[194.423602] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[201.439674] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.025s)
[201.587892] [026/131] (817s left) gem_ctx_persistence (saturated-hostile)
[201.652210] Starting subtest: saturated-hostile
[201.654827] Starting dynamic subtest: rcs0
[202.464707] Dynamic subtest rcs0: SUCCESS (0.812s)
[202.477017] Starting dynamic subtest: bcs0
[203.282438] Dynamic subtest bcs0: SUCCESS (0.816s)
[203.294981] Starting dynamic subtest: vcs0
[204.073265] Dynamic subtest vcs0: SUCCESS (0.789s)
[204.085463] Starting dynamic subtest: vcs1
[204.885358] Dynamic subtest vcs1: SUCCESS (0.810s)
[204.897516] Starting dynamic subtest: vecs0
[205.698885] Dynamic subtest vecs0: SUCCESS (0.812s)
[205.711219] Starting dynamic subtest: ccs0
[206.552052] Dynamic subtest ccs0: SUCCESS (0.852s)
[206.554687] Subtest saturated-hostile: SUCCESS (4.898s)
[206.656667] [027/131] (812s left) gem_mmap_gtt (fault-concurrent-y)
[206.728083] Subtest fault-concurrent-Y: SKIP (0.000s)
[206.788761] [028/131] (812s left) i915_query (test-query-geometry-subslices)
[206.859925] Starting subtest: test-query-geometry-subslices
[206.862674] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[207.000797] [029/131] (812s left) perf (global-sseu-config-invalid)
[207.143566] Starting subtest: global-sseu-config-invalid
[207.148659] Subtest global-sseu-config-invalid: SKIP (0.000s)
[207.187461] [030/131] (811s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-render)
[207.299548] Starting subtest: fbcpsr-rgb565-draw-render
[214.381774] Subtest fbcpsr-rgb565-draw-render: SUCCESS (7.084s)
[214.563856] [031/131] (804s left) vgem_basic (dmabuf-fence-before)
[214.615123] Starting subtest: dmabuf-fence-before
[214.617702] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[214.698060] [032/131] (804s left) gem_exec_params (secure-non-root)
[214.755877] Starting subtest: secure-non-root
[214.760896] Subtest secure-non-root: SKIP (0.000s)
[214.890255] [033/131] (804s left) sw_sync (sync_expired_merge)
[214.930872] Starting subtest: sync_expired_merge
[216.005361] Subtest sync_expired_merge: SUCCESS (1.074s)
[216.092004] [034/131] (803s left) prime_mmap (test_reprime)
[216.149451] Starting subtest: test_reprime
[216.151477] Starting dynamic subtest: test_reprime-smem
[216.176440] Dynamic subtest test_reprime-smem: SUCCESS (0.030s)
[216.179237] Subtest test_reprime: SUCCESS (0.030s)
[216.293263] [035/131] (803s left) gem_ctx_param (basic)
[216.343673] Starting subtest: basic
[216.346407] Subtest basic: SUCCESS (0.001s)
[216.480206] [036/131] (802s left) sysfs_heartbeat_interval (nopreempt)
[216.528835] Starting subtest: nopreempt
[216.531640] Starting dynamic subtest: vecs0
[226.175803] Dynamic subtest vecs0: SUCCESS (9.645s)
[226.189126] Starting dynamic subtest: ccs0
[230.134829] Dynamic subtest ccs0: SUCCESS (3.957s)
[230.146382] Starting dynamic subtest: vcs0
[240.122068] Dynamic subtest vcs0: SUCCESS (9.983s)
[240.134516] Starting dynamic subtest: bcs0
[244.028839] Dynamic subtest bcs0: SUCCESS (3.907s)
[244.039730] Starting dynamic subtest: rcs0
[248.059071] Dynamic subtest rcs0: SUCCESS (4.030s)
[248.069343] Starting dynamic subtest: vcs1
[258.151603] Dynamic subtest vcs1: SUCCESS (10.092s)
[258.154834] Subtest nopreempt: SUCCESS (41.623s)
[258.253736] [037/131] (761s left) kms_plane_multiple (2x-tiling-y)
[258.357276] Starting subtest: 2x-tiling-y
[258.362276] Subtest 2x-tiling-y: SKIP (0.000s)
[258.458726] [038/131] (761s left) gem_exec_balancer (bonded-semaphore)
[258.518814] Starting subtest: bonded-semaphore
[258.524266] Subtest bonded-semaphore: SKIP (0.000s)
[258.849082] [039/131] (760s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[258.949755] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[258.954609] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[259.085217] [040/131] (760s left) kms_cursor_crc (cursor-sliding-512x512)
[259.346777] Starting subtest: cursor-sliding-512x512
[259.351948] Subtest cursor-sliding-512x512: SKIP (0.001s)
[259.556343] [041/131] (760s left) kms_invalid_mode (bad-hsync-start)
[259.657861] Starting subtest: bad-hsync-start
[259.660427] Starting dynamic subtest: pipe-A-eDP-1
[259.946941] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.293s)
[259.956836] Starting dynamic subtest: pipe-B-eDP-1
[259.959220] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[259.967822] Starting dynamic subtest: pipe-C-eDP-1
[259.970623] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[259.979731] Starting dynamic subtest: pipe-D-eDP-1
[259.982254] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[259.984531] Subtest bad-hsync-start: SUCCESS (0.298s)
[260.781342] [042/131] (758s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-signaled)
[260.855557] Starting subtest: etime-multi-wait-all-available-unsubmitted-signaled
[260.965069] Subtest etime-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.108s)
[261.064062] [043/131] (758s left) kms_pm_rpm (i2c)
[263.284447] Starting subtest: i2c
[268.595803] Subtest i2c: SUCCESS (5.310s)
[268.708541] [044/131] (751s left) kms_atomic (atomic-plane-damage)
[268.802749] Starting subtest: atomic-plane-damage
[268.852571] Starting dynamic subtest: pipe-A-eDP-1
[269.428146] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.575s)
[269.430687] Subtest atomic-plane-damage: SUCCESS (0.623s)
[270.319257] [045/131] (749s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[270.424829] Starting subtest: 4-tiled-8bpp-rotate-270
[270.449731] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.023s)
[270.595927] [046/131] (749s left) kms_chamelium_hpd (dp-hpd-storm)
[270.996870] Subtest dp-hpd-storm: SKIP (0.000s)
[271.813079] [047/131] (748s left) kms_flip (2x-plain-flip-fb-recreate-interruptible)
[271.907576] Starting subtest: 2x-plain-flip-fb-recreate-interruptible
[271.918068] Subtest 2x-plain-flip-fb-recreate-interruptible: SKIP (0.010s)
[272.053254] [048/131] (747s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[272.155928] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[273.002570] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.848s)
[273.199800] [049/131] (746s left) kms_psr (psr-primary-page-flip)
[273.294500] Starting subtest: psr-primary-page-flip
[273.297025] Starting dynamic subtest: eDP-1
[275.039516] Dynamic subtest eDP-1: SUCCESS (1.745s)
[275.042818] Subtest psr-primary-page-flip: SUCCESS (1.747s)
[275.923361] [050/131] (744s left) prime_busy (hang)
[275.982271] Starting subtest: hang
[275.984729] Starting dynamic subtest: rcs0
[301.638171] Dynamic subtest rcs0: SUCCESS (25.659s)
[301.648837] Starting dynamic subtest: bcs0
[308.790870] Dynamic subtest bcs0: SUCCESS (7.153s)
[308.802488] Starting dynamic subtest: vcs0
[315.766735] Dynamic subtest vcs0: SUCCESS (6.979s)
[315.775861] Starting dynamic subtest: vcs1
[322.804272] Dynamic subtest vcs1: SUCCESS (7.038s)
[322.816595] Starting dynamic subtest: vecs0
[329.775291] Dynamic subtest vecs0: SUCCESS (6.975s)
[329.787968] Starting dynamic subtest: ccs0
[343.623152] Dynamic subtest ccs0: SUCCESS (13.832s)
[343.626129] Subtest hang: SUCCESS (67.642s)
[343.775392] [051/131] (676s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[343.888651] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[344.766728] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.881s)
[344.947734] [052/131] (675s left) kms_flip (flip-vs-modeset-vs-hang)
[345.042579] Starting subtest: flip-vs-modeset-vs-hang
[345.045161] Starting dynamic subtest: A-eDP1
[384.581833] Dynamic subtest A-eDP1: SUCCESS (39.520s)
[384.595253] Starting dynamic subtest: D-eDP1
[435.582307] Dynamic subtest D-eDP1: SUCCESS (51.000s)
[435.584681] Subtest flip-vs-modeset-vs-hang: SUCCESS (90.526s)
[436.005376] [053/131] (584s left) kms_psr (psr-primary-mmap-cpu)
[436.103762] Starting subtest: psr-primary-mmap-cpu
[436.106840] Starting dynamic subtest: eDP-1
[437.797414] Dynamic subtest eDP-1: SUCCESS (1.689s)
[437.800073] Subtest psr-primary-mmap-cpu: SUCCESS (1.690s)
[438.687127] [054/131] (581s left) kms_cursor_crc (cursor-random-32x32)
[438.839825] Starting subtest: cursor-random-32x32
[438.889585] Subtest cursor-random-32x32: SKIP (0.039s)
[439.238658] [055/131] (580s left) kms_selftest (drm_format_helper)
[439.276840] Starting subtest: drm_format_helper
[439.326265] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8
[439.490288] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.165s)
[439.501061] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332
[439.657647] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.166s)
[439.669517] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565
[439.811650] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.152s)
[439.822184] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555
[439.972757] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.159s)
[439.984257] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555
[440.133970] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.161s)
[440.144816] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551
[440.285848] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.149s)
[440.295396] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888
[440.442750] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.157s)
[440.454044] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888
[440.582456] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.139s)
[440.593740] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888
[440.716238] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.132s)
[440.727706] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010
[440.845651] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.129s)
[440.856732] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010
[440.993699] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.146s)
[441.004112] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono
[441.152460] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.160s)
[441.162292] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab
[441.321093] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.168s)
[441.330894] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888
[441.483735] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.159s)
[441.493669] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888
[441.629168] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.147s)
[441.638822] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset
[441.780505] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.150s)
[441.790592] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy
[441.917842] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.136s)
[441.920510] Subtest drm_format_helper: SUCCESS (2.643s)
[442.138535] [056/131] (578s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled)
[442.203292] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[442.206135] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[442.324132] [057/131] (577s left) kms_big_fb (y-tiled-16bpp-rotate-180)
[442.433528] Starting subtest: y-tiled-16bpp-rotate-180
[442.438817] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s)
[442.576404] [058/131] (577s left) gem_reg_read (timestamp-moving)
[442.636242] Starting subtest: timestamp-moving
[443.636199] Subtest timestamp-moving: SUCCESS (1.001s)
[443.735913] [059/131] (576s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[443.800934] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[443.870153] [060/131] (576s left) gem_exec_params (no-bsd)
[443.934677] Starting subtest: no-bsd
[443.937716] Subtest no-bsd: SUCCESS (0.002s)
[445.246551] [061/131] (575s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[445.352993] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[445.363774] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.010s)
[445.512497] [062/131] (574s left) kms_atomic_interruptible (universal-setplane-cursor)
[445.622511] Starting subtest: universal-setplane-cursor
[445.625068] Starting dynamic subtest: pipe-A-eDP-1
[452.996752] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.376s)
[452.999763] Subtest universal-setplane-cursor: SUCCESS (7.377s)
[453.862050] [063/131] (566s left) kms_lease (atomic-implicit-crtc)
[453.967308] Starting subtest: atomic-implicit-crtc
[453.969686] Starting dynamic subtest: pipe-A-eDP-1
[453.984350] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[453.995278] Starting dynamic subtest: pipe-B-eDP-1
[454.008857] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.009s)
[454.018671] Starting dynamic subtest: pipe-C-eDP-1
[454.031675] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.009s)
[454.041708] Starting dynamic subtest: pipe-D-eDP-1
[454.054634] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.009s)
[454.057384] Subtest atomic-implicit-crtc: SUCCESS (0.033s)
[454.148142] [064/131] (566s left) gem_exec_schedule (pi-common)
[454.334146] Starting subtest: pi-common
[454.336575] Starting dynamic subtest: rcs0
[454.358523] Dynamic subtest rcs0: SUCCESS (0.027s)
[454.370843] Starting dynamic subtest: bcs0
[454.386341] Dynamic subtest bcs0: SUCCESS (0.027s)
[454.400646] Starting dynamic subtest: vcs0
[454.411871] Dynamic subtest vcs0: SUCCESS (0.025s)
[454.425865] Starting dynamic subtest: vcs1
[454.438536] Dynamic subtest vcs1: SUCCESS (0.026s)
[454.451200] Starting dynamic subtest: vecs0
[454.466443] Dynamic subtest vecs0: SUCCESS (0.027s)
[454.479204] Starting dynamic subtest: ccs0
[454.494834] Dynamic subtest ccs0: SUCCESS (0.028s)
[454.497628] Subtest pi-common: SUCCESS (0.165s)
[454.732378] [065/131] (565s left) prime_mmap (test_correct)
[454.794052] Starting subtest: test_correct
[454.796645] Starting dynamic subtest: test_correct-smem
[454.821293] Dynamic subtest test_correct-smem: SUCCESS (0.030s)
[454.824137] Subtest test_correct: SUCCESS (0.030s)
[454.942574] [066/131] (565s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[455.053639] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[461.567773] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.515s)
[461.717325] [067/131] (558s left) sw_sync (sync_random_merge)
[461.749561] Starting subtest: sync_random_merge
[461.784578] Subtest sync_random_merge: SUCCESS (0.036s)
[461.870201] [068/131] (558s left) kms_psr (fbc-psr2-basic)
[461.967358] Starting subtest: fbc-psr2-basic
[461.969600] Starting dynamic subtest: eDP-1
[461.973814] Dynamic subtest eDP-1: SKIP (0.000s)
[461.978155] Subtest fbc-psr2-basic: SKIP (0.001s)
[462.061026] [069/131] (558s left) kms_psr (fbc-psr-primary-render)
[462.158602] Starting subtest: fbc-psr-primary-render
[462.160811] Starting dynamic subtest: eDP-1
[462.165555] Dynamic subtest eDP-1: SKIP (0.000s)
[462.170718] Subtest fbc-psr-primary-render: SKIP (0.001s)
[462.255343] [070/131] (558s left) gem_huc_copy (huc-copy)
[462.328619] Starting subtest: huc-copy
[462.330884] Subtest huc-copy: SUCCESS (0.003s)
[462.479378] [071/131] (558s left) kms_content_protection (lic-type-0)
[462.633630] Starting subtest: lic-type-0
[462.638853] Subtest lic-type-0: SKIP (0.000s)
[462.788032] [072/131] (558s left) gem_eio (reset-stress)
[462.992470] Starting subtest: reset-stress
[462.994643] Starting dynamic subtest: render
[467.755980] Dynamic subtest render: SUCCESS (4.760s)
[467.772881] Starting dynamic subtest: bsd1
[485.682287] Dynamic subtest bsd1: SUCCESS (17.916s)
[485.692628] Starting dynamic subtest: bsd2
[503.700557] Dynamic subtest bsd2: SUCCESS (18.020s)
[503.717614] Starting dynamic subtest: blt
[503.722593] Dynamic subtest blt: SKIP (0.000s)
[503.732039] Starting dynamic subtest: vebox
[521.653633] Dynamic subtest vebox: SUCCESS (17.951s)
[521.656176] Subtest reset-stress: SUCCESS (58.651s)
[523.180382] [073/131] (497s left) kms_vblank (wait-forked-busy-hang)
[523.293642] Starting subtest: wait-forked-busy-hang
[523.296289] Starting dynamic subtest: pipe-A-eDP-1
[525.168577] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.875s)
[525.185703] Starting dynamic subtest: pipe-D-eDP-1
[527.741769] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.570s)
[527.744686] Subtest wait-forked-busy-hang: SUCCESS (4.451s)
[528.556807] [074/131] (492s left) kms_plane_scaling (2x-scaler-multi-pipe)
[528.657912] Starting subtest: 2x-scaler-multi-pipe
[528.663465] Subtest 2x-scaler-multi-pipe: SKIP (0.001s)
[528.776442] [075/131] (492s left) gem_render_copy (y-tiled-to-vebox-yf-tiled)
[528.834378] Starting subtest: y-tiled-to-vebox-yf-tiled
[528.839603] Subtest y-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[529.071610] [076/131] (492s left) gem_create (create-ext-placement-all)
[529.254149] Starting subtest: create-ext-placement-all
[529.257149] Subtest create-ext-placement-all: SUCCESS (0.000s)
[529.380689] [077/131] (491s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling)
[529.490875] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-downscaling
[529.493580] Starting dynamic subtest: pipe-A-default-mode
[529.786707] Dynamic subtest pipe-A-default-mode: SKIP (0.293s)
[529.791688] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SKIP (0.294s)
[530.599412] [078/131] (490s left) gen7_exec_parse (cmd-crossing-page)
[530.669624] Subtest cmd-crossing-page: SKIP (0.000s)
[530.762145] [079/131] (490s left) gem_shrink (reclaim)
[530.836547] Starting subtest: reclaim
[533.287178] Subtest reclaim: SUCCESS (2.447s)
[533.480473] [080/131] (487s left) kms_frontbuffer_tracking (fbc-tiling-4)
[533.586600] Starting subtest: fbc-tiling-4
[537.767352] Subtest fbc-tiling-4: SUCCESS (4.185s)
[539.002023] [081/131] (482s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc)
[539.104205] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc
[539.106854] Starting dynamic subtest: pipe-A-eDP-1
[539.252632] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.139s)
[539.262532] Starting dynamic subtest: pipe-B-eDP-1
[539.282849] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.012s)
[539.292849] Starting dynamic subtest: pipe-C-eDP-1
[539.316354] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.011s)
[539.325958] Starting dynamic subtest: pipe-D-eDP-1
[539.349771] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.012s)
[539.352326] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.181s)
[541.564531] [082/131] (479s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[541.980431] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[542.759105] [083/131] (478s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[542.866831] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[542.872705] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[543.002312] [084/131] (478s left) i915_drm_fdinfo (all-busy-check-all)
[543.043150] Starting subtest: all-busy-check-all
[543.047634] Subtest all-busy-check-all: SKIP (0.004s)
[543.131507] [085/131] (478s left) gem_ctx_shared (q-out-order)
[543.247265] Starting subtest: Q-out-order
[543.249760] Starting dynamic subtest: rcs0
[543.347648] Dynamic subtest rcs0: SUCCESS (0.100s)
[543.365686] Starting dynamic subtest: vcs0
[543.428146] Dynamic subtest vcs0: SUCCESS (0.080s)
[543.445827] Starting dynamic subtest: vcs1
[543.508700] Dynamic subtest vcs1: SUCCESS (0.080s)
[543.524737] Starting dynamic subtest: vecs0
[543.584178] Dynamic subtest vecs0: SUCCESS (0.074s)
[543.601266] Starting dynamic subtest: ccs0
[543.679398] Dynamic subtest ccs0: SUCCESS (0.095s)
[543.682427] Subtest Q-out-order: SUCCESS (0.433s)
[545.268981] [086/131] (476s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs)
[545.361561] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs
[545.364225] Starting dynamic subtest: pipe-A-eDP-1
[545.374698] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[545.385436] Starting dynamic subtest: pipe-B-eDP-1
[545.395854] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[545.405888] Starting dynamic subtest: pipe-C-eDP-1
[545.416625] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[545.426665] Starting dynamic subtest: pipe-D-eDP-1
[545.437764] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[545.443354] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs: SKIP (0.005s)
[547.576085] [087/131] (474s left) gem_exec_flush (basic-wb-ro-default)
[547.650599] Starting subtest: basic-wb-ro-default
[553.109657] Subtest basic-wb-ro-default: SUCCESS (5.452s)
[553.317098] [088/131] (468s left) gem_busy (extended)
[553.524148] Starting subtest: extended
[553.527053] Starting dynamic subtest: rcs0
[553.639739] Dynamic subtest rcs0: SUCCESS (0.115s)
[553.652839] Starting dynamic subtest: bcs0
[553.685839] Dynamic subtest bcs0: SUCCESS (0.044s)
[553.696610] Starting dynamic subtest: vcs0
[555.113179] Dynamic subtest vcs0: SUCCESS (1.424s)
[555.126687] Starting dynamic subtest: vcs1
[557.097116] Dynamic subtest vcs1: SUCCESS (1.981s)
[557.110726] Starting dynamic subtest: vecs0
[559.144207] Dynamic subtest vecs0: SUCCESS (2.044s)
[559.156861] Starting dynamic subtest: ccs0
[559.188938] Dynamic subtest ccs0: SUCCESS (0.044s)
[559.192001] Subtest extended: SUCCESS (5.666s)
[559.478278] [089/131] (462s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-pwrite)
[559.595641] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-pwrite
[559.600635] Subtest fbc-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[559.729767] [090/131] (461s left) api_intel_allocator (two-level-inception-interruptible)
[559.788971] Starting subtest: two-level-inception-interruptible
[565.189877] Subtest two-level-inception-interruptible: SUCCESS (5.402s)
[565.363241] [091/131] (456s left) gem_exec_balancer (waits)
[565.458422] Starting subtest: waits
[571.913866] Subtest waits: SUCCESS (6.453s)
[572.249181] [092/131] (449s left) kms_ccs (crc-primary-basic-4-tiled-lnl-ccs)
[572.350532] Starting subtest: crc-primary-basic-4-tiled-lnl-ccs
[572.355248] Subtest crc-primary-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[573.495945] [093/131] (448s left) gem_softpin (allocator-nopin-reserve)
[573.562821] Starting subtest: allocator-nopin-reserve
[573.676155] Subtest allocator-nopin-reserve: SUCCESS (0.112s)
[573.814302] [094/131] (448s left) gem_exec_reloc (basic-cpu)
[573.890652] Subtest basic-cpu: SKIP (0.000s)
[573.976527] [095/131] (447s left) kms_debugfs (display-on-read-all)
[574.067830] Starting subtest: display-on-read-all
[574.246109] Subtest display-on-read-all: SUCCESS (0.179s)
[574.388597] [096/131] (447s left) kms_plane (plane-position-hole-dpms)
[574.481573] Starting subtest: plane-position-hole-dpms
[574.983825] Starting dynamic subtest: pipe-A-plane-1
[577.276545] Dynamic subtest pipe-A-plane-1: SUCCESS (2.293s)
[577.287730] Starting dynamic subtest: pipe-A-plane-2
[579.523797] Dynamic subtest pipe-A-plane-2: SUCCESS (2.247s)
[579.535842] Starting dynamic subtest: pipe-A-plane-3
[581.882616] Dynamic subtest pipe-A-plane-3: SUCCESS (2.358s)
[581.894834] Starting dynamic subtest: pipe-A-plane-4
[584.151804] Dynamic subtest pipe-A-plane-4: SUCCESS (2.269s)
[584.163416] Starting dynamic subtest: pipe-A-plane-5
[584.179034] Dynamic subtest pipe-A-plane-5: SUCCESS (0.024s)
[585.336277] Starting dynamic subtest: pipe-B-plane-1
[587.580674] Dynamic subtest pipe-B-plane-1: SUCCESS (2.256s)
[587.592441] Starting dynamic subtest: pipe-B-plane-2
[589.847069] Dynamic subtest pipe-B-plane-2: SUCCESS (2.266s)
[589.857837] Starting dynamic subtest: pipe-B-plane-3
[592.101696] Dynamic subtest pipe-B-plane-3: SUCCESS (2.255s)
[592.112827] Starting dynamic subtest: pipe-B-plane-4
[594.367501] Dynamic subtest pipe-B-plane-4: SUCCESS (2.265s)
[594.382376] Starting dynamic subtest: pipe-B-plane-5
[594.393595] Dynamic subtest pipe-B-plane-5: SUCCESS (0.023s)
[594.396437] Subtest plane-position-hole-dpms: SUCCESS (19.914s)
[595.216166] [097/131] (426s left) gem_lmem_swapping (parallel-random-verify)
[595.267627] Subtest parallel-random-verify: SKIP (0.000s)
[595.311867] [098/131] (426s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[595.405866] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[602.192707] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.791s)
[602.341309] [099/131] (419s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[602.452897] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[602.457739] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[602.598947] [100/131] (419s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-gtt)
[602.697915] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-gtt
[602.703249] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[602.823563] [101/131] (419s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[602.934575] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[602.939626] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[603.090357] [102/131] (419s left) gem_flink_basic (bad-open)
[603.155325] Starting subtest: bad-open
[603.157546] Subtest bad-open: SUCCESS (0.000s)
[603.287082] [103/131] (419s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[603.393374] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[603.397659] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[603.534043] [104/131] (418s left) gem_exec_reloc (basic-gtt-wc-noreloc)
[603.604165] Subtest basic-gtt-wc-noreloc: SKIP (0.000s)
[603.690353] [105/131] (418s left) kms_cursor_legacy (cursor-vs-flip-legacy)
[603.809349] Starting subtest: cursor-vs-flip-legacy
[633.189895] Subtest cursor-vs-flip-legacy: SUCCESS (29.381s)
[634.000199] [106/131] (388s left) gem_exec_schedule (preempt-queue-contexts-chain)
[634.070655] Subtest preempt-queue-contexts-chain: SKIP (0.000s)
[634.382207] [107/131] (388s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[634.494234] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[638.897606] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (4.407s)
[640.099098] [108/131] (382s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[640.201644] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc
[640.207418] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[640.310619] [109/131] (382s left) gem_exec_fence (syncobj-invalid-wait)
[640.772860] Starting subtest: syncobj-invalid-wait
[640.775732] Subtest syncobj-invalid-wait: SUCCESS (0.000s)
[642.219479] [110/131] (380s left) kms_psr (fbc-pr-cursor-blt)
[642.311649] Starting subtest: fbc-pr-cursor-blt
[642.316825] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[642.407027] [111/131] (380s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[642.510148] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[649.459702] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (6.952s)
[649.617304] [112/131] (373s left) kms_psr (psr2-basic)
[649.719675] Starting subtest: psr2-basic
[649.722239] Starting dynamic subtest: eDP-1
[651.288589] Dynamic subtest eDP-1: SUCCESS (1.568s)
[651.291282] Subtest psr2-basic: SUCCESS (1.569s)
[652.106318] [113/131] (370s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[652.182771] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[652.185549] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[652.322174] [114/131] (370s left) gem_ctx_param (invalid-set-no-zeromap)
[652.382857] Starting subtest: invalid-set-no-zeromap
[652.385758] Subtest invalid-set-no-zeromap: SUCCESS (0.000s)
[652.484443] [115/131] (370s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[652.587634] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[653.298838] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.715s)
[653.473186] [116/131] (369s left) drm_buddy (drm_buddy)
[653.515451] Starting subtest: drm_buddy
[653.528587] Starting dynamic subtest: drm_test_buddy_alloc_limit
[653.683715] Dynamic subtest drm_test_buddy_alloc_limit: SUCCESS (0.154s)
[653.694641] Starting dynamic subtest: drm_test_buddy_alloc_optimistic
[653.844855] Dynamic subtest drm_test_buddy_alloc_optimistic: SUCCESS (0.162s)
[653.855620] Starting dynamic subtest: drm_test_buddy_alloc_pessimistic
[653.995989] Dynamic subtest drm_test_buddy_alloc_pessimistic: SUCCESS (0.149s)
[654.015860] Starting dynamic subtest: drm_test_buddy_alloc_pathological
[654.119996] Dynamic subtest drm_test_buddy_alloc_pathological: SUCCESS (0.125s)
[654.136437] Starting dynamic subtest: drm_test_buddy_alloc_contiguous
[654.250554] Dynamic subtest drm_test_buddy_alloc_contiguous: SUCCESS (0.129s)
[654.262656] Starting dynamic subtest: drm_test_buddy_alloc_clear
[654.423566] Dynamic subtest drm_test_buddy_alloc_clear: SUCCESS (0.171s)
[654.433861] Starting dynamic subtest: drm_test_buddy_alloc_range_bias
[654.557811] Dynamic subtest drm_test_buddy_alloc_range_bias: SUCCESS (0.134s)
[654.568839] Starting dynamic subtest: drm_test_buddy_fragmentation_performance
[658.797329] Dynamic subtest drm_test_buddy_fragmentation_performance: SUCCESS (4.235s)
[658.799820] Subtest drm_buddy: SUCCESS (5.284s)
[659.024309] [117/131] (363s left) syncobj_timeline (multi-wait-available-submitted-signaled)
[659.085721] Starting subtest: multi-wait-available-submitted-signaled
[659.088694] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.000s)
[659.225952] [118/131] (363s left) kms_flip (2x-flip-vs-modeset)
[659.325898] Starting subtest: 2x-flip-vs-modeset
[659.333856] Subtest 2x-flip-vs-modeset: SKIP (0.010s)
[659.471983] [119/131] (363s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[659.564513] Starting subtest: compare-crc-sanitycheck-xr24
[659.567225] Starting dynamic subtest: pipe-A-eDP-1
[660.181532] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.615s)
[660.193680] Starting dynamic subtest: pipe-B-eDP-1
[661.441618] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.259s)
[661.456478] Starting dynamic subtest: pipe-C-eDP-1
[662.623834] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.181s)
[662.635745] Starting dynamic subtest: pipe-D-eDP-1
[663.864113] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.239s)
[663.866710] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.299s)
[664.746159] [120/131] (358s left) gem_exec_reloc (basic-gtt-cpu)
[664.814696] Subtest basic-gtt-cpu: SKIP (0.000s)
[664.900917] [121/131] (358s left) gem_exec_reloc (basic-active)
[664.962296] Subtest basic-active: SKIP (0.000s)
[665.027847] [122/131] (358s left) gem_pread (exhaustion)
[665.097646] Subtest exhaustion: SKIP (0.000s)
[665.174615] [123/131] (357s left) gem_userptr_blits (unsync-unmap)
[665.258621] Subtest unsync-unmap: SKIP (0.000s)
[665.419414] [124/131] (357s left) i915_hangman (engine-engine-error)
[665.488626] Starting subtest: engine-engine-error
[665.490966] Starting dynamic subtest: rcs0
[667.080067] Dynamic subtest rcs0: SUCCESS (1.589s)
[667.094152] Starting dynamic subtest: bcs0
[669.063314] Dynamic subtest bcs0: SUCCESS (1.981s)
[669.078282] Starting dynamic subtest: vcs0
[671.110359] Dynamic subtest vcs0: SUCCESS (2.044s)
[671.123999] Starting dynamic subtest: vcs1
[673.094618] Dynamic subtest vcs1: SUCCESS (1.982s)
[673.106878] Starting dynamic subtest: vecs0
[675.078965] Dynamic subtest vecs0: SUCCESS (1.983s)
[675.092960] Starting dynamic subtest: ccs0
[677.063132] Dynamic subtest ccs0: SUCCESS (1.981s)
[677.066174] Subtest engine-engine-error: SUCCESS (11.576s)
[677.167290] [125/131] (346s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[682.201363] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[682.206638] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.002s)
[683.063052] [126/131] (340s left) kms_flip (2x-flip-vs-wf_vblank)
[683.168255] Starting subtest: 2x-flip-vs-wf_vblank
[683.179371] Subtest 2x-flip-vs-wf_vblank: SKIP (0.010s)
[683.285244] [127/131] (340s left) api_intel_bb (lot-of-buffers)
[683.353618] Starting subtest: lot-of-buffers
[684.341275] Subtest lot-of-buffers: SUCCESS (0.988s)
[684.886477] [128/131] (338s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf)
[689.925646] Starting subtest: pr-overlay-plane-move-continuous-sf
[689.931507] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.003s)
[690.793198] [129/131] (332s left) intel_hwmon (hwmon-read)
[690.852425] Subtest hwmon-read: SKIP (0.000s)
[690.922061] [130/131] (332s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[691.030644] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[691.035850] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[691.162458] [131/131] (332s left) kms_plane_scaling (planes-scaler-unity-scaling)
[691.263842] Starting subtest: planes-scaler-unity-scaling
[691.266522] Starting dynamic subtest: pipe-A
[691.324997] Dynamic subtest pipe-A: SUCCESS (0.064s)
[691.336485] Starting dynamic subtest: pipe-B
[692.490844] Dynamic subtest pipe-B: SUCCESS (1.165s)
[692.502830] Starting dynamic subtest: pipe-C
[693.592297] Dynamic subtest pipe-C: SUCCESS (1.100s)
[693.603857] Starting dynamic subtest: pipe-D
[694.715829] Dynamic subtest pipe-D: SUCCESS (1.123s)
[694.718494] Subtest planes-scaler-unity-scaling: SUCCESS (3.457s)
[695.889906] 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.