[53.463343] Initializing watchdogs
[53.463385]   /dev/watchdog0
[53.477223] [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]
[53.481303] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[53.483421] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[53.486794] [001/133] (960s left) kms_big_fb (x-tiled-64bpp-rotate-0)
[53.606059] Starting subtest: x-tiled-64bpp-rotate-0
[55.238934] Subtest x-tiled-64bpp-rotate-0: SUCCESS (1.636s)
[55.404668] [002/133] (958s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[55.488748] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[55.491132] Starting dynamic subtest: pipe-A
[55.714936] Dynamic subtest pipe-A: SUCCESS (0.229s)
[55.723275] Starting dynamic subtest: pipe-B
[57.036648] Dynamic subtest pipe-B: SUCCESS (1.322s)
[57.044847] Starting dynamic subtest: pipe-C
[58.368211] Dynamic subtest pipe-C: SUCCESS (1.333s)
[58.377091] Starting dynamic subtest: pipe-D
[59.699590] Dynamic subtest pipe-D: SUCCESS (1.332s)
[59.702033] Subtest plane-scaler-with-clipping-clamping-rotation: SUCCESS (4.218s)
[60.880320] [003/133] (953s left) gem_render_copy_redux (flink)
[60.950768] Starting subtest: flink
[61.661913] Subtest flink: SUCCESS (0.712s)
[61.787026] [004/133] (952s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt)
[61.894438] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt
[68.829779] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.941s)
[68.961367] [005/133] (945s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-render)
[69.059497] Starting subtest: fbcpsr-rgb565-draw-render
[76.141342] Subtest fbcpsr-rgb565-draw-render: SUCCESS (7.090s)
[76.284650] [006/133] (937s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-pwrite)
[76.379715] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-pwrite
[76.384072] Subtest fbc-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[76.490066] [007/133] (937s left) sw_sync (alloc_fence)
[76.530996] Starting subtest: alloc_fence
[76.533265] Subtest alloc_fence: SUCCESS (0.000s)
[76.576154] [008/133] (937s left) template (a)
[76.624781] Starting subtest: A
[76.626977] Subtest A: SUCCESS (0.000s)
[76.723908] [009/133] (937s left) kms_addfb_basic (bad-pitch-0)
[76.779991] Starting subtest: bad-pitch-0
[76.782416] Subtest bad-pitch-0: SUCCESS (0.000s)
[76.917239] [010/133] (937s left) gem_exec_reloc (basic-cpu-gtt-active)
[76.974393] Subtest basic-cpu-gtt-active: SKIP (0.000s)
[77.034887] [011/133] (937s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[77.124653] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip
[78.114296] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (0.989s)
[78.252985] [012/133] (936s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[78.313870] Starting subtest: single-wait-for-submit-available-signaled
[78.315876] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s)
[78.396785] [013/133] (936s left) kms_psr (pr-primary-mmap-cpu)
[78.486450] Starting subtest: pr-primary-mmap-cpu
[78.489829] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[78.552573] [014/133] (935s left) gem_exec_balancer (bonded-sync)
[78.609647] Starting subtest: bonded-sync
[78.613147] Subtest bonded-sync: SKIP (0.000s)
[78.910887] [015/133] (935s left) kms_chamelium_edid (dp-edid-resolution-list)
[79.299716] Subtest dp-edid-resolution-list: SKIP (0.000s)
[80.141442] [016/133] (934s left) kms_color (deep-color)
[80.238220] Starting subtest: deep-color
[81.343462] Starting dynamic subtest: pipe-A-eDP-1-gamma
[82.071506] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.728s)
[82.080108] Starting dynamic subtest: pipe-A-eDP-1-degamma
[83.520567] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.451s)
[83.529532] Starting dynamic subtest: pipe-A-eDP-1-ctm
[84.935123] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.411s)
[85.734770] Starting dynamic subtest: pipe-B-eDP-1-gamma
[86.422326] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.693s)
[86.431618] Starting dynamic subtest: pipe-B-eDP-1-degamma
[87.863457] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.441s)
[87.871848] Starting dynamic subtest: pipe-B-eDP-1-ctm
[89.291282] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.426s)
[90.044844] Starting dynamic subtest: pipe-C-eDP-1-gamma
[90.737539] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.697s)
[90.746222] Starting dynamic subtest: pipe-C-eDP-1-degamma
[92.118073] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.380s)
[92.126359] Starting dynamic subtest: pipe-C-eDP-1-ctm
[93.514787] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.397s)
[94.344987] Starting dynamic subtest: pipe-D-eDP-1-gamma
[95.044894] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.704s)
[95.055572] Starting dynamic subtest: pipe-D-eDP-1-degamma
[96.501273] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.457s)
[96.508629] Starting dynamic subtest: pipe-D-eDP-1-ctm
[97.950212] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.448s)
[97.952512] Subtest deep-color: SUCCESS (17.716s)
[98.806506] [017/133] (915s left) gem_exec_create (basic)
[98.862571] Starting subtest: basic
[98.864762] Starting dynamic subtest: smem
[102.934398] Dynamic subtest smem: SUCCESS (4.070s)
[102.937382] Subtest basic: SUCCESS (4.072s)
[103.126953] [018/133] (911s left) gem_exec_reloc (basic-range)
[103.186108] Subtest basic-range: SKIP (0.000s)
[103.255202] [019/133] (911s left) gen7_exec_parse (basic-offset)
[103.325412] Subtest basic-offset: SKIP (0.000s)
[103.395221] [020/133] (911s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-fully-sf)
[103.498872] Starting subtest: pr-overlay-plane-move-continuous-exceed-fully-sf
[103.503183] Subtest pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[103.580158] [021/133] (911s left) api_intel_bb (reset-bb)
[103.635228] Starting subtest: reset-bb
[103.637586] Subtest reset-bb: SUCCESS (0.003s)
[103.741300] [022/133] (911s left) kms_big_fb (y-tiled-16bpp-rotate-180)
[103.840205] Starting subtest: y-tiled-16bpp-rotate-180
[103.844216] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s)
[103.936286] [023/133] (910s left) kms_big_fb (4-tiled-32bpp-rotate-270)
[104.029982] Starting subtest: 4-tiled-32bpp-rotate-270
[104.048802] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.018s)
[104.155436] [024/133] (910s left) kms_dsc (dsc-with-formats)
[104.268410] Starting subtest: dsc-with-formats
[104.301489] Subtest dsc-with-formats: SKIP (0.001s)
[104.337482] [025/133] (910s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[104.450109] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[104.454028] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[104.602328] [026/133] (910s left) kms_flip (nonexisting-fb)
[104.701980] Starting subtest: nonexisting-fb
[104.703674] Starting dynamic subtest: A-eDP1
[105.867096] Dynamic subtest A-eDP1: SUCCESS (1.166s)
[105.875969] Starting dynamic subtest: B-eDP1
[107.007513] Dynamic subtest B-eDP1: SUCCESS (1.138s)
[107.015968] Starting dynamic subtest: C-eDP1
[108.135573] Dynamic subtest C-eDP1: SUCCESS (1.127s)
[108.144681] Starting dynamic subtest: D-eDP1
[109.265934] Dynamic subtest D-eDP1: SUCCESS (1.130s)
[109.271045] Subtest nonexisting-fb: SUCCESS (4.569s)
[110.466667] [027/133] (904s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions)
[110.583537] Starting subtest: cursorB-vs-flipB-atomic-transitions
[110.587964] Subtest cursorB-vs-flipB-atomic-transitions: SKIP (0.001s)
[110.729910] [028/133] (904s left) kms_fbcon_fbt (psr-suspend)
[110.786960] Starting subtest: psr-suspend
[160.155696] Subtest psr-suspend: SUCCESS (19.713s)
[160.195786] [029/133] (854s left) kms_prop_blob (blob-prop-core)
[160.265883] Starting subtest: blob-prop-core
[160.268242] Subtest blob-prop-core: SUCCESS (0.000s)
[160.357646] [030/133] (854s left) gem_ctx_sseu (invalid-args)
[160.422814] Subtest invalid-args: SKIP (0.000s)
[160.522934] [031/133] (854s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping)
[160.626457] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping
[160.654389] Starting dynamic subtest: pipe-A-plane-0
[161.094467] Dynamic subtest pipe-A-plane-0: SUCCESS (0.444s)
[161.102435] Starting dynamic subtest: pipe-A-plane-3
[161.348721] Dynamic subtest pipe-A-plane-3: SUCCESS (0.254s)
[162.441492] Starting dynamic subtest: pipe-B-plane-0
[162.866817] Dynamic subtest pipe-B-plane-0: SUCCESS (0.433s)
[162.877923] Starting dynamic subtest: pipe-B-plane-3
[163.132784] Dynamic subtest pipe-B-plane-3: SUCCESS (0.266s)
[163.442744] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping: SUCCESS (2.823s)
[164.317242] [032/133] (850s left) prime_vgem (basic-blt)
[164.457407] Starting subtest: basic-blt
[164.482836] Subtest basic-blt: SUCCESS (0.026s)
[164.598733] [FACT prime_vgem (basic-blt)] new: kernel.kmod_is_loaded.vgem: true
[164.601813] [033/133] (850s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[164.689088] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[164.693395] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[164.790267] [034/133] (850s left) syncobj_timeline (32bits-limit)
[164.844324] Starting subtest: 32bits-limit
[164.846711] Subtest 32bits-limit: SUCCESS (0.001s)
[164.936651] [035/133] (850s left) gem_userptr_blits (map-fixed-invalidate)
[164.997838] Starting subtest: map-fixed-invalidate
[165.002344] Subtest map-fixed-invalidate: SKIP (0.000s)
[165.121717] [036/133] (850s left) kms_pm_rpm (cursor)
[166.765877] Starting subtest: cursor
[166.770891] Subtest cursor: SKIP (0.000s)
[167.443934] [037/133] (848s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt)
[167.543998] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt
[167.548205] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[167.622549] [038/133] (847s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[167.716994] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt
[167.720940] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[167.805515] [039/133] (847s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-mc-ccs)
[167.894542] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-mc-ccs
[167.896771] Starting dynamic subtest: pipe-A-eDP-1
[167.918310] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[167.927217] Starting dynamic subtest: pipe-B-eDP-1
[167.946916] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[167.954418] Starting dynamic subtest: pipe-C-eDP-1
[167.974890] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[167.982384] Starting dynamic subtest: pipe-D-eDP-1
[168.002914] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[168.006943] Subtest crc-primary-rotation-180-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[170.190214] [040/133] (845s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[170.321257] Starting subtest: cursorA-vs-flipB-atomic-transitions
[170.325640] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.001s)
[170.464244] [041/133] (845s left) api_intel_allocator (fork-simple-once)
[170.522656] Starting subtest: fork-simple-once
[170.534168] Subtest fork-simple-once: SUCCESS (0.014s)
[170.652919] [042/133] (844s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[170.755106] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[178.056219] Subtest psr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.310s)
[178.171099] [043/133] (837s left) syncobj_timeline (invalid-single-wait-unsubmitted)
[178.228476] Starting subtest: invalid-single-wait-unsubmitted
[178.230471] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[178.324696] [044/133] (837s left) gem_exec_gttfill (all-engines)
[178.386624] Starting subtest: all-engines
[201.636734] Subtest all-engines: SUCCESS (23.248s)
[201.828477] [045/133] (813s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-pgflip-blt)
[201.966524] Starting subtest: fbcpsr-1p-primscrn-shrfb-pgflip-blt
[209.247538] Subtest fbcpsr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.283s)
[209.380324] [046/133] (806s left) gen3_render_tiledx_blits
[209.497478] [047/133] (806s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[209.599409] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[209.601604] Starting dynamic subtest: pipe-A-eDP-1
[209.621340] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[209.629699] Starting dynamic subtest: pipe-B-eDP-1
[209.648547] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[209.656750] Starting dynamic subtest: pipe-C-eDP-1
[209.675459] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[209.683641] Starting dynamic subtest: pipe-D-eDP-1
[209.701999] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[209.704018] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.007s)
[211.805483] [048/133] (804s left) gem_mmap_wc (bad-offset)
[211.864078] Subtest bad-offset: SKIP (0.000s)
[211.920715] [049/133] (804s left) sw_sync (sync_merge_invalid)
[211.969795] Starting subtest: sync_merge_invalid
[211.988852] Subtest sync_merge_invalid: SUCCESS (0.021s)
[212.062880] [050/133] (803s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[212.166238] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu
[212.170598] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[212.280464] [051/133] (803s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling)
[212.361624] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-downscaling
[212.365944] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.000s)
[212.433218] [052/133] (803s left) gem_mmap_gtt (basic-write)
[212.498607] Subtest basic-write: SKIP (0.000s)
[212.554108] [053/133] (803s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt)
[212.652842] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt
[212.656992] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[212.746660] [054/133] (803s left) syncobj_timeline (multi-wait-for-submit-signaled)
[212.794352] Starting subtest: multi-wait-for-submit-signaled
[212.796173] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s)
[212.887037] [055/133] (803s left) kms_sequence (get-forked)
[212.986279] Starting subtest: get-forked
[212.987866] Starting dynamic subtest: pipe-A-eDP-1
[214.872766] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.887s)
[214.882547] Starting dynamic subtest: pipe-B-eDP-1
[217.455604] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.579s)
[217.464341] Starting dynamic subtest: pipe-C-eDP-1
[219.965109] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.510s)
[219.974536] Starting dynamic subtest: pipe-D-eDP-1
[222.515009] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.546s)
[222.516960] Subtest get-forked: SUCCESS (9.529s)
[223.339428] [056/133] (792s left) gem_workarounds (reset-fd)
[223.418729] Starting subtest: reset-fd
[223.591307] Subtest reset-fd: SUCCESS (0.172s)
[223.704714] [057/133] (792s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-plflip-blt)
[223.796047] Starting subtest: fbcpsr-2p-scndscrn-indfb-plflip-blt
[223.800491] Subtest fbcpsr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[223.921277] [058/133] (792s left) gem_mmap_wc (read-write-distinct)
[223.982026] Subtest read-write-distinct: SKIP (0.000s)
[224.059404] [059/133] (792s left) kms_chamelium_color (ctm-max)
[224.162089] Subtest ctm-max: SKIP (0.000s)
[224.208220] [060/133] (792s left) kms_async_flips (basic-modeset-with-all-modifiers-formats)
[224.297885] Starting subtest: basic-modeset-with-all-modifiers-formats
[224.670161] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB8888
[225.408080] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB8888: SUCCESS (0.739s)
[225.419217] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB2101010
[225.429684] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB2101010: SUCCESS (0.021s)
[225.438206] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB16161616F
[225.451901] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB16161616F: SUCCESS (0.022s)
[225.466167] Starting dynamic subtest: pipe-A-eDP-1-4-RGB565
[225.596569] Dynamic subtest pipe-A-eDP-1-4-RGB565: SUCCESS (0.144s)
[225.607224] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB8888
[225.618502] Dynamic subtest pipe-A-eDP-1-4-XRGB8888: SUCCESS (0.021s)
[225.627405] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB2101010
[225.640692] Dynamic subtest pipe-A-eDP-1-4-XRGB2101010: SUCCESS (0.022s)
[225.649143] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB16161616F
[225.662955] Dynamic subtest pipe-A-eDP-1-4-XRGB16161616F: SUCCESS (0.022s)
[225.670935] Starting dynamic subtest: pipe-A-eDP-1-4-YUYV
[225.685084] Dynamic subtest pipe-A-eDP-1-4-YUYV: SUCCESS (0.021s)
[225.693923] Starting dynamic subtest: pipe-A-eDP-1-4-Y210
[225.707333] Dynamic subtest pipe-A-eDP-1-4-Y210: SUCCESS (0.021s)
[225.715399] Starting dynamic subtest: pipe-A-eDP-1-4-XYUV8888
[225.732384] Dynamic subtest pipe-A-eDP-1-4-XYUV8888: SUCCESS (0.021s)
[225.740293] Starting dynamic subtest: pipe-A-eDP-1-4-XV30
[225.752726] Dynamic subtest pipe-A-eDP-1-4-XV30: SUCCESS (0.022s)
[225.760720] Starting dynamic subtest: pipe-A-eDP-1-4-XV36
[225.776035] Dynamic subtest pipe-A-eDP-1-4-XV36: SUCCESS (0.022s)
[225.784108] Starting dynamic subtest: pipe-A-eDP-1-x-RGB565
[225.929687] Dynamic subtest pipe-A-eDP-1-x-RGB565: SUCCESS (0.155s)
[225.939345] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB8888
[225.951877] Dynamic subtest pipe-A-eDP-1-x-XRGB8888: SUCCESS (0.021s)
[225.960281] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB2101010
[225.974072] Dynamic subtest pipe-A-eDP-1-x-XRGB2101010: SUCCESS (0.022s)
[225.982460] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB16161616F
[225.996242] Dynamic subtest pipe-A-eDP-1-x-XRGB16161616F: SUCCESS (0.021s)
[226.004978] Starting dynamic subtest: pipe-A-eDP-1-x-YUYV
[226.018484] Dynamic subtest pipe-A-eDP-1-x-YUYV: SUCCESS (0.022s)
[226.027142] Starting dynamic subtest: pipe-A-eDP-1-x-Y210
[226.040724] Dynamic subtest pipe-A-eDP-1-x-Y210: SUCCESS (0.022s)
[226.049338] Starting dynamic subtest: pipe-A-eDP-1-x-XYUV8888
[226.062914] Dynamic subtest pipe-A-eDP-1-x-XYUV8888: SUCCESS (0.021s)
[226.071493] Starting dynamic subtest: pipe-A-eDP-1-x-XV30
[226.085093] Dynamic subtest pipe-A-eDP-1-x-XV30: SUCCESS (0.022s)
[226.093915] Starting dynamic subtest: pipe-A-eDP-1-x-XV36
[226.107015] Dynamic subtest pipe-A-eDP-1-x-XV36: SUCCESS (0.022s)
[226.115569] Starting dynamic subtest: pipe-A-eDP-1-linear-RGB565
[226.274363] Dynamic subtest pipe-A-eDP-1-linear-RGB565: SUCCESS (0.166s)
[226.284822] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB8888
[226.296845] Dynamic subtest pipe-A-eDP-1-linear-XRGB8888: SUCCESS (0.022s)
[226.305492] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB2101010
[226.318530] Dynamic subtest pipe-A-eDP-1-linear-XRGB2101010: SUCCESS (0.021s)
[226.327494] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB16161616F
[226.340993] Dynamic subtest pipe-A-eDP-1-linear-XRGB16161616F: SUCCESS (0.022s)
[226.349960] Starting dynamic subtest: pipe-A-eDP-1-linear-YUYV
[226.362904] Dynamic subtest pipe-A-eDP-1-linear-YUYV: SUCCESS (0.021s)
[226.372093] Starting dynamic subtest: pipe-A-eDP-1-linear-Y210
[226.385181] Dynamic subtest pipe-A-eDP-1-linear-Y210: SUCCESS (0.022s)
[226.394914] Starting dynamic subtest: pipe-A-eDP-1-linear-XYUV8888
[226.407342] Dynamic subtest pipe-A-eDP-1-linear-XYUV8888: SUCCESS (0.022s)
[226.415439] Starting dynamic subtest: pipe-A-eDP-1-linear-XV30
[226.430099] Dynamic subtest pipe-A-eDP-1-linear-XV30: SUCCESS (0.022s)
[226.441269] Starting dynamic subtest: pipe-A-eDP-1-linear-XV36
[226.451747] Dynamic subtest pipe-A-eDP-1-linear-XV36: SUCCESS (0.021s)
[226.841693] Subtest basic-modeset-with-all-modifiers-formats: SUCCESS (2.545s)
[227.687247] [061/133] (788s left) kms_pm_rpm (modeset-non-lpsp)
[229.650371] Starting subtest: modeset-non-lpsp
[230.806394] Subtest modeset-non-lpsp: SKIP (1.153s)
[231.175913] [062/133] (785s left) gem_ctx_exec (basic-norecovery)
[231.239487] Starting subtest: basic-norecovery
[231.568806] Subtest basic-norecovery: SUCCESS (0.330s)
[231.697881] [063/133] (784s left) kms_psr (fbc-pr-cursor-mmap-cpu)
[231.799935] Starting subtest: fbc-pr-cursor-mmap-cpu
[231.804120] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s)
[231.888274] [064/133] (784s left) kms_cursor_crc (cursor-dpms)
[232.025437] Starting subtest: cursor-dpms
[232.027738] Starting dynamic subtest: pipe-A-eDP-1
[235.026153] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.998s)
[235.034961] Starting dynamic subtest: pipe-D-eDP-1
[238.620356] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.594s)
[238.622266] Subtest cursor-dpms: SUCCESS (6.595s)
[239.459016] [065/133] (777s left) i915_pm_rc6_residency (media-rc6-accuracy)
[239.526553] Starting subtest: media-rc6-accuracy
[239.531139] Subtest media-rc6-accuracy: SKIP (0.000s)
[239.637266] [066/133] (777s left) gem_wait (write-busy)
[239.709822] Starting subtest: write-busy
[239.712243] Starting dynamic subtest: all-engines
[240.338344] Dynamic subtest all-engines: SUCCESS (0.628s)
[240.354760] Starting dynamic subtest: rcs0
[240.895507] Dynamic subtest rcs0: SUCCESS (0.556s)
[240.910897] Starting dynamic subtest: bcs0
[241.446081] Dynamic subtest bcs0: SUCCESS (0.550s)
[241.461648] Starting dynamic subtest: vcs0
[242.533192] Dynamic subtest vcs0: SUCCESS (1.085s)
[242.549510] Starting dynamic subtest: vcs1
[244.580139] Dynamic subtest vcs1: SUCCESS (2.045s)
[244.595750] Starting dynamic subtest: vecs0
[246.564632] Dynamic subtest vecs0: SUCCESS (1.982s)
[246.577618] Starting dynamic subtest: ccs0
[247.123115] Dynamic subtest ccs0: SUCCESS (0.558s)
[247.125582] Subtest write-busy: SUCCESS (7.416s)
[247.320821] [067/133] (769s left) kms_psr (fbc-psr-sprite-blt)
[247.415879] Starting subtest: fbc-psr-sprite-blt
[247.418206] Starting dynamic subtest: eDP-1
[247.422535] Dynamic subtest eDP-1: SKIP (0.000s)
[247.426941] Subtest fbc-psr-sprite-blt: SKIP (0.001s)
[247.495612] [068/133] (769s left) kms_invalid_mode (bad-vsync-start)
[247.594960] Starting subtest: bad-vsync-start
[247.597305] Starting dynamic subtest: pipe-A-eDP-1
[247.882662] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.289s)
[247.892359] Starting dynamic subtest: pipe-B-eDP-1
[247.894261] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[247.902233] Starting dynamic subtest: pipe-C-eDP-1
[247.904425] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[247.916770] Starting dynamic subtest: pipe-D-eDP-1
[247.919598] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[247.922623] Subtest bad-vsync-start: SUCCESS (0.295s)
[248.687279] [069/133] (768s left) kms_cursor_edge_walk (256x256-top-edge)
[248.777643] Starting subtest: 256x256-top-edge
[248.779991] Starting dynamic subtest: pipe-A-eDP-1
[252.245255] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.466s)
[252.256101] Starting dynamic subtest: pipe-D-eDP-1
[255.371197] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.125s)
[255.373417] Subtest 256x256-top-edge: SUCCESS (6.594s)
[256.188608] [070/133] (760s left) kms_psr (psr-sprite-plane-move)
[256.286996] Starting subtest: psr-sprite-plane-move
[256.289244] Starting dynamic subtest: eDP-1
[258.111119] Dynamic subtest eDP-1: SUCCESS (1.821s)
[258.113273] Subtest psr-sprite-plane-move: SUCCESS (1.822s)
[258.933970] [071/133] (757s left) kms_content_protection (mei-interface)
[259.073891] Starting subtest: mei-interface
[259.078472] Subtest mei-interface: SKIP (0.001s)
[259.180920] [072/133] (757s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[259.275785] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[259.286435] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.010s)
[259.398778] [073/133] (757s left) kms_cursor_crc (cursor-random-32x32)
[259.539696] Starting subtest: cursor-random-32x32
[259.594989] Subtest cursor-random-32x32: SKIP (0.050s)
[259.894966] [074/133] (757s left) gem_ctx_persistence (legacy-engines-persistence)
[259.943096] Starting subtest: legacy-engines-persistence
[259.944665] Starting dynamic subtest: render
[260.694590] Dynamic subtest render: SUCCESS (0.752s)
[260.707192] Starting dynamic subtest: bsd1
[261.481791] Dynamic subtest bsd1: SUCCESS (0.785s)
[261.496297] Starting dynamic subtest: bsd2
[262.219212] Dynamic subtest bsd2: SUCCESS (0.734s)
[262.229710] Starting dynamic subtest: blt
[263.018167] Dynamic subtest blt: SUCCESS (0.796s)
[263.030152] Starting dynamic subtest: vebox
[263.755326] Dynamic subtest vebox: SUCCESS (0.734s)
[263.757878] Subtest legacy-engines-persistence: SUCCESS (3.813s)
[263.884735] [075/133] (753s left) kms_vblank (query-forked-busy-hang)
[263.989681] Starting subtest: query-forked-busy-hang
[263.991900] Starting dynamic subtest: pipe-A-eDP-1
[290.342911] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.350s)
[290.360584] Starting dynamic subtest: pipe-D-eDP-1
[315.303703] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.958s)
[315.305928] Subtest query-forked-busy-hang: SUCCESS (51.312s)
[316.115777] [076/133] (700s left) gem_readwrite (write-bad-handle)
[316.179062] Subtest write-bad-handle: SKIP (0.000s)
[316.245646] [077/133] (700s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-upscaling)
[316.358144] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-upscaling
[316.362346] Subtest flip-64bpp-ytile-to-16bpp-ytile-upscaling: SKIP (0.000s)
[316.431894] [078/133] (700s left) gem_exec_fence (basic-wait)
[316.605510] Starting subtest: basic-wait
[316.607979] Starting dynamic subtest: rcs0
[316.680514] Dynamic subtest rcs0: SUCCESS (0.076s)
[316.691817] Starting dynamic subtest: bcs0
[316.745681] Dynamic subtest bcs0: SUCCESS (0.063s)
[316.757089] Starting dynamic subtest: vcs0
[316.801222] Dynamic subtest vcs0: SUCCESS (0.054s)
[316.813906] Starting dynamic subtest: vcs1
[316.870139] Dynamic subtest vcs1: SUCCESS (0.067s)
[316.880880] Starting dynamic subtest: vecs0
[316.922228] Dynamic subtest vecs0: SUCCESS (0.050s)
[316.933003] Starting dynamic subtest: ccs0
[316.983473] Dynamic subtest ccs0: SUCCESS (0.059s)
[316.985936] Subtest basic-wait: SUCCESS (0.380s)
[318.641138] [079/133] (698s left) gem_create (create-ext-set-pat)
[318.821878] Starting subtest: create-ext-set-pat
[318.824068] Subtest create-ext-set-pat: SUCCESS (0.001s)
[318.927592] [080/133] (698s left) gem_exec_whisper (basic-normal-all)
[318.990821] Starting subtest: basic-normal-all
[324.536037] Subtest basic-normal-all: SUCCESS (5.489s)
[324.673593] [081/133] (692s left) gem_mmap_offset (clear)
[324.742337] Starting subtest: clear
[324.744717] Starting dynamic subtest: smem0
[348.997034] Dynamic subtest smem0: SUCCESS (24.255s)
[348.999386] Subtest clear: SUCCESS (24.257s)
[349.127601] [082/133] (668s left) kms_cursor_legacy (short-busy-flip-before-cursor-toggle)
[349.299350] Starting subtest: short-busy-flip-before-cursor-toggle
[349.303919] Subtest short-busy-flip-before-cursor-toggle: SKIP (0.000s)
[349.458204] [083/133] (667s left) gem_exec_fence (syncobj-invalid-wait)
[349.887602] Starting subtest: syncobj-invalid-wait
[349.890117] Subtest syncobj-invalid-wait: SUCCESS (0.001s)
[351.609276] [084/133] (665s left) i915_drm_fdinfo (virtual-busy-hang-all)
[351.657743] Starting subtest: virtual-busy-hang-all
[351.662403] Subtest virtual-busy-hang-all: SKIP (0.000s)
[351.731658] [085/133] (665s left) kms_frontbuffer_tracking (fbc-suspend)
[351.835207] Starting subtest: fbc-suspend
[389.603548] Subtest fbc-suspend: SUCCESS (7.466s)
[390.791742] [086/133] (626s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-msflip-blt)
[390.884543] Starting subtest: psr-2p-scndscrn-indfb-msflip-blt
[390.888855] Subtest psr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[390.975257] [087/133] (626s left) gem_pxp (verify-pxp-stale-ctx-execution)
[391.091416] Starting subtest: verify-pxp-stale-ctx-execution
[392.147115] Subtest verify-pxp-stale-ctx-execution: SUCCESS (1.061s)
[392.269874] [088/133] (625s left) syncobj_wait (reset-during-wait-for-submit)
[392.331250] Starting subtest: reset-during-wait-for-submit
[392.432257] Subtest reset-during-wait-for-submit: SUCCESS (0.103s)
[392.524364] [089/133] (625s left) kms_atomic (plane-immutable-zpos)
[392.619576] Starting subtest: plane-immutable-zpos
[392.621697] Starting dynamic subtest: pipe-A-eDP-1
[393.281187] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.663s)
[393.283495] Subtest plane-immutable-zpos: SUCCESS (0.665s)
[394.097322] [090/133] (623s left) kms_addfb_basic (bad-pitch-32)
[394.158085] Starting subtest: bad-pitch-32
[394.160409] Subtest bad-pitch-32: SUCCESS (0.000s)
[394.300122] [091/133] (623s left) i915_selftest (mock)
[398.813517] Starting subtest: mock
[398.817595] Starting dynamic subtest: sanitycheck
[399.476199] Dynamic subtest sanitycheck: SUCCESS (0.668s)
[399.486702] Starting dynamic subtest: shmem
[400.126119] Dynamic subtest shmem: SUCCESS (0.648s)
[400.136258] Starting dynamic subtest: fence
[408.028350] Dynamic subtest fence: SUCCESS (7.906s)
[408.038516] Starting dynamic subtest: scatterlist
[409.687883] Dynamic subtest scatterlist: SUCCESS (1.659s)
[409.698898] Starting dynamic subtest: syncmap
[412.959613] Dynamic subtest syncmap: SUCCESS (3.271s)
[412.969618] Starting dynamic subtest: uncore
[413.596032] Dynamic subtest uncore: SUCCESS (0.635s)
[413.606005] Starting dynamic subtest: ring
[414.228942] Dynamic subtest ring: SUCCESS (0.631s)
[414.239003] Starting dynamic subtest: engine
[414.862021] Dynamic subtest engine: SUCCESS (0.631s)
[414.874576] Starting dynamic subtest: timelines
[418.567532] Dynamic subtest timelines: SUCCESS (3.704s)
[418.577673] Starting dynamic subtest: requests
[422.414131] Dynamic subtest requests: SUCCESS (3.843s)
[422.423512] Starting dynamic subtest: objects
[423.184635] Dynamic subtest objects: SUCCESS (0.770s)
[423.194458] Starting dynamic subtest: phys
[423.950378] Dynamic subtest phys: SUCCESS (0.763s)
[423.965569] Starting dynamic subtest: dmabuf
[424.707062] Dynamic subtest dmabuf: SUCCESS (0.755s)
[424.716862] Starting dynamic subtest: vma
[430.364758] Dynamic subtest vma: SUCCESS (5.655s)
[430.374363] Starting dynamic subtest: evict
[431.720893] Dynamic subtest evict: SUCCESS (1.355s)
[431.736568] Starting dynamic subtest: gtt
[434.970559] Dynamic subtest gtt: SUCCESS (3.248s)
[434.980678] Starting dynamic subtest: hugepages
[435.826509] Dynamic subtest hugepages: SUCCESS (0.855s)
[435.836611] Starting dynamic subtest: memory_region
[438.382982] Dynamic subtest memory_region: SUCCESS (2.555s)
[438.385944] Subtest mock: SUCCESS (39.585s)
[438.414426] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[438.415121] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[438.418229] [092/133] (579s left) kms_pipe_crc_basic (hang-read-crc)
[439.973217] Starting subtest: hang-read-crc
[439.975101] Starting dynamic subtest: pipe-A-eDP-1
[442.088382] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.114s)
[442.097842] Starting dynamic subtest: pipe-B-eDP-1
[444.975450] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.887s)
[444.987572] Starting dynamic subtest: pipe-C-eDP-1
[447.657258] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.681s)
[447.669161] Starting dynamic subtest: pipe-D-eDP-1
[450.303110] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.645s)
[450.305430] Subtest hang-read-crc: SUCCESS (10.333s)
[451.192524] [FACT kms_pipe_crc_basic (hang-read-crc)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[451.194063] [FACT kms_pipe_crc_basic (hang-read-crc)] new: kernel.kmod_is_loaded.i915: true
[451.198192] [093/133] (566s left) gem_mmap (bad-object)
[451.261677] Subtest bad-object: SKIP (0.000s)
[451.325334] [094/133] (566s left) kms_psr (psr2-sprite-blt)
[451.427140] Starting subtest: psr2-sprite-blt
[451.429467] Starting dynamic subtest: eDP-1
[453.152580] Dynamic subtest eDP-1: SUCCESS (1.727s)
[453.154976] Subtest psr2-sprite-blt: SUCCESS (1.727s)
[454.023995] [095/133] (563s left) kms_plane_lowres (tiling-y)
[454.121804] Starting subtest: tiling-y
[454.126124] Subtest tiling-y: SKIP (0.000s)
[454.192880] [096/133] (563s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[454.296881] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[454.301145] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.000s)
[454.365079] [097/133] (563s left) gem_exec_flush (basic-wb-rw-default)
[454.436341] Starting subtest: basic-wb-rw-default
[459.917096] Subtest basic-wb-rw-default: SUCCESS (5.455s)
[460.078123] [098/133] (557s left) kms_lease (lease-invalid-connector)
[460.178861] Starting subtest: lease-invalid-connector
[460.181185] Starting dynamic subtest: pipe-A-eDP-1
[460.183401] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[460.192614] Starting dynamic subtest: pipe-B-eDP-1
[460.194984] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[460.204010] Starting dynamic subtest: pipe-C-eDP-1
[460.206191] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[460.214750] Starting dynamic subtest: pipe-D-eDP-1
[460.216647] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[460.218537] Subtest lease-invalid-connector: SUCCESS (0.004s)
[460.258199] [099/133] (557s left) gem_softpin (zero)
[460.319328] Starting subtest: zero
[460.326192] Subtest zero: SUCCESS (0.005s)
[460.455390] [100/133] (557s left) kms_ccs (crc-primary-basic-y-tiled-gen12-mc-ccs)
[460.560704] Starting subtest: crc-primary-basic-y-tiled-gen12-mc-ccs
[460.562828] Starting dynamic subtest: pipe-A-eDP-1
[460.585613] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[460.596300] Starting dynamic subtest: pipe-B-eDP-1
[460.617805] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[460.626870] Starting dynamic subtest: pipe-C-eDP-1
[460.648148] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[460.659551] Starting dynamic subtest: pipe-D-eDP-1
[460.681270] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[460.685336] Subtest crc-primary-basic-y-tiled-gen12-mc-ccs: SKIP (0.006s)
[462.799333] [101/133] (555s left) i915_drm_fdinfo (memory-info-shared)
[462.846802] Starting subtest: memory-info-shared
[462.848802] Starting dynamic subtest: smem0
[462.890334] Dynamic subtest smem0: SUCCESS (0.046s)
[462.893049] Subtest memory-info-shared: SUCCESS (0.047s)
[462.965335] [102/133] (555s left) dmabuf (all-tests)
[463.003237] Starting subtest: all-tests
[463.005188] Starting dynamic subtest: sanitycheck
[463.088280] Dynamic subtest sanitycheck: SUCCESS (0.087s)
[463.101641] Starting dynamic subtest: dma_fence
[463.285281] Dynamic subtest dma_fence: SUCCESS (0.195s)
[463.298429] Starting dynamic subtest: dma_fence_chain
[472.511420] Dynamic subtest dma_fence_chain: SUCCESS (9.226s)
[472.524295] Starting dynamic subtest: dma_fence_unwrap
[472.600480] Dynamic subtest dma_fence_unwrap: SUCCESS (0.087s)
[472.616124] Starting dynamic subtest: dma_resv
[472.684375] Dynamic subtest dma_resv: SUCCESS (0.081s)
[472.686904] Subtest all-tests: SUCCESS (9.688s)
[472.750176] [103/133] (545s left) kms_psr (fbc-pr-suspend)
[472.842709] Starting subtest: fbc-pr-suspend
[472.847070] Subtest fbc-pr-suspend: SKIP (0.000s)
[472.914558] [104/133] (545s left) perf_pmu (busy-check-all)
[472.956548] Starting subtest: busy-check-all
[472.958772] Starting dynamic subtest: rcs0
[473.513557] Dynamic subtest rcs0: SUCCESS (0.559s)
[473.525733] Starting dynamic subtest: bcs0
[474.063695] Dynamic subtest bcs0: SUCCESS (0.548s)
[474.075680] Starting dynamic subtest: vcs0
[475.859234] Dynamic subtest vcs0: SUCCESS (1.792s)
[475.877191] Starting dynamic subtest: vcs1
[477.841959] Dynamic subtest vcs1: SUCCESS (1.980s)
[477.853880] Starting dynamic subtest: vecs0
[479.891296] Dynamic subtest vecs0: SUCCESS (2.047s)
[479.904996] Starting dynamic subtest: ccs0
[480.445985] Dynamic subtest ccs0: SUCCESS (0.554s)
[480.448476] Subtest busy-check-all: SUCCESS (7.495s)
[480.569064] [105/133] (537s left) kms_tv_load_detect (load-detect)
[480.624652] Subtest load-detect: SKIP (0.000s)
[480.696442] [106/133] (537s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted)
[480.757326] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted
[480.862483] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.104s)
[480.937752] [107/133] (537s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[481.052323] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[481.056435] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[481.149807] [108/133] (537s left) gem_exec_whisper (basic-queues-priority-all)
[481.216213] Starting subtest: basic-queues-priority-all
[505.153697] Subtest basic-queues-priority-all: SUCCESS (23.878s)
[505.281251] [109/133] (513s left) kms_atomic_transition (plane-all-modeset-transition-fencing)
[505.380118] Starting subtest: plane-all-modeset-transition-fencing
[505.384296] Subtest plane-all-modeset-transition-fencing: SKIP (0.000s)
[505.449804] [110/133] (513s left) gem_exec_reloc (basic-cpu-wc-active)
[505.503514] Subtest basic-cpu-wc-active: SKIP (0.000s)
[505.578711] [111/133] (512s left) gem_userptr_blits (dmabuf-sync)
[505.644976] Starting subtest: dmabuf-sync
[505.649361] Subtest dmabuf-sync: SKIP (0.002s)
[505.779921] [112/133] (512s left) gem_exec_schedule (implicit-read-write)
[505.846038] Starting subtest: implicit-read-write
[505.848353] Starting dynamic subtest: rcs0
[505.947116] Dynamic subtest rcs0: SUCCESS (0.112s)
[505.962081] Starting dynamic subtest: vcs0
[506.034087] Dynamic subtest vcs0: SUCCESS (0.086s)
[506.045474] Starting dynamic subtest: vcs1
[506.116885] Dynamic subtest vcs1: SUCCESS (0.082s)
[506.129283] Starting dynamic subtest: vecs0
[506.199320] Dynamic subtest vecs0: SUCCESS (0.082s)
[506.209769] Starting dynamic subtest: ccs0
[506.291954] Dynamic subtest ccs0: SUCCESS (0.092s)
[506.294245] Subtest implicit-read-write: SUCCESS (0.458s)
[507.946056] [113/133] (510s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-move)
[508.049069] Starting subtest: fbc-2p-scndscrn-cur-indfb-move
[508.052994] Subtest fbc-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[508.149544] [114/133] (510s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move)
[508.242507] Starting subtest: fbc-2p-scndscrn-spr-indfb-move
[508.247130] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[508.329587] [115/133] (510s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[508.416300] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[508.418359] Starting dynamic subtest: pipe-A-eDP-1
[508.871219] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.426s)
[508.882380] Starting dynamic subtest: pipe-B-eDP-1
[510.341339] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.469s)
[510.351962] Starting dynamic subtest: pipe-C-eDP-1
[511.726217] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.382s)
[511.737799] Starting dynamic subtest: pipe-D-eDP-1
[513.138957] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.414s)
[513.140753] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SUCCESS (4.696s)
[514.304018] [116/133] (504s left) gem_ccs (ctrl-surf-copy-new-ctx)
[514.360963] Starting subtest: ctrl-surf-copy-new-ctx
[514.365749] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[514.455012] [117/133] (504s left) kms_flip (wf_vblank-ts-check-interruptible)
[514.546553] Starting subtest: wf_vblank-ts-check-interruptible
[514.549482] Starting dynamic subtest: A-eDP1
[523.492296] Dynamic subtest A-eDP1: SUCCESS (8.911s)
[523.504434] Starting dynamic subtest: B-eDP1
[532.411991] Dynamic subtest B-eDP1: SUCCESS (8.918s)
[532.423605] Starting dynamic subtest: C-eDP1
[541.333132] Dynamic subtest C-eDP1: SUCCESS (8.908s)
[541.343082] Starting dynamic subtest: D-eDP1
[550.262956] Dynamic subtest D-eDP1: SUCCESS (8.928s)
[550.265398] Subtest wf_vblank-ts-check-interruptible: SUCCESS (35.677s)
[551.444489] [118/133] (467s left) kms_atomic_transition (plane-toggle-modeset-transition)
[551.539191] Starting subtest: plane-toggle-modeset-transition
[551.541083] Starting dynamic subtest: pipe-A-eDP-1
[564.303224] Dynamic subtest pipe-A-eDP-1: SUCCESS (12.768s)
[564.318761] Starting dynamic subtest: pipe-B-eDP-1
[576.705599] Dynamic subtest pipe-B-eDP-1: SUCCESS (12.401s)
[576.708062] Subtest plane-toggle-modeset-transition: SUCCESS (25.175s)
[577.522673] [119/133] (441s left) gem_mmap_gtt (cpuset-big-copy-odd)
[577.581506] Subtest cpuset-big-copy-odd: SKIP (0.000s)
[577.637548] [120/133] (441s left) kms_frontbuffer_tracking (fbcpsr-stridechange)
[577.733623] Starting subtest: fbcpsr-stridechange
[583.939971] Subtest fbcpsr-stridechange: SUCCESS (6.211s)
[584.070400] [121/133] (434s left) gem_exec_params (secure-non-master)
[584.125615] Starting subtest: secure-non-master
[584.130130] Subtest secure-non-master: SKIP (0.000s)
[584.242304] [122/133] (434s left) gem_mmap_gtt (big-copy)
[584.304035] Subtest big-copy: SKIP (0.000s)
[584.370467] [123/133] (434s left) gem_exec_parallel (fds)
[584.416962] Starting subtest: fds
[584.419091] Starting dynamic subtest: rcs0
[587.412995] Dynamic subtest rcs0: SUCCESS (2.995s)
[587.425662] Starting dynamic subtest: bcs0
[591.144872] Dynamic subtest bcs0: SUCCESS (3.730s)
[591.156002] Starting dynamic subtest: vcs0
[596.962873] Dynamic subtest vcs0: SUCCESS (5.817s)
[596.975698] Starting dynamic subtest: vcs1
[602.926943] Dynamic subtest vcs1: SUCCESS (5.963s)
[602.937677] Starting dynamic subtest: vecs0
[607.161673] Dynamic subtest vecs0: SUCCESS (4.234s)
[607.173963] Starting dynamic subtest: ccs0
[611.600507] Dynamic subtest ccs0: SUCCESS (4.437s)
[611.602987] Subtest fds: SUCCESS (27.190s)
[611.816301] [124/133] (407s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[612.192573] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[613.042131] [125/133] (406s left) kms_plane (plane-position-hole-dpms)
[613.137817] Starting subtest: plane-position-hole-dpms
[613.654521] Starting dynamic subtest: pipe-A-plane-1
[616.077179] Dynamic subtest pipe-A-plane-1: SUCCESS (2.422s)
[616.087645] Starting dynamic subtest: pipe-A-plane-2
[618.516999] Dynamic subtest pipe-A-plane-2: SUCCESS (2.437s)
[618.526908] Starting dynamic subtest: pipe-A-plane-3
[620.890285] Dynamic subtest pipe-A-plane-3: SUCCESS (2.371s)
[620.910900] Starting dynamic subtest: pipe-A-plane-4
[623.164003] Dynamic subtest pipe-A-plane-4: SUCCESS (2.274s)
[623.177817] Starting dynamic subtest: pipe-A-plane-5
[623.194314] Dynamic subtest pipe-A-plane-5: SUCCESS (0.028s)
[624.340952] Starting dynamic subtest: pipe-B-plane-1
[626.690065] Dynamic subtest pipe-B-plane-1: SUCCESS (2.356s)
[626.700149] Starting dynamic subtest: pipe-B-plane-2
[629.036436] Dynamic subtest pipe-B-plane-2: SUCCESS (2.347s)
[629.049213] Starting dynamic subtest: pipe-B-plane-3
[631.377454] Dynamic subtest pipe-B-plane-3: SUCCESS (2.337s)
[631.388578] Starting dynamic subtest: pipe-B-plane-4
[633.737336] Dynamic subtest pipe-B-plane-4: SUCCESS (2.357s)
[633.748715] Starting dynamic subtest: pipe-B-plane-5
[633.762862] Dynamic subtest pipe-B-plane-5: SUCCESS (0.024s)
[633.765107] Subtest plane-position-hole-dpms: SUCCESS (20.618s)
[634.565461] [126/133] (384s left) prime_mmap (test_dup)
[634.618973] Starting subtest: test_dup
[634.621125] Starting dynamic subtest: test_dup-smem
[634.647553] Dynamic subtest test_dup-smem: SUCCESS (0.031s)
[634.650090] Subtest test_dup: SUCCESS (0.032s)
[634.721834] [127/133] (384s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[634.830936] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[635.942737] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.111s)
[636.057178] [128/133] (383s left) perf_pmu (render-node-busy)
[636.122424] Starting subtest: render-node-busy
[636.124296] Starting dynamic subtest: rcs0
[636.699908] Dynamic subtest rcs0: SUCCESS (0.576s)
[636.713069] Starting dynamic subtest: bcs0
[637.256965] Dynamic subtest bcs0: SUCCESS (0.554s)
[637.271689] Starting dynamic subtest: vcs0
[638.866144] Dynamic subtest vcs0: SUCCESS (1.605s)
[638.879463] Starting dynamic subtest: vcs1
[640.850152] Dynamic subtest vcs1: SUCCESS (1.981s)
[640.863115] Starting dynamic subtest: vecs0
[642.898539] Dynamic subtest vecs0: SUCCESS (2.045s)
[642.915668] Starting dynamic subtest: ccs0
[643.459131] Dynamic subtest ccs0: SUCCESS (0.559s)
[643.461878] Subtest render-node-busy: SUCCESS (7.335s)
[643.535583] [129/133] (375s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[643.653245] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip
[643.657733] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[643.776000] [130/133] (375s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[643.849197] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[643.853291] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[644.044497] [131/133] (375s left) gem_exec_schedule (timeslicing)
[644.120443] Starting subtest: timeslicing
[644.122804] Starting dynamic subtest: rcs0
[644.130189] Dynamic subtest rcs0: SUCCESS (0.021s)
[644.141852] Starting dynamic subtest: bcs0
[644.152477] Dynamic subtest bcs0: SUCCESS (0.021s)
[644.163587] Starting dynamic subtest: vcs0
[644.173711] Dynamic subtest vcs0: SUCCESS (0.021s)
[644.183167] Starting dynamic subtest: vcs1
[644.195816] Dynamic subtest vcs1: SUCCESS (0.020s)
[644.205107] Starting dynamic subtest: vecs0
[644.216024] Dynamic subtest vecs0: SUCCESS (0.019s)
[644.225272] Starting dynamic subtest: ccs0
[644.239060] Dynamic subtest ccs0: SUCCESS (0.022s)
[644.241347] Subtest timeslicing: SUCCESS (0.131s)
[645.884568] [132/133] (373s left) sysfs_heartbeat_interval (invalid)
[645.936696] Starting subtest: invalid
[645.939090] Starting dynamic subtest: vecs0
[645.941516] Dynamic subtest vecs0: SUCCESS (0.000s)
[645.952234] Starting dynamic subtest: ccs0
[645.954098] Dynamic subtest ccs0: SUCCESS (0.000s)
[645.963683] Starting dynamic subtest: vcs0
[645.965599] Dynamic subtest vcs0: SUCCESS (0.000s)
[645.975434] Starting dynamic subtest: bcs0
[645.977676] Dynamic subtest bcs0: SUCCESS (0.000s)
[645.987061] Starting dynamic subtest: rcs0
[645.989209] Dynamic subtest rcs0: SUCCESS (0.000s)
[645.998410] Starting dynamic subtest: vcs1
[646.000529] Dynamic subtest vcs1: SUCCESS (0.000s)
[646.002446] Subtest invalid: SUCCESS (0.005s)
[646.041372] [133/133] (373s left) kms_big_fb (yf-tiled-8bpp-rotate-180)
[646.133774] Starting subtest: yf-tiled-8bpp-rotate-180
[646.138036] Subtest yf-tiled-8bpp-rotate-180: SKIP (0.000s)
[646.230472] Closing watchdogs
results: parsing output: 0/ for test: kms_big_fb
results: parsing output: 1/ for test: kms_plane_scaling
results: parsing output: 2/ for test: gem_render_copy_redux
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: sw_sync
results: parsing output: 7/ for test: template
results: parsing output: 8/ for test: kms_addfb_basic
results: parsing output: 9/ for test: gem_exec_reloc
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: syncobj_timeline
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: gem_exec_balancer
results: parsing output: 14/ for test: kms_chamelium_edid
results: parsing output: 15/ for test: kms_color
results: parsing output: 16/ for test: gem_exec_create
results: parsing output: 17/ for test: gem_exec_reloc
results: parsing output: 18/ for test: gen7_exec_parse
results: parsing output: 19/ for test: kms_psr2_sf
results: parsing output: 20/ for test: api_intel_bb
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: kms_big_fb
results: parsing output: 23/ for test: kms_dsc
results: parsing output: 24/ for test: kms_cursor_legacy
results: parsing output: 25/ for test: kms_flip
results: parsing output: 26/ for test: kms_cursor_legacy
results: parsing output: 27/ for test: kms_fbcon_fbt
results: parsing output: 28/ for test: kms_prop_blob
results: parsing output: 29/ for test: gem_ctx_sseu
results: parsing output: 30/ for test: kms_plane
results: parsing output: 31/ for test: prime_vgem
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: syncobj_timeline
results: parsing output: 34/ for test: gem_userptr_blits
results: parsing output: 35/ for test: kms_pm_rpm
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_ccs
results: parsing output: 39/ for test: kms_cursor_legacy
results: parsing output: 40/ for test: api_intel_allocator
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: syncobj_timeline
results: parsing output: 43/ for test: gem_exec_gttfill
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: gen3_render_tiledx_blits
results: parsing output: 46/ for test: kms_ccs
results: parsing output: 47/ for test: gem_mmap_wc
results: parsing output: 48/ for test: sw_sync
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_flip_scaled_crc
results: parsing output: 51/ for test: gem_mmap_gtt
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: syncobj_timeline
results: parsing output: 54/ for test: kms_sequence
results: parsing output: 55/ for test: gem_workarounds
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: gem_mmap_wc
results: parsing output: 58/ for test: kms_chamelium_color
results: parsing output: 59/ for test: kms_async_flips
results: parsing output: 60/ for test: kms_pm_rpm
results: parsing output: 61/ for test: gem_ctx_exec
results: parsing output: 62/ for test: kms_psr
results: parsing output: 63/ for test: kms_cursor_crc
results: parsing output: 64/ for test: i915_pm_rc6_residency
results: parsing output: 65/ for test: gem_wait
results: parsing output: 66/ for test: kms_psr
results: parsing output: 67/ for test: kms_invalid_mode
results: parsing output: 68/ for test: kms_cursor_edge_walk
results: parsing output: 69/ for test: kms_psr
results: parsing output: 70/ for test: kms_content_protection
results: parsing output: 71/ for test: kms_flip
results: parsing output: 72/ for test: kms_cursor_crc
results: parsing output: 73/ for test: gem_ctx_persistence
results: parsing output: 74/ for test: kms_vblank
results: parsing output: 75/ for test: gem_readwrite
results: parsing output: 76/ for test: kms_flip_scaled_crc
results: parsing output: 77/ for test: gem_exec_fence
results: parsing output: 78/ for test: gem_create
results: parsing output: 79/ for test: gem_exec_whisper
results: parsing output: 80/ for test: gem_mmap_offset
results: parsing output: 81/ for test: kms_cursor_legacy
results: parsing output: 82/ for test: gem_exec_fence
results: parsing output: 83/ for test: i915_drm_fdinfo
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: gem_pxp
results: parsing output: 87/ for test: syncobj_wait
results: parsing output: 88/ for test: kms_atomic
results: parsing output: 89/ for test: kms_addfb_basic
results: parsing output: 90/ for test: i915_selftest
results: parsing output: 91/ for test: kms_pipe_crc_basic
results: parsing output: 92/ for test: gem_mmap
results: parsing output: 93/ for test: kms_psr
results: parsing output: 94/ for test: kms_plane_lowres
results: parsing output: 95/ for test: kms_flip_scaled_crc
results: parsing output: 96/ for test: gem_exec_flush
results: parsing output: 97/ for test: kms_lease
results: parsing output: 98/ for test: gem_softpin
results: parsing output: 99/ for test: kms_ccs
results: parsing output: 100/ for test: i915_drm_fdinfo
results: parsing output: 101/ for test: dmabuf
results: parsing output: 102/ for test: kms_psr
results: parsing output: 103/ for test: perf_pmu
results: parsing output: 104/ for test: kms_tv_load_detect
results: parsing output: 105/ for test: syncobj_timeline
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: gem_exec_whisper
results: parsing output: 108/ for test: kms_atomic_transition
results: parsing output: 109/ for test: gem_exec_reloc
results: parsing output: 110/ for test: gem_userptr_blits
results: parsing output: 111/ for test: gem_exec_schedule
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_ccs
results: parsing output: 115/ for test: gem_ccs
results: parsing output: 116/ for test: kms_flip
results: parsing output: 117/ for test: kms_atomic_transition
results: parsing output: 118/ for test: gem_mmap_gtt
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: gem_exec_params
results: parsing output: 121/ for test: gem_mmap_gtt
results: parsing output: 122/ for test: gem_exec_parallel
results: parsing output: 123/ for test: kms_chamelium_hpd
results: parsing output: 124/ for test: kms_plane
results: parsing output: 125/ for test: prime_mmap
results: parsing output: 126/ for test: kms_big_fb
results: parsing output: 127/ for test: perf_pmu
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: gem_render_copy
results: parsing output: 130/ for test: gem_exec_schedule
results: parsing output: 131/ for test: sysfs_heartbeat_interval
results: parsing output: 132/ for test: kms_big_fb
Done.