[59.538969] Initializing watchdogs
[59.539034]   /dev/watchdog0
[59.554267] [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]
[59.559009] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.561291] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.563320] [001/133] (960s left) kms_cursor_crc (cursor-alpha-opaque)
[59.657694] Starting subtest: cursor-alpha-opaque
[59.658673] Starting dynamic subtest: pipe-A-eDP-1
[60.323973] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.664s)
[60.330053] Starting dynamic subtest: pipe-D-eDP-1
[61.633255] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.307s)
[61.634151] Subtest cursor-alpha-opaque: SUCCESS (1.973s)
[62.513226] [002/133] (957s left) gen7_exec_parse (oacontrol-tracking)
[62.567482] Subtest oacontrol-tracking: SKIP (0.000s)
[62.636484] [003/133] (957s left) kms_lease (simple-lease)
[62.728335] Starting subtest: simple-lease
[62.729277] Starting dynamic subtest: pipe-A-eDP-1
[63.245231] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.516s)
[63.253160] Starting dynamic subtest: pipe-B-eDP-1
[64.660931] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.414s)
[64.667254] Starting dynamic subtest: pipe-C-eDP-1
[66.054134] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.391s)
[66.061245] Starting dynamic subtest: pipe-D-eDP-1
[67.480098] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.424s)
[67.481241] Subtest simple-lease: SUCCESS (4.751s)
[68.285724] [004/133] (951s left) kms_flip (flip-vs-expired-vblank)
[68.369463] Starting subtest: flip-vs-expired-vblank
[68.371643] Starting dynamic subtest: A-eDP1
[77.099759] Dynamic subtest A-eDP1: SUCCESS (8.700s)
[77.107306] Starting dynamic subtest: B-eDP1
[85.717025] Dynamic subtest B-eDP1: SUCCESS (8.639s)
[85.727927] Starting dynamic subtest: C-eDP1
[94.391645] Dynamic subtest C-eDP1: SUCCESS (8.635s)
[94.400475] Starting dynamic subtest: D-eDP1
[102.988611] Dynamic subtest D-eDP1: SUCCESS (8.632s)
[102.993365] Subtest flip-vs-expired-vblank: SUCCESS (34.619s)
[104.148629] [005/133] (916s left) syncobj_wait (invalid-signal-zero-handles)
[104.199498] Starting subtest: invalid-signal-zero-handles
[104.200494] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[104.290146] [006/133] (915s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move)
[104.375057] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move
[104.376708] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[104.463509] [007/133] (915s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-sf)
[104.559663] Starting subtest: fbc-pr-cursor-plane-move-continuous-exceed-sf
[104.561453] Subtest fbc-pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[104.636705] [008/133] (915s left) kms_plane (pixel-format-yf-tiled-ccs-modifier)
[104.718924] Starting subtest: pixel-format-yf-tiled-ccs-modifier
[104.720800] Subtest pixel-format-yf-tiled-ccs-modifier: SKIP (0.000s)
[104.783571] [009/133] (915s left) syncobj_wait (single-wait-all-for-submit-signaled)
[104.840970] Starting subtest: single-wait-all-for-submit-signaled
[104.841981] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.001s)
[104.926901] [010/133] (915s left) kms_atomic_transition (plane-all-transition-nonblocking)
[105.022156] Starting subtest: plane-all-transition-nonblocking
[105.023062] Starting dynamic subtest: pipe-A-eDP-1
[107.517540] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.495s)
[107.831712] Starting dynamic subtest: pipe-B-eDP-1
[111.091149] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.265s)
[111.388514] Subtest plane-all-transition-nonblocking: SUCCESS (6.366s)
[112.216695] [011/133] (908s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[112.332270] Starting subtest: y-tiled-32bpp-rotate-0
[112.334037] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[112.423011] [012/133] (907s left) gem_ctx_param (invalid-set-no-zeromap)
[112.473489] Starting subtest: invalid-set-no-zeromap
[112.474584] Subtest invalid-set-no-zeromap: SUCCESS (0.000s)
[112.534756] [013/133] (907s left) gem_ctx_param (invalid-ctx-set)
[112.595918] Starting subtest: invalid-ctx-set
[112.596931] Subtest invalid-ctx-set: SUCCESS (0.001s)
[112.704023] [014/133] (907s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling)
[112.799342] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling
[112.801053] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.000s)
[112.863664] [015/133] (907s left) kms_draw_crc (draw-method-mmap-wc)
[112.959383] Starting subtest: draw-method-mmap-wc
[112.960396] Starting dynamic subtest: xrgb8888-untiled
[113.192289] Dynamic subtest xrgb8888-untiled: SUCCESS (0.233s)
[113.200112] Starting dynamic subtest: rgb565-untiled
[113.403378] Dynamic subtest rgb565-untiled: SUCCESS (0.210s)
[113.410301] Starting dynamic subtest: xrgb2101010-untiled
[113.614738] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.211s)
[113.621380] Starting dynamic subtest: xbgr16161616f-untiled
[113.837067] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.221s)
[113.843750] Starting dynamic subtest: xrgb8888-xtiled
[113.959043] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.121s)
[113.964965] Starting dynamic subtest: rgb565-xtiled
[114.081295] Dynamic subtest rgb565-xtiled: SUCCESS (0.121s)
[114.087547] Starting dynamic subtest: xrgb2101010-xtiled
[114.203614] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.122s)
[114.209977] Starting dynamic subtest: xbgr16161616f-xtiled
[114.336926] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.133s)
[114.343533] Starting dynamic subtest: xrgb8888-4tiled
[114.503450] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.166s)
[114.509442] Starting dynamic subtest: rgb565-4tiled
[114.659187] Dynamic subtest rgb565-4tiled: SUCCESS (0.155s)
[114.666826] Starting dynamic subtest: xrgb2101010-4tiled
[114.803793] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.144s)
[114.810639] Starting dynamic subtest: xbgr16161616f-4tiled
[114.970199] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.166s)
[114.970996] Subtest draw-method-mmap-wc: SUCCESS (2.011s)
[115.069272] [016/133] (905s left) gem_exec_fence (submit3)
[115.253155] Starting subtest: submit3
[115.258532] Subtest submit3: SKIP (0.000s)
[116.956864] [FACT gem_exec_fence (submit3)] new: kernel.kmod_is_loaded.vgem: true
[116.959112] [017/133] (903s left) gem_ctx_bad_destroy (invalid-pad)
[117.009709] Starting subtest: invalid-pad
[117.010581] Subtest invalid-pad: SUCCESS (0.000s)
[117.089302] [018/133] (903s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy)
[117.155800] Starting subtest: map-fixed-invalidate-overlap-busy
[117.157933] Subtest map-fixed-invalidate-overlap-busy: SKIP (0.000s)
[117.267183] [019/133] (903s left) syncobj_wait (wait-for-submit-complex)
[117.325682] Starting subtest: wait-for-submit-complex
[117.388382] Subtest wait-for-submit-complex: SUCCESS (0.062s)
[117.469652] [020/133] (903s left) gem_mmap_wc (read-write)
[117.524402] Subtest read-write: SKIP (0.000s)
[117.580961] [021/133] (903s left) gem_exec_schedule (preemptive-hang)
[117.749694] Starting subtest: preemptive-hang
[117.750979] Starting dynamic subtest: rcs0
[127.041396] Dynamic subtest rcs0: SUCCESS (9.292s)
[127.050559] Starting dynamic subtest: bcs0
[135.998531] Dynamic subtest bcs0: SUCCESS (8.954s)
[136.005327] Starting dynamic subtest: vcs0
[145.082292] Dynamic subtest vcs0: SUCCESS (9.084s)
[145.089506] Starting dynamic subtest: vcs1
[154.108443] Dynamic subtest vcs1: SUCCESS (9.024s)
[154.114542] Starting dynamic subtest: vecs0
[163.067987] Dynamic subtest vecs0: SUCCESS (8.957s)
[163.076321] Starting dynamic subtest: ccs0
[172.031229] Dynamic subtest ccs0: SUCCESS (8.961s)
[172.032531] Subtest preemptive-hang: SUCCESS (54.279s)
[172.297400] [022/133] (848s left) kms_big_fb (linear-64bpp-rotate-180)
[172.418914] Starting subtest: linear-64bpp-rotate-180
[174.080530] Subtest linear-64bpp-rotate-180: SUCCESS (1.661s)
[174.243438] [023/133] (846s left) syncobj_timeline (wait-zero-handles)
[174.299313] Starting subtest: wait-zero-handles
[174.300454] Subtest wait-zero-handles: SUCCESS (0.000s)
[174.382293] [024/133] (846s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs)
[174.466955] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs
[174.467897] Starting dynamic subtest: pipe-A-eDP-1
[175.233862] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.762s)
[175.243899] Starting dynamic subtest: pipe-B-eDP-1
[177.057722] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.822s)
[177.066169] Starting dynamic subtest: pipe-C-eDP-1
[178.878254] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.819s)
[178.887251] Starting dynamic subtest: pipe-D-eDP-1
[180.743741] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.863s)
[180.744837] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SUCCESS (6.272s)
[181.947391] [025/133] (838s left) gem_spin_batch (engines)
[182.001864] Starting subtest: engines
[182.002740] Starting dynamic subtest: rcs0
[185.250195] Dynamic subtest rcs0: SUCCESS (3.236s)
[185.258828] Starting dynamic subtest: bcs0
[188.524934] Dynamic subtest bcs0: SUCCESS (3.236s)
[188.534071] Starting dynamic subtest: vcs0
[191.761217] Dynamic subtest vcs0: SUCCESS (3.235s)
[191.770257] Starting dynamic subtest: vcs1
[194.998881] Dynamic subtest vcs1: SUCCESS (3.235s)
[195.007840] Starting dynamic subtest: vecs0
[198.234076] Dynamic subtest vecs0: SUCCESS (3.233s)
[198.243327] Starting dynamic subtest: ccs0
[201.471744] Dynamic subtest ccs0: SUCCESS (3.235s)
[201.473036] Subtest engines: SUCCESS (19.422s)
[201.664318] [026/133] (819s left) kms_plane_scaling (plane-scaler-unity-scaling-with-rotation)
[201.756076] Starting subtest: plane-scaler-unity-scaling-with-rotation
[201.756962] Starting dynamic subtest: pipe-A
[202.006100] Dynamic subtest pipe-A: SUCCESS (0.250s)
[202.013303] Starting dynamic subtest: pipe-B
[203.322459] Dynamic subtest pipe-B: SUCCESS (1.315s)
[203.329386] Starting dynamic subtest: pipe-C
[204.666408] Dynamic subtest pipe-C: SUCCESS (1.334s)
[204.675307] Starting dynamic subtest: pipe-D
[205.975716] Dynamic subtest pipe-D: SUCCESS (1.318s)
[205.976590] Subtest plane-scaler-unity-scaling-with-rotation: SUCCESS (4.221s)
[207.170792] [027/133] (813s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-cpu)
[207.266358] Starting subtest: fbcpsr-rgb565-draw-mmap-cpu
[214.143673] Subtest fbcpsr-rgb565-draw-mmap-cpu: SUCCESS (6.878s)
[214.249343] [028/133] (806s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-rc-ccs)
[214.338165] Starting subtest: missing-ccs-buffer-y-tiled-gen12-rc-ccs
[214.338956] Starting dynamic subtest: pipe-A-eDP-1
[214.347579] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[214.354642] Starting dynamic subtest: pipe-B-eDP-1
[214.363070] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[214.369810] Starting dynamic subtest: pipe-C-eDP-1
[214.377916] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[214.384063] Starting dynamic subtest: pipe-D-eDP-1
[214.392659] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[214.394332] Subtest missing-ccs-buffer-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[216.567835] [029/133] (804s left) core_setmaster (master-drop-set-user)
[216.638910] Starting subtest: master-drop-set-user
[216.650463] Subtest master-drop-set-user: SUCCESS (0.014s)
[216.680257] [030/133] (804s left) kms_addfb_basic (tile-pitch-mismatch)
[216.734734] Starting subtest: tile-pitch-mismatch
[216.736969] Subtest tile-pitch-mismatch: SKIP (0.000s)
[216.861477] [031/133] (804s left) gem_userptr_blits (set-cache-level)
[216.913818] Starting subtest: set-cache-level
[216.915680] Subtest set-cache-level: SKIP (0.000s)
[217.036745] [032/133] (804s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs)
[217.134375] Starting subtest: ccs-on-another-bo-yf-tiled-ccs
[217.135387] Starting dynamic subtest: pipe-A-eDP-1
[217.144517] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[217.151573] Starting dynamic subtest: pipe-B-eDP-1
[217.160410] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[217.167307] Starting dynamic subtest: pipe-C-eDP-1
[217.175719] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[217.181825] Starting dynamic subtest: pipe-D-eDP-1
[217.191386] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[217.193073] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.004s)
[219.435972] [033/133] (801s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-plflip-blt)
[219.534307] Starting subtest: fbc-2p-scndscrn-indfb-plflip-blt
[219.535956] Subtest fbc-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[219.626946] [034/133] (801s left) kms_frontbuffer_tracking (fbc-shrfb-scaledprimary)
[219.707880] Starting subtest: fbc-shrfb-scaledprimary
[222.751592] Subtest fbc-shrfb-scaledprimary: SUCCESS (3.044s)
[223.943324] [035/133] (797s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180)
[224.033276] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180
[225.102156] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.069s)
[225.228362] [036/133] (796s left) kms_big_fb (x-tiled-16bpp-rotate-270)
[225.328407] Starting subtest: x-tiled-16bpp-rotate-270
[225.348516] Subtest x-tiled-16bpp-rotate-270: SKIP (0.020s)
[225.462469] [037/133] (795s left) kms_invalid_mode (int-max-clock)
[225.554832] Starting subtest: int-max-clock
[225.555756] Starting dynamic subtest: pipe-A-eDP-1
[225.838930] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[225.846758] Starting dynamic subtest: pipe-B-eDP-1
[225.847631] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[225.853581] Starting dynamic subtest: pipe-C-eDP-1
[225.854458] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[225.860395] Starting dynamic subtest: pipe-D-eDP-1
[225.861257] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[225.862066] Subtest int-max-clock: SUCCESS (0.290s)
[226.662436] [038/133] (794s left) gem_exec_flush (basic-wb-ro-default)
[226.717434] Starting subtest: basic-wb-ro-default
[232.197586] Subtest basic-wb-ro-default: SUCCESS (5.480s)
[232.384557] [039/133] (788s left) kms_cursor_legacy (2x-long-cursor-vs-flip-atomic)
[232.517433] Starting subtest: 2x-long-cursor-vs-flip-atomic
[232.520341] Subtest 2x-long-cursor-vs-flip-atomic: SKIP (0.001s)
[232.657356] [040/133] (788s left) syncobj_wait (wait-for-submit-snapshot)
[232.714703] Starting subtest: wait-for-submit-snapshot
[232.796981] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[232.886653] [041/133] (788s left) kms_async_flips (async-flip-with-page-flip-events-tiled)
[232.976501] Starting subtest: async-flip-with-page-flip-events-tiled
[233.351160] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs
[236.154108] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.793s)
[236.160441] Starting dynamic subtest: pipe-A-eDP-1-4
[238.329083] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.173s)
[238.335842] Starting dynamic subtest: pipe-A-eDP-1-4
[240.338590] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.008s)
[240.345859] Starting dynamic subtest: pipe-A-eDP-1-x
[242.518283] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.178s)
[242.875662] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs
[245.687554] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.806s)
[245.694474] Starting dynamic subtest: pipe-B-eDP-1-4
[247.873492] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.185s)
[247.882615] Starting dynamic subtest: pipe-B-eDP-1-4
[249.883535] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.009s)
[249.899357] Starting dynamic subtest: pipe-B-eDP-1-x
[252.084599] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.200s)
[252.438458] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs
[255.215151] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.772s)
[255.222087] Starting dynamic subtest: pipe-C-eDP-1-4
[257.389957] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.174s)
[257.399383] Starting dynamic subtest: pipe-C-eDP-1-4
[259.400389] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s)
[259.407560] Starting dynamic subtest: pipe-C-eDP-1-x
[261.600848] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.200s)
[261.952997] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs
[264.741062] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.784s)
[264.748350] Starting dynamic subtest: pipe-D-eDP-1-4
[266.915700] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.173s)
[266.924640] Starting dynamic subtest: pipe-D-eDP-1-4
[268.926343] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.010s)
[268.936075] Starting dynamic subtest: pipe-D-eDP-1-x
[271.094234] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.167s)
[271.095292] Subtest async-flip-with-page-flip-events-tiled: SUCCESS (38.106s)
[272.309388] [042/133] (749s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted)
[272.365464] Starting subtest: etime-multi-wait-all-available-unsubmitted
[272.471729] Subtest etime-multi-wait-all-available-unsubmitted: SUCCESS (0.105s)
[272.567080] [043/133] (748s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions-varying-size)
[272.679622] Starting subtest: short-flip-before-cursor-atomic-transitions-varying-size
[273.628156] Subtest short-flip-before-cursor-atomic-transitions-varying-size: SUCCESS (0.948s)
[274.442246] [044/133] (747s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-onoff)
[274.525618] Starting subtest: fbc-1p-primscrn-cur-indfb-onoff
[278.432035] Subtest fbc-1p-primscrn-cur-indfb-onoff: SUCCESS (3.907s)
[279.542980] [045/133] (741s left) gem_exec_params (invalid-bsd2-flag-on-blt)
[279.590839] Starting subtest: invalid-bsd2-flag-on-blt
[279.591793] Subtest invalid-bsd2-flag-on-blt: SUCCESS (0.000s)
[279.707855] [046/133] (741s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[279.798967] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt
[279.800892] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[279.890865] [047/133] (741s left) syncobj_basic (bad-handle-to-fd)
[279.956702] Starting subtest: bad-handle-to-fd
[279.957595] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[280.062028] [048/133] (741s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-msflip-blt)
[280.150708] Starting subtest: fbcpsr-1p-primscrn-indfb-msflip-blt
[287.591737] Subtest fbcpsr-1p-primscrn-indfb-msflip-blt: SUCCESS (7.442s)
[287.729803] [049/133] (733s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-gtt)
[287.817363] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-gtt
[287.818951] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[287.923659] [050/133] (733s left) gem_create (busy-create)
[287.979357] Starting subtest: busy-create
[287.980563] Starting dynamic subtest: smem0
[321.954310] Dynamic subtest smem0: SUCCESS (33.963s)
[321.955720] Subtest busy-create: SUCCESS (33.965s)
[322.133836] [051/133] (699s left) kms_chamelium_hpd (dp-hpd)
[322.511354] Subtest dp-hpd: SKIP (0.000s)
[323.278587] [052/133] (698s left) kms_plane_multiple (tiling-4)
[323.366152] Starting subtest: tiling-4
[323.366909] Starting dynamic subtest: pipe-A-eDP-1
[327.131564] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.764s)
[327.138472] Starting dynamic subtest: pipe-B-eDP-1
[331.562326] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.429s)
[331.569016] Starting dynamic subtest: pipe-C-eDP-1
[335.898569] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.336s)
[335.909494] Starting dynamic subtest: pipe-D-eDP-1
[340.227452] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.327s)
[340.228391] Subtest tiling-4: SUCCESS (16.861s)
[341.031701] [053/133] (680s left) kms_vblank (query-forked-busy)
[341.118625] Starting subtest: query-forked-busy
[341.119690] Starting dynamic subtest: pipe-A-eDP-1
[342.994180] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.875s)
[343.002313] Starting dynamic subtest: pipe-D-eDP-1
[345.590425] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.594s)
[345.591417] Subtest query-forked-busy: SUCCESS (4.473s)
[346.390792] [054/133] (675s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-submitted-signaled)
[346.442031] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[346.443007] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[346.534403] [055/133] (675s left) kms_chamelium_frames (hdmi-crc-multiple)
[346.904152] Subtest hdmi-crc-multiple: SKIP (0.000s)
[347.707063] [056/133] (674s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-render)
[347.811732] Starting subtest: psr-2p-primscrn-cur-indfb-draw-render
[347.813510] Subtest psr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[347.910278] [057/133] (674s left) kms_pm_rpm (dpms-non-lpsp)
[350.032874] Starting subtest: dpms-non-lpsp
[350.035202] Subtest dpms-non-lpsp: SKIP (0.001s)
[350.408465] [058/133] (671s left) kms_debugfs (display-off-read-all)
[350.510300] Starting subtest: display-off-read-all
[350.799340] Subtest display-off-read-all: SUCCESS (0.290s)
[351.622337] [059/133] (670s left) kms_frontbuffer_tracking (fbc-2p-shrfb-fliptrack-mmap-gtt)
[351.711295] Starting subtest: fbc-2p-shrfb-fliptrack-mmap-gtt
[351.712895] Subtest fbc-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[351.798205] [060/133] (670s left) kms_psr (fbc-psr2-sprite-blt)
[351.892275] Starting subtest: fbc-psr2-sprite-blt
[351.893110] Starting dynamic subtest: eDP-1
[351.894975] Dynamic subtest eDP-1: SKIP (0.000s)
[351.896750] Subtest fbc-psr2-sprite-blt: SKIP (0.001s)
[351.975910] [061/133] (670s left) gem_mmap_gtt (medium-copy-odd)
[352.023701] Subtest medium-copy-odd: SKIP (0.000s)
[352.083431] [062/133] (670s left) gem_close_race (basic-process)
[352.139769] Starting subtest: basic-process
[352.190756] Subtest basic-process: SUCCESS (0.050s)
[352.364549] [063/133] (669s left) gem_exec_params (no-vebox)
[352.428030] Starting subtest: no-vebox
[352.430830] Subtest no-vebox: SUCCESS (0.002s)
[354.004736] [064/133] (668s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[354.105766] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[361.323899] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (7.220s)
[361.418486] [065/133] (660s left) gem_unref_active_buffers
[361.583663] [066/133] (660s left) kms_flip (flip-vs-suspend)
[361.675349] Starting subtest: flip-vs-suspend
[361.676253] Starting dynamic subtest: A-eDP1
[396.115562] Dynamic subtest A-eDP1: SUCCESS (4.330s)
[396.125591] Starting dynamic subtest: B-eDP1
[430.114079] Dynamic subtest B-eDP1: SUCCESS (4.170s)
[430.130410] Starting dynamic subtest: C-eDP1
[464.109206] Dynamic subtest C-eDP1: SUCCESS (4.427s)
[464.120069] Starting dynamic subtest: D-eDP1
[498.093805] Dynamic subtest D-eDP1: SUCCESS (4.153s)
[498.096532] Subtest flip-vs-suspend: SUCCESS (17.091s)
[504.365711] [067/133] (522s left) kms_pm_rpm (system-suspend-idle)
[506.404281] Starting subtest: system-suspend-idle
[526.636441] Subtest system-suspend-idle: SUCCESS (5.014s)
[531.065576] [068/133] (500s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[531.146414] Starting subtest: x-tiled-to-vebox-y-tiled
[531.149209] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[531.326711] [069/133] (500s left) i915_drm_fdinfo (isolation)
[531.362356] Starting subtest: isolation
[531.363553] Starting dynamic subtest: rcs0
[531.384289] Dynamic subtest rcs0: SKIP (0.020s)
[531.398738] Starting dynamic subtest: bcs0
[531.401565] Dynamic subtest bcs0: SKIP (0.000s)
[531.413413] Starting dynamic subtest: vcs0
[531.415505] Dynamic subtest vcs0: SKIP (0.000s)
[531.423058] Starting dynamic subtest: vcs1
[531.425522] Dynamic subtest vcs1: SKIP (0.000s)
[531.432833] Starting dynamic subtest: vecs0
[531.435302] Dynamic subtest vecs0: SKIP (0.000s)
[531.442614] Starting dynamic subtest: ccs0
[531.445142] Dynamic subtest ccs0: SKIP (0.000s)
[531.447190] Subtest isolation: SKIP (0.025s)
[531.476945] [070/133] (500s left) kms_ccs (bad-rotation-90-4-tiled-bmg-ccs)
[531.563781] Starting subtest: bad-rotation-90-4-tiled-bmg-ccs
[531.566317] Subtest bad-rotation-90-4-tiled-bmg-ccs: SKIP (0.000s)
[532.642271] [071/133] (498s left) kms_plane_alpha_blend (alpha-transparent-fb)
[532.742495] Starting subtest: alpha-transparent-fb
[533.033442] Starting dynamic subtest: pipe-A-eDP-1
[533.676312] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.641s)
[533.684164] Starting dynamic subtest: pipe-D-eDP-1
[535.045855] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.367s)
[535.046818] Subtest alpha-transparent-fb: SUCCESS (2.301s)
[535.904299] [072/133] (495s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render)
[536.007895] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render
[536.010224] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[536.112400] [073/133] (495s left) gem_sync (basic-store-each)
[536.170433] Starting subtest: basic-store-each
[538.642226] Subtest basic-store-each: SUCCESS (2.471s)
[538.824647] [074/133] (492s left) kms_frontbuffer_tracking (fbcpsr-tiling-4)
[538.912529] Starting subtest: fbcpsr-tiling-4
[546.038236] Subtest fbcpsr-tiling-4: SUCCESS (7.122s)
[546.172161] [075/133] (485s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[546.270574] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[546.272828] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[546.359141] [076/133] (485s left) syncobj_wait (invalid-multi-wait-all-unsubmitted)
[546.419582] Starting subtest: invalid-multi-wait-all-unsubmitted
[546.420764] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[546.513521] [077/133] (485s left) kms_flip (2x-flip-vs-blocking-wf-vblank)
[546.610503] Starting subtest: 2x-flip-vs-blocking-wf-vblank
[546.620593] Subtest 2x-flip-vs-blocking-wf-vblank: SKIP (0.011s)
[546.698528] [078/133] (485s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[546.784544] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt
[546.786620] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[546.879962] [079/133] (484s left) kms_async_flips (test-cursor-atomic)
[546.966918] Starting subtest: test-cursor-atomic
[547.353770] Starting dynamic subtest: pipe-A-eDP-1
[548.147634] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.793s)
[548.514304] Starting dynamic subtest: pipe-B-eDP-1
[549.278631] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.770s)
[549.696722] Starting dynamic subtest: pipe-C-eDP-1
[550.503571] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.814s)
[550.867619] Starting dynamic subtest: pipe-D-eDP-1
[551.639316] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.778s)
[551.640538] Subtest test-cursor-atomic: SUCCESS (4.671s)
[552.808275] [080/133] (479s left) kms_selftest (drm_dp_mst_helper)
[552.847545] Starting subtest: drm_dp_mst_helper
[552.886207] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[552.977544] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.090s)
[552.985588] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[553.072471] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.096s)
[553.081454] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[553.190468] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.116s)
[553.191486] Subtest drm_dp_mst_helper: SUCCESS (0.343s)
[553.326206] [081/133] (478s left) core_auth (basic-auth)
[553.388721] Starting subtest: basic-auth
[553.390273] Subtest basic-auth: SUCCESS (0.001s)
[553.479013] [082/133] (478s left) gem_ctx_persistence (processes)
[553.528749] Starting subtest: processes
[555.424747] Subtest processes: SUCCESS (1.895s)
[555.498224] [083/133] (476s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary)
[555.589135] Starting subtest: psr-indfb-scaledprimary
[561.361368] Subtest psr-indfb-scaledprimary: SUCCESS (5.771s)
[561.458823] [084/133] (470s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[561.565923] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[561.567922] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[561.671887] [085/133] (470s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[561.768493] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[561.771295] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[561.869262] [086/133] (470s left) gem_lmem_swapping (random)
[561.908086] Subtest random: SKIP (0.000s)
[561.952619] [087/133] (470s left) kms_color (degamma)
[562.037607] Starting subtest: degamma
[562.038565] Starting dynamic subtest: pipe-A-eDP-1
[562.759205] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.721s)
[562.767487] Starting dynamic subtest: pipe-B-eDP-1
[564.178648] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.418s)
[564.187960] Starting dynamic subtest: pipe-C-eDP-1
[565.541902] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.365s)
[565.549467] Starting dynamic subtest: pipe-D-eDP-1
[566.869424] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.326s)
[566.870604] Subtest degamma: SUCCESS (4.833s)
[567.659684] [088/133] (464s left) i915_selftest (live)
[569.318327] Starting subtest: live
[569.319477] Starting dynamic subtest: sanitycheck
[572.927339] Dynamic subtest sanitycheck: SUCCESS (3.609s)
[572.935853] Starting dynamic subtest: uncore
[576.533769] Dynamic subtest uncore: SUCCESS (3.606s)
[576.541915] Starting dynamic subtest: workarounds
[580.226058] Dynamic subtest workarounds: SUCCESS (3.691s)
[580.234551] Starting dynamic subtest: gt_engines
[585.344471] Dynamic subtest gt_engines: SUCCESS (5.116s)
[585.353591] Starting dynamic subtest: gt_timelines
[602.612910] Dynamic subtest gt_timelines: SUCCESS (17.263s)
[602.621353] Starting dynamic subtest: gt_contexts
[607.708684] Dynamic subtest gt_contexts: SUCCESS (5.093s)
[607.718934] Starting dynamic subtest: gt_lrc
[612.610287] Dynamic subtest gt_lrc: SUCCESS (4.898s)
[612.618657] Starting dynamic subtest: gt_mocs
[616.435863] Dynamic subtest gt_mocs: SUCCESS (3.823s)
[616.443942] Starting dynamic subtest: gt_pm
[622.179842] Dynamic subtest gt_pm: SUCCESS (5.741s)
[622.189928] Starting dynamic subtest: gt_heartbeat
[625.483314] Dynamic subtest gt_heartbeat: SUCCESS (3.300s)
[625.490502] Starting dynamic subtest: gt_tlb
[635.378876] Dynamic subtest gt_tlb: SUCCESS (9.895s)
[635.387187] Starting dynamic subtest: requests
[647.468400] Dynamic subtest requests: SUCCESS (12.090s)
[647.478547] Starting dynamic subtest: migrate
[654.000197] Dynamic subtest migrate: SUCCESS (6.530s)
[654.009907] Starting dynamic subtest: active
[657.287695] Dynamic subtest active: SUCCESS (3.286s)
[657.298182] Starting dynamic subtest: objects
[661.083917] Dynamic subtest objects: SUCCESS (3.794s)
[661.092561] Starting dynamic subtest: mman
[664.968785] Dynamic subtest mman: SUCCESS (3.882s)
[664.978160] Starting dynamic subtest: dmabuf
[668.349797] Dynamic subtest dmabuf: SUCCESS (3.379s)
[668.359484] Starting dynamic subtest: vma
[671.608621] Dynamic subtest vma: SUCCESS (3.257s)
[671.616991] Starting dynamic subtest: coherency
[676.632312] Dynamic subtest coherency: SUCCESS (5.021s)
[676.642638] Starting dynamic subtest: gtt
[687.003057] Dynamic subtest gtt: SUCCESS (10.368s)
[687.012071] Starting dynamic subtest: gem
[695.112921] Dynamic subtest gem: SUCCESS (8.107s)
[695.122540] Starting dynamic subtest: evict
[701.281285] Dynamic subtest evict: SUCCESS (6.165s)
[701.290202] Starting dynamic subtest: hugepages
[710.525243] Dynamic subtest hugepages: SUCCESS (9.239s)
[710.534514] Starting dynamic subtest: gem_contexts
[738.322580] Dynamic subtest gem_contexts: SUCCESS (27.790s)
[738.330915] Starting dynamic subtest: client
[741.689826] Dynamic subtest client: SUCCESS (3.365s)
[741.699543] Starting dynamic subtest: gem_migrate
[744.946656] Dynamic subtest gem_migrate: SUCCESS (3.253s)
[744.955859] Starting dynamic subtest: reset
[749.823303] Dynamic subtest reset: SUCCESS (4.874s)
[749.832280] Starting dynamic subtest: memory_region
[754.281794] Dynamic subtest memory_region: SUCCESS (4.455s)
[754.291366] Starting dynamic subtest: hangcheck
[767.703207] Dynamic subtest hangcheck: SUCCESS (13.424s)
[767.712183] Starting dynamic subtest: execlists
[770.943826] Dynamic subtest execlists: SUCCESS (3.237s)
[770.953128] Starting dynamic subtest: ring_submission
[774.219488] Dynamic subtest ring_submission: SUCCESS (3.275s)
[774.228383] Starting dynamic subtest: perf
[779.185636] Dynamic subtest perf: SUCCESS (4.965s)
[779.194873] Starting dynamic subtest: slpc
[792.203793] Dynamic subtest slpc: SUCCESS (13.018s)
[792.212844] Starting dynamic subtest: guc
[796.683601] Dynamic subtest guc: SUCCESS (4.478s)
[796.692912] Starting dynamic subtest: guc_multi_lrc
[799.918066] Dynamic subtest guc_multi_lrc: SUCCESS (3.232s)
[799.926939] Starting dynamic subtest: guc_hang
[803.930832] Dynamic subtest guc_hang: SUCCESS (4.011s)
[803.940276] Starting dynamic subtest: late_gt_pm
[807.262716] Dynamic subtest late_gt_pm: SUCCESS (3.329s)
[807.264371] Subtest live: SUCCESS (237.921s)
[807.288032] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[807.288748] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[807.290650] [089/133] (224s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[809.369413] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf
[809.371689] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[809.467834] [FACT kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[809.469086] [FACT kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)] new: kernel.kmod_is_loaded.i915: true
[809.471941] [090/133] (222s left) gem_exec_schedule (preempt-queue-contexts-chain)
[809.536765] Subtest preempt-queue-contexts-chain: SKIP (0.000s)
[809.838435] [091/133] (222s left) perf_pmu (semaphore-wait)
[809.877912] Starting subtest: semaphore-wait
[809.879329] Starting dynamic subtest: rcs0
[810.405354] Dynamic subtest rcs0: SUCCESS (0.518s)
[810.414209] Starting dynamic subtest: bcs0
[810.920068] Dynamic subtest bcs0: SUCCESS (0.512s)
[810.930201] Starting dynamic subtest: vcs0
[811.433431] Dynamic subtest vcs0: SUCCESS (0.510s)
[811.442607] Starting dynamic subtest: vcs1
[811.936767] Dynamic subtest vcs1: SUCCESS (0.510s)
[811.948723] Starting dynamic subtest: vecs0
[812.461774] Dynamic subtest vecs0: SUCCESS (0.512s)
[812.471739] Starting dynamic subtest: ccs0
[812.980179] Dynamic subtest ccs0: SUCCESS (0.516s)
[812.981603] Subtest semaphore-wait: SUCCESS (3.095s)
[814.521000] [092/133] (217s left) gem_reg_read (timestamp-moving)
[814.592298] Starting subtest: timestamp-moving
[815.603701] Subtest timestamp-moving: SUCCESS (1.001s)
[815.668155] [093/133] (216s left) gem_ppgtt (shrink-vs-evict-any)
[815.716234] Starting subtest: shrink-vs-evict-any
[821.533731] Subtest shrink-vs-evict-any: SUCCESS (5.770s)
[821.564905] [094/133] (210s left) kms_hdr (invalid-hdr)
[821.683180] Starting subtest: invalid-hdr
[823.830710] Starting dynamic subtest: pipe-A-eDP-1
[826.852452] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.021s)
[826.853638] Subtest invalid-hdr: SUCCESS (5.171s)
[826.958674] [095/133] (205s left) syncobj_timeline (invalid-transfer-illegal-handle)
[827.006526] Starting subtest: invalid-transfer-illegal-handle
[827.007795] Subtest invalid-transfer-illegal-handle: SUCCESS (0.000s)
[827.091754] [096/133] (205s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-wc)
[827.176541] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-wc
[827.178575] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[827.272229] [097/133] (205s left) kms_flip (2x-flip-vs-wf_vblank)
[827.351173] Starting subtest: 2x-flip-vs-wf_vblank
[827.362644] Subtest 2x-flip-vs-wf_vblank: SKIP (0.011s)
[827.438694] [098/133] (205s left) syncobj_basic (test-valid-cycle)
[827.497584] Starting subtest: test-valid-cycle
[827.498810] Subtest test-valid-cycle: SUCCESS (0.000s)
[827.591128] [099/133] (204s left) core_debugfs (read-all-entries)
[827.639489] Starting subtest: read-all-entries
[827.733740] Subtest read-all-entries: SUCCESS (0.095s)
[827.830962] [100/133] (204s left) i915_pm_rpm (gem-pread)
[829.559515] Starting subtest: gem-pread
[831.774665] Subtest gem-pread: SUCCESS (2.217s)
[831.872681] [101/133] (200s left) kms_rotation_crc (primary-x-tiled-reflect-x-0)
[831.954823] Starting subtest: primary-x-tiled-reflect-x-0
[840.092147] Subtest primary-x-tiled-reflect-x-0: SUCCESS (8.138s)
[841.330350] [102/133] (191s left) kms_psr (pr-sprite-blt)
[841.421653] Starting subtest: pr-sprite-blt
[841.423957] Subtest pr-sprite-blt: SKIP (0.000s)
[841.499542] [103/133] (191s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs)
[841.581596] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs
[841.582568] Starting dynamic subtest: pipe-A-eDP-1
[841.591588] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[841.600188] Starting dynamic subtest: pipe-B-eDP-1
[841.608434] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[841.616899] Starting dynamic subtest: pipe-C-eDP-1
[841.626670] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[841.634859] Starting dynamic subtest: pipe-D-eDP-1
[841.644336] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[841.645996] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.006s)
[843.786985] [104/133] (188s left) i915_module_load (resize-bar)
[843.820579] Starting subtest: resize-bar
[843.827623] Subtest resize-bar: SKIP (0.005s)
[843.864327] [105/133] (188s left) kms_psr (fbc-psr-sprite-plane-onoff)
[843.948923] Starting subtest: fbc-psr-sprite-plane-onoff
[843.950503] Starting dynamic subtest: eDP-1
[843.953197] Dynamic subtest eDP-1: SKIP (0.000s)
[843.955539] Subtest fbc-psr-sprite-plane-onoff: SKIP (0.001s)
[844.016508] [106/133] (188s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[844.104504] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[844.106533] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[844.188994] [107/133] (188s left) kms_fbcon_fbt (fbc-suspend)
[844.240664] Starting subtest: fbc-suspend
[894.185745] Subtest fbc-suspend: SUCCESS (19.749s)
[895.503385] [108/133] (137s left) gem_exec_create (legacy)
[895.554255] Starting subtest: legacy
[895.555204] Starting dynamic subtest: smem
[897.685567] Dynamic subtest smem: SUCCESS (2.131s)
[897.687024] Subtest legacy: SUCCESS (2.133s)
[897.878380] [109/133] (134s left) kms_cursor_edge_walk (64x64-top-bottom)
[897.960206] Starting subtest: 64x64-top-bottom
[897.961145] Starting dynamic subtest: pipe-A-eDP-1
[901.382299] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.423s)
[901.390591] Starting dynamic subtest: pipe-D-eDP-1
[904.511951] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.129s)
[904.512762] Subtest 64x64-top-bottom: SUCCESS (6.554s)
[905.313961] [110/133] (127s left) gem_exec_whisper (basic-queues-all)
[905.378057] Starting subtest: basic-queues-all
[916.189578] Subtest basic-queues-all: SUCCESS (10.810s)
[916.370895] [111/133] (116s left) gem_ccs (block-copy-compressed)
[916.441373] Starting subtest: block-copy-compressed
[916.443617] Subtest block-copy-compressed: SKIP (0.000s)
[916.531141] [112/133] (116s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[916.627339] Starting subtest: yf-tiled-16bpp-rotate-0
[916.629216] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[916.719009] [113/133] (116s left) syncobj_wait (wait-any-interrupted)
[916.771319] Starting subtest: wait-any-interrupted
[916.873474] Subtest wait-any-interrupted: SUCCESS (0.101s)
[916.964442] [114/133] (116s left) perf_pmu (init-wait)
[916.998663] Starting subtest: init-wait
[916.999779] Starting dynamic subtest: rcs0
[917.000741] Dynamic subtest rcs0: SUCCESS (0.001s)
[917.010650] Starting dynamic subtest: bcs0
[917.011557] Dynamic subtest bcs0: SUCCESS (0.001s)
[917.019650] Starting dynamic subtest: vcs0
[917.020566] Dynamic subtest vcs0: SUCCESS (0.001s)
[917.028568] Starting dynamic subtest: vcs1
[917.029452] Dynamic subtest vcs1: SUCCESS (0.001s)
[917.037854] Starting dynamic subtest: vecs0
[917.038919] Dynamic subtest vecs0: SUCCESS (0.001s)
[917.047031] Starting dynamic subtest: ccs0
[917.047863] Dynamic subtest ccs0: SUCCESS (0.000s)
[917.048857] Subtest init-wait: SUCCESS (0.007s)
[917.096215] [115/133] (115s left) gem_ctx_shared (q-in-order)
[917.149030] Starting subtest: Q-in-order
[917.149842] Starting dynamic subtest: rcs0
[917.273293] Dynamic subtest rcs0: SUCCESS (0.116s)
[917.289846] Starting dynamic subtest: vcs0
[917.356350] Dynamic subtest vcs0: SUCCESS (0.090s)
[917.372334] Starting dynamic subtest: vcs1
[917.442895] Dynamic subtest vcs1: SUCCESS (0.086s)
[917.460447] Starting dynamic subtest: vecs0
[917.519870] Dynamic subtest vecs0: SUCCESS (0.076s)
[917.536660] Starting dynamic subtest: ccs0
[917.600847] Dynamic subtest ccs0: SUCCESS (0.080s)
[917.602110] Subtest Q-in-order: SUCCESS (0.453s)
[918.772906] [116/133] (114s left) kms_vrr (seamless-rr-switch-drrs)
[918.870283] Starting subtest: seamless-rr-switch-drrs
[918.872975] Subtest seamless-rr-switch-drrs: SKIP (0.000s)
[918.966572] [117/133] (114s left) syncobj_wait (wait-all-complex)
[919.022778] Starting subtest: wait-all-complex
[919.246757] Subtest wait-all-complex: SUCCESS (0.215s)
[919.313277] [118/133] (113s left) gem_readwrite (beyond-eob)
[919.356312] Subtest beyond-EOB: SKIP (0.000s)
[919.409596] [119/133] (113s left) prime_self_import (basic-llseek-size)
[919.443702] Starting subtest: basic-llseek-size
[919.462863] Subtest basic-llseek-size: SUCCESS (0.021s)
[919.567550] [120/133] (113s left) gem_exec_whisper (basic-fds)
[919.628939] Starting subtest: basic-fds
[927.613458] Subtest basic-fds: SUCCESS (7.974s)
[927.782091] [121/133] (105s left) gem_mmap_gtt (isolation)
[927.849312] Subtest isolation: SKIP (0.000s)
[927.901225] [122/133] (105s left) gem_ringfill (engines-basic)
[933.664579] Starting subtest: engines-basic
[933.665796] Starting dynamic subtest: rcs0
[933.709777] Dynamic subtest rcs0: SUCCESS (0.051s)
[933.722810] Starting dynamic subtest: bcs0
[933.754344] Dynamic subtest bcs0: SUCCESS (0.043s)
[933.765794] Starting dynamic subtest: vcs0
[933.796338] Dynamic subtest vcs0: SUCCESS (0.041s)
[933.807873] Starting dynamic subtest: vcs1
[933.838250] Dynamic subtest vcs1: SUCCESS (0.041s)
[933.850403] Starting dynamic subtest: vecs0
[933.883374] Dynamic subtest vecs0: SUCCESS (0.044s)
[933.896854] Starting dynamic subtest: ccs0
[933.930226] Dynamic subtest ccs0: SUCCESS (0.045s)
[933.931220] Subtest engines-basic: SUCCESS (0.274s)
[934.002077] [123/133] ( 99s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-75)
[934.093957] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-75
[934.094799] Starting dynamic subtest: pipe-A
[934.113822] Dynamic subtest pipe-A: SKIP (0.019s)
[934.122306] Starting dynamic subtest: pipe-B
[934.147683] Dynamic subtest pipe-B: SKIP (0.032s)
[934.156882] Starting dynamic subtest: pipe-C
[934.185137] Dynamic subtest pipe-C: SKIP (0.037s)
[934.193591] Starting dynamic subtest: pipe-D
[934.218700] Dynamic subtest pipe-D: SKIP (0.033s)
[934.220461] Subtest planes-upscale-factor-0-25-downscale-factor-0-75: SKIP (0.124s)
[934.316234] [124/133] ( 99s left) syncobj_timeline (wait-all-delayed-signal)
[934.356460] Starting subtest: wait-all-delayed-signal
[934.458891] Subtest wait-all-delayed-signal: SUCCESS (0.103s)
[934.550373] [125/133] ( 98s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[934.641699] Starting subtest: psr2-overlay-plane-update-continuous-sf
[934.642582] Starting dynamic subtest: pipe-A-eDP-1
[935.779757] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.138s)
[935.788097] Starting dynamic subtest: pipe-B-eDP-1
[937.573436] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.792s)
[937.574356] Subtest psr2-overlay-plane-update-continuous-sf: SUCCESS (2.933s)
[938.375839] [126/133] ( 95s left) gem_exec_balancer (parallel-balancer)
[938.639376] Starting subtest: parallel-balancer
[939.610031] Subtest parallel-balancer: SUCCESS (0.971s)
[939.701035] [127/133] ( 93s left) prime_vgem (fence-write-hang)
[939.770529] Subtest fence-write-hang: SKIP (0.000s)
[939.863705] [128/133] ( 93s left) kms_psr (psr-primary-mmap-gtt)
[939.958930] Starting subtest: psr-primary-mmap-gtt
[939.959872] Starting dynamic subtest: eDP-1
[941.378104] Dynamic subtest eDP-1: SKIP (1.408s)
[941.379908] Subtest psr-primary-mmap-gtt: SKIP (1.410s)
[941.550207] [129/133] ( 92s left) gem_exec_gttfill (all-engines)
[941.612492] Starting subtest: all-engines
[964.876412] Subtest all-engines: SUCCESS (23.263s)
[965.064830] [130/133] ( 68s left) kms_cursor_crc (cursor-rapid-movement-64x21)
[965.301398] Starting subtest: cursor-rapid-movement-64x21
[965.348452] Subtest cursor-rapid-movement-64x21: SKIP (0.045s)
[965.560042] [131/133] ( 68s left) kms_psr (psr2-primary-render)
[965.643313] Starting subtest: psr2-primary-render
[965.644235] Starting dynamic subtest: eDP-1
[967.395363] Dynamic subtest eDP-1: SUCCESS (1.752s)
[967.396360] Subtest psr2-primary-render: SUCCESS (1.753s)
[968.268185] [132/133] ( 65s left) syncobj_timeline (etime-single-wait-all-available-unsubmitted)
[968.333598] Starting subtest: etime-single-wait-all-available-unsubmitted
[968.442171] Subtest etime-single-wait-all-available-unsubmitted: SUCCESS (0.107s)
[968.529419] [133/133] ( 65s left) kms_content_protection (lic-type-0-hdcp14)
[968.659718] Starting subtest: lic-type-0-hdcp14
[968.662286] Subtest lic-type-0-hdcp14: SKIP (0.000s)
[968.770094] Closing watchdogs
results: parsing output: 0/ for test: kms_cursor_crc
results: parsing output: 1/ for test: gen7_exec_parse
results: parsing output: 2/ for test: kms_lease
results: parsing output: 3/ for test: kms_flip
results: parsing output: 4/ for test: syncobj_wait
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_psr2_sf
results: parsing output: 7/ for test: kms_plane
results: parsing output: 8/ for test: syncobj_wait
results: parsing output: 9/ for test: kms_atomic_transition
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: gem_ctx_param
results: parsing output: 12/ for test: gem_ctx_param
results: parsing output: 13/ for test: kms_flip_scaled_crc
results: parsing output: 14/ for test: kms_draw_crc
results: parsing output: 15/ for test: gem_exec_fence
results: parsing output: 16/ for test: gem_ctx_bad_destroy
results: parsing output: 17/ for test: gem_userptr_blits
results: parsing output: 18/ for test: syncobj_wait
results: parsing output: 19/ for test: gem_mmap_wc
results: parsing output: 20/ for test: gem_exec_schedule
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: syncobj_timeline
results: parsing output: 23/ for test: kms_ccs
results: parsing output: 24/ for test: gem_spin_batch
results: parsing output: 25/ for test: kms_plane_scaling
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: kms_ccs
results: parsing output: 28/ for test: core_setmaster
results: parsing output: 29/ for test: kms_addfb_basic
results: parsing output: 30/ for test: gem_userptr_blits
results: parsing output: 31/ for test: kms_ccs
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_big_fb
results: parsing output: 35/ for test: kms_big_fb
results: parsing output: 36/ for test: kms_invalid_mode
results: parsing output: 37/ for test: gem_exec_flush
results: parsing output: 38/ for test: kms_cursor_legacy
results: parsing output: 39/ for test: syncobj_wait
results: parsing output: 40/ for test: kms_async_flips
results: parsing output: 41/ for test: syncobj_timeline
results: parsing output: 42/ for test: kms_cursor_legacy
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: gem_exec_params
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: syncobj_basic
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: gem_create
results: parsing output: 50/ for test: kms_chamelium_hpd
results: parsing output: 51/ for test: kms_plane_multiple
results: parsing output: 52/ for test: kms_vblank
results: parsing output: 53/ for test: syncobj_timeline
results: parsing output: 54/ for test: kms_chamelium_frames
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: kms_pm_rpm
results: parsing output: 57/ for test: kms_debugfs
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: kms_psr
results: parsing output: 60/ for test: gem_mmap_gtt
results: parsing output: 61/ for test: gem_close_race
results: parsing output: 62/ for test: gem_exec_params
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: gem_unref_active_buffers
results: parsing output: 65/ for test: kms_flip
results: parsing output: 66/ for test: kms_pm_rpm
results: parsing output: 67/ for test: gem_render_copy
results: parsing output: 68/ for test: i915_drm_fdinfo
results: parsing output: 69/ for test: kms_ccs
results: parsing output: 70/ for test: kms_plane_alpha_blend
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_sync
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_big_fb
results: parsing output: 75/ for test: syncobj_wait
results: parsing output: 76/ for test: kms_flip
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_async_flips
results: parsing output: 79/ for test: kms_selftest
results: parsing output: 80/ for test: core_auth
results: parsing output: 81/ for test: gem_ctx_persistence
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_big_fb
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: gem_lmem_swapping
results: parsing output: 86/ for test: kms_color
results: parsing output: 87/ for test: i915_selftest
results: parsing output: 88/ for test: kms_psr2_sf
results: parsing output: 89/ for test: gem_exec_schedule
results: parsing output: 90/ for test: perf_pmu
results: parsing output: 91/ for test: gem_reg_read
results: parsing output: 92/ for test: gem_ppgtt
results: parsing output: 93/ for test: kms_hdr
results: parsing output: 94/ for test: syncobj_timeline
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_flip
results: parsing output: 97/ for test: syncobj_basic
results: parsing output: 98/ for test: core_debugfs
results: parsing output: 99/ for test: i915_pm_rpm
results: parsing output: 100/ for test: kms_rotation_crc
results: parsing output: 101/ for test: kms_psr
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: i915_module_load
results: parsing output: 104/ for test: kms_psr
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_fbcon_fbt
results: parsing output: 107/ for test: gem_exec_create
results: parsing output: 108/ for test: kms_cursor_edge_walk
results: parsing output: 109/ for test: gem_exec_whisper
results: parsing output: 110/ for test: gem_ccs
results: parsing output: 111/ for test: kms_big_fb
results: parsing output: 112/ for test: syncobj_wait
results: parsing output: 113/ for test: perf_pmu
results: parsing output: 114/ for test: gem_ctx_shared
results: parsing output: 115/ for test: kms_vrr
results: parsing output: 116/ for test: syncobj_wait
results: parsing output: 117/ for test: gem_readwrite
results: parsing output: 118/ for test: prime_self_import
results: parsing output: 119/ for test: gem_exec_whisper
results: parsing output: 120/ for test: gem_mmap_gtt
results: parsing output: 121/ for test: gem_ringfill
results: parsing output: 122/ for test: kms_plane_scaling
results: parsing output: 123/ for test: syncobj_timeline
results: parsing output: 124/ for test: kms_psr2_sf
results: parsing output: 125/ for test: gem_exec_balancer
results: parsing output: 126/ for test: prime_vgem
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: gem_exec_gttfill
results: parsing output: 129/ for test: kms_cursor_crc
results: parsing output: 130/ for test: kms_psr
results: parsing output: 131/ for test: syncobj_timeline
results: parsing output: 132/ for test: kms_content_protection
Done.