[68.411986] Initializing watchdogs
[68.412083]   /dev/watchdog0
[68.441025] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics]
[68.454486] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[68.459346] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[68.462393] [001/131] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-blt)
[70.572213] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-blt
[70.574117] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[70.777465] [002/131] (958s left) gem_spin_batch (resubmit-new-all)
[70.845678] Starting subtest: resubmit-new-all
[70.846534] Starting dynamic subtest: rcs0
[70.871476] Dynamic subtest rcs0: SUCCESS (0.026s)
[70.878764] Starting dynamic subtest: bcs0
[70.879768] Dynamic subtest bcs0: SUCCESS (0.007s)
[70.887510] Starting dynamic subtest: vcs0
[70.888533] Dynamic subtest vcs0: SUCCESS (0.007s)
[70.896182] Starting dynamic subtest: vcs1
[70.897264] Dynamic subtest vcs1: SUCCESS (0.007s)
[70.904527] Starting dynamic subtest: vecs0
[70.905562] Dynamic subtest vecs0: SUCCESS (0.007s)
[70.906582] Subtest resubmit-new-all: SUCCESS (0.056s)
[71.828540] [003/131] (957s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[73.843486] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[73.844317] Starting dynamic subtest: pipe-A-valid-mode
[74.655978] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.813s)
[74.656893] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (0.814s)
[74.837311] [004/131] (954s left) gem_exec_fence (submit-chain)
[75.020131] Starting subtest: submit-chain
[75.052653] Subtest submit-chain: SUCCESS (0.032s)
[75.775436] [FACT gem_exec_fence (submit-chain)] new: kernel.kmod_is_loaded.vgem: true
[75.777769] [005/131] (953s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-gtt)
[77.775131] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-gtt
[77.776844] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[77.982758] [006/131] (951s left) kms_flip (flip-vs-expired-vblank)
[79.977945] Starting subtest: flip-vs-expired-vblank
[79.985139] Starting dynamic subtest: A-HDMI-A4
[87.842169] Dynamic subtest A-HDMI-A4: SUCCESS (7.858s)
[87.851467] Starting dynamic subtest: B-HDMI-A4
[95.519055] Dynamic subtest B-HDMI-A4: SUCCESS (7.677s)
[95.527703] Starting dynamic subtest: C-HDMI-A4
[103.202875] Dynamic subtest C-HDMI-A4: SUCCESS (7.683s)
[103.211017] Starting dynamic subtest: D-HDMI-A4
[110.888434] Dynamic subtest D-HDMI-A4: SUCCESS (7.684s)
[110.890609] Subtest flip-vs-expired-vblank: SUCCESS (30.912s)
[111.101309] [007/131] (918s left) syncobj_wait (invalid-signal-zero-handles)
[111.152194] Starting subtest: invalid-signal-zero-handles
[111.153199] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[111.285346] [008/131] (918s left) gem_ctx_shared (q-out-order)
[111.346496] Starting subtest: Q-out-order
[111.347440] Starting dynamic subtest: rcs0
[111.518976] Dynamic subtest rcs0: SUCCESS (0.169s)
[111.526283] Starting dynamic subtest: bcs0
[111.635644] Dynamic subtest bcs0: SUCCESS (0.116s)
[111.642867] Starting dynamic subtest: vcs0
[111.751809] Dynamic subtest vcs0: SUCCESS (0.116s)
[111.759351] Starting dynamic subtest: vcs1
[111.863493] Dynamic subtest vcs1: SUCCESS (0.113s)
[111.870462] Starting dynamic subtest: vecs0
[111.991421] Dynamic subtest vecs0: SUCCESS (0.126s)
[111.992563] Subtest Q-out-order: SUCCESS (0.642s)
[112.376132] [009/131] (917s left) gem_userptr_blits (stress-mm)
[112.445044] Starting subtest: stress-mm
[117.816063] Subtest stress-mm: SUCCESS (5.369s)
[118.020936] [010/131] (911s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[120.012426] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[120.013275] Starting dynamic subtest: pipe-A-HDMI-A-4
[120.021882] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.000s)
[120.029245] Starting dynamic subtest: pipe-B-HDMI-A-4
[120.037804] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.000s)
[120.045052] Starting dynamic subtest: pipe-C-HDMI-A-4
[120.054255] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.000s)
[120.061352] Starting dynamic subtest: pipe-D-HDMI-A-4
[120.071033] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.000s)
[120.072931] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SKIP (0.005s)
[120.247050] [011/131] (909s left) perf (whitelisted-registers-userspace-config)
[120.356251] Starting subtest: whitelisted-registers-userspace-config
[120.358141] Subtest whitelisted-registers-userspace-config: SUCCESS (0.001s)
[120.428773] [012/131] (909s left) gem_exec_balancer (indices)
[120.492191] Starting subtest: indices
[122.083298] Subtest indices: SUCCESS (1.591s)
[122.451542] [013/131] (907s left) kms_cursor_crc (cursor-onscreen-128x128)
[124.572406] Starting subtest: cursor-onscreen-128x128
[124.578108] Starting dynamic subtest: pipe-A-HDMI-A-4
[127.275124] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (2.697s)
[127.305332] Starting dynamic subtest: pipe-D-HDMI-A-4
[129.833440] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (2.535s)
[129.834276] Subtest cursor-onscreen-128x128: SUCCESS (5.261s)
[130.220762] [014/131] (899s left) kms_setmode (invalid-clone-single-crtc)
[130.270221] Starting subtest: invalid-clone-single-crtc
[130.272972] Subtest invalid-clone-single-crtc: SKIP (0.000s)
[130.370360] [015/131] (899s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[132.368719] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[132.370300] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[132.580310] [016/131] (897s left) kms_setmode (basic-clone-single-crtc)
[132.629895] Starting subtest: basic-clone-single-crtc
[132.633039] Subtest basic-clone-single-crtc: SKIP (0.000s)
[132.755325] [017/131] (897s left) i915_hangman (hangcheck-unterminated)
[132.816870] Starting subtest: hangcheck-unterminated
[142.090980] Subtest hangcheck-unterminated: SUCCESS (9.274s)
[142.275931] [018/131] (888s left) kms_vblank (wait-idle-hang)
[144.271163] Starting subtest: wait-idle-hang
[144.273373] Starting dynamic subtest: pipe-A-HDMI-A-4
[170.495832] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (26.223s)
[170.506132] Starting dynamic subtest: pipe-D-HDMI-A-4
[195.497062] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (24.998s)
[195.497924] Subtest wait-idle-hang: SUCCESS (51.227s)
[195.669883] [019/131] (834s left) kms_rotation_crc (primary-rotation-180)
[197.666051] Starting subtest: primary-rotation-180
[208.171378] Subtest primary-rotation-180: SUCCESS (10.504s)
[208.410928] [020/131] (822s left) gem_exec_schedule (preempt-queue-contexts)
[208.480652] Subtest preempt-queue-contexts: SKIP (0.000s)
[208.883011] [021/131] (821s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move)
[210.884231] Starting subtest: fbc-2p-primscrn-cur-indfb-move
[210.885883] Subtest fbc-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[211.080734] [022/131] (819s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[213.100964] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip
[214.335333] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip: SUCCESS (1.235s)
[214.575575] [023/131] (816s left) gem_exec_reloc (basic-gtt-wc-active)
[214.632821] Subtest basic-gtt-wc-active: SKIP (0.000s)
[214.721788] [024/131] (816s left) kms_cursor_crc (cursor-rapid-movement-max-size)
[216.949088] Starting subtest: cursor-rapid-movement-max-size
[216.952188] Subtest cursor-rapid-movement-max-size: SKIP (0.000s)
[217.189326] [025/131] (813s left) gem_pxp (reject-modify-context-protection-off-1)
[219.758974] Starting subtest: reject-modify-context-protection-off-1
[219.760966] Subtest reject-modify-context-protection-off-1: SKIP (0.000s)
[219.873140] [026/131] (811s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted)
[219.924284] Starting subtest: etime-single-wait-for-submit-available-unsubmitted
[220.029279] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.104s)
[220.163364] [027/131] (810s left) kms_frontbuffer_tracking (pipe-fbc-rte)
[222.165564] Starting subtest: pipe-fbc-rte
[222.170485] Subtest pipe-fbc-rte: SKIP (0.000s)
[222.371630] [028/131] (808s left) kms_plane_multiple (tiling-none)
[224.367578] Starting subtest: tiling-none
[224.368468] Starting dynamic subtest: pipe-A-HDMI-A-4
[225.230897] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.863s)
[225.240421] Starting dynamic subtest: pipe-B-HDMI-A-4
[225.933107] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.700s)
[225.941317] Starting dynamic subtest: pipe-C-HDMI-A-4
[226.637855] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.704s)
[226.647663] Starting dynamic subtest: pipe-D-HDMI-A-4
[227.348112] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.708s)
[227.348961] Subtest tiling-none: SUCCESS (2.981s)
[227.549592] [029/131] (803s left) gem_lmem_swapping (heavy-multi)
[232.860437] Starting subtest: heavy-multi
[232.861553] Starting dynamic subtest: lmem0
[238.820031] Dynamic subtest lmem0: SUCCESS (5.956s)
[238.821102] Subtest heavy-multi: SUCCESS (5.957s)
[240.821738] [FACT gem_lmem_swapping (heavy-multi)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[240.822927] [FACT gem_lmem_swapping (heavy-multi)] deleted: kernel.kmod_is_loaded.i915: true
[240.825398] [030/131] (790s left) gem_exec_whisper (basic-contexts-priority)
[244.828835] Starting subtest: basic-contexts-priority
[260.844842] Subtest basic-contexts-priority: SUCCESS (16.010s)
[261.012286] [FACT gem_exec_whisper (basic-contexts-priority)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[261.016529] [FACT gem_exec_whisper (basic-contexts-priority)] new: kernel.kmod_is_loaded.i915: true
[261.020050] [031/131] (770s left) vgem_basic (dmabuf-export)
[261.077980] Starting subtest: dmabuf-export
[261.136871] Subtest dmabuf-export: SUCCESS (0.059s)
[261.280129] [032/131] (770s left) gem_exec_params (invalid-bsd-ring)
[261.335243] Starting subtest: invalid-bsd-ring
[261.336182] Subtest invalid-bsd-ring: SUCCESS (0.000s)
[261.465357] [033/131] (770s left) perf_pmu (rc6-all-gts)
[261.520202] Starting subtest: rc6-all-gts
[261.522047] Subtest rc6-all-gts: SKIP (0.000s)
[261.627707] [034/131] (769s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-wc)
[263.632067] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-wc
[263.633998] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[263.803550] [035/131] (767s left) kms_prime (basic-modeset-hybrid)
[268.620967] Subtest basic-modeset-hybrid: SKIP (0.000s)
[268.737420] [FACT kms_prime (basic-modeset-hybrid)] new: kernel.kmod_is_loaded.amdgpu: true
[268.738593] [FACT kms_prime (basic-modeset-hybrid)] new: kernel.kmod_is_loaded.xe: true
[268.741033] [036/131] (762s left) kms_lease (master-vs-lease)
[270.732343] Starting subtest: master-vs-lease
[270.733293] Subtest master-vs-lease: SUCCESS (0.002s)
[270.861200] [037/131] (760s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-fully-sf)
[272.888449] Subtest psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[272.965775] [038/131] (758s left) kms_busy (extended-modeset-hang-newfb)
[274.970141] Starting subtest: extended-modeset-hang-newfb
[274.971165] Starting dynamic subtest: pipe-A
[290.516223] Dynamic subtest pipe-A: SUCCESS (15.544s)
[290.527237] Starting dynamic subtest: pipe-D
[306.004509] Dynamic subtest pipe-D: SUCCESS (15.484s)
[306.005369] Subtest extended-modeset-hang-newfb: SUCCESS (31.036s)
[306.207082] [039/131] (725s left) kms_psr (fbc-psr-cursor-mmap-cpu)
[308.208083] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.000s)
[308.282118] [040/131] (723s left) prime_self_import (basic-with_one_bo)
[308.330814] Starting subtest: basic-with_one_bo
[308.334631] Subtest basic-with_one_bo: SUCCESS (0.004s)
[308.444706] [041/131] (723s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc)
[310.441331] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc
[310.442302] Starting dynamic subtest: pipe-A-HDMI-A-4
[310.451289] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.001s)
[310.459543] Starting dynamic subtest: pipe-B-HDMI-A-4
[310.469570] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.001s)
[310.477830] Starting dynamic subtest: pipe-C-HDMI-A-4
[310.488773] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.001s)
[310.496918] Starting dynamic subtest: pipe-D-HDMI-A-4
[310.508432] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.001s)
[310.510694] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.011s)
[310.683893] [042/131] (721s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[312.678531] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[312.679391] Starting dynamic subtest: pipe-A-valid-mode
[313.850530] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.171s)
[313.851406] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SUCCESS (1.173s)
[314.025655] [043/131] (718s left) device_reset (unbind-cold-reset-rebind)
[314.126222] Starting subtest: unbind-cold-reset-rebind
[314.128055] Subtest unbind-cold-reset-rebind: SKIP (0.000s)
[314.244596] [044/131] (718s left) gem_exec_schedule (u-submit-late-slice)
[314.312488] Starting subtest: u-submit-late-slice
[314.313328] Starting dynamic subtest: rcs0
[314.361990] Dynamic subtest rcs0: SUCCESS (0.049s)
[314.370679] Starting dynamic subtest: bcs0
[314.397448] Dynamic subtest bcs0: SUCCESS (0.035s)
[314.405784] Starting dynamic subtest: vcs0
[314.430847] Dynamic subtest vcs0: SUCCESS (0.033s)
[314.439318] Starting dynamic subtest: vcs1
[314.466073] Dynamic subtest vcs1: SUCCESS (0.034s)
[314.474622] Starting dynamic subtest: vecs0
[314.501683] Dynamic subtest vecs0: SUCCESS (0.035s)
[314.502610] Subtest u-submit-late-slice: SUCCESS (0.190s)
[314.956489] [045/131] (717s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format)
[316.956200] Starting subtest: plane-upscale-20x20-with-pixel-format
[316.957183] Starting dynamic subtest: pipe-A
[319.214263] Dynamic subtest pipe-A: SUCCESS (2.259s)
[319.228652] Starting dynamic subtest: pipe-B
[321.437061] Dynamic subtest pipe-B: SUCCESS (2.221s)
[321.454140] Starting dynamic subtest: pipe-C
[321.745058] Dynamic subtest pipe-C: SUCCESS (0.306s)
[321.759941] Starting dynamic subtest: pipe-D
[322.051958] Dynamic subtest pipe-D: SUCCESS (0.305s)
[322.053022] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (5.098s)
[322.251246] [046/131] (710s left) kms_chamelium_color (ctm-0-75)
[324.253043] Subtest ctm-0-75: SKIP (0.000s)
[324.328792] [047/131] (708s left) kms_addfb_basic (bo-too-small)
[326.328497] Starting subtest: bo-too-small
[326.329348] Subtest bo-too-small: SUCCESS (0.000s)
[326.491026] [048/131] (706s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-blt)
[328.509937] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-blt
[328.511776] Subtest fbc-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[328.731900] [049/131] (703s left) gem_mmap_offset (isolation)
[328.779937] Starting subtest: isolation
[328.785921] Subtest isolation: SUCCESS (0.004s)
[328.974284] [050/131] (703s left) gem_exec_params (invalid-flag)
[329.030759] Starting subtest: invalid-flag
[329.031668] Subtest invalid-flag: SUCCESS (0.000s)
[329.166570] [051/131] (703s left) sysfs_preempt_timeout (invalid)
[329.218910] Starting subtest: invalid
[329.221218] Starting dynamic subtest: vecs0
[329.222121] Dynamic subtest vecs0: SUCCESS (0.000s)
[329.231165] Starting dynamic subtest: vcs0
[329.232231] Dynamic subtest vcs0: SUCCESS (0.000s)
[329.240328] Starting dynamic subtest: bcs0
[329.241545] Dynamic subtest bcs0: SUCCESS (0.000s)
[329.249744] Starting dynamic subtest: rcs0
[329.250905] Dynamic subtest rcs0: SUCCESS (0.000s)
[329.259036] Starting dynamic subtest: vcs1
[329.260150] Dynamic subtest vcs1: SUCCESS (0.000s)
[329.261280] Subtest invalid: SUCCESS (0.009s)
[329.333313] [052/131] (703s left) kms_ccs (bad-aux-stride-4-tiled-mtl-mc-ccs)
[331.329376] Starting subtest: bad-aux-stride-4-tiled-mtl-mc-ccs
[331.330481] Starting dynamic subtest: pipe-A-HDMI-A-4
[331.339801] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.000s)
[331.348277] Starting dynamic subtest: pipe-B-HDMI-A-4
[331.358816] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.000s)
[331.367154] Starting dynamic subtest: pipe-C-HDMI-A-4
[331.375152] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.000s)
[331.383224] Starting dynamic subtest: pipe-D-HDMI-A-4
[331.391707] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.000s)
[331.393300] Subtest bad-aux-stride-4-tiled-mtl-mc-ccs: SKIP (0.009s)
[331.560883] [053/131] (701s left) kms_chamelium_hpd (vga-hpd-for-each-pipe)
[333.610306] Subtest vga-hpd-for-each-pipe: SKIP (0.000s)
[333.719896] [054/131] (699s left) gem_softpin (allocator-evict)
[333.775852] Starting subtest: allocator-evict
[333.776832] Starting dynamic subtest: rcs0
[362.766461] Dynamic subtest rcs0: SUCCESS (28.987s)
[362.775268] Starting dynamic subtest: bcs0
[392.062323] Dynamic subtest bcs0: SUCCESS (29.295s)
[392.071342] Starting dynamic subtest: vcs0
[421.288307] Dynamic subtest vcs0: SUCCESS (29.225s)
[421.297379] Starting dynamic subtest: vcs1
[449.086287] Dynamic subtest vcs1: SUCCESS (27.797s)
[449.095286] Starting dynamic subtest: vecs0
[478.129297] Dynamic subtest vecs0: SUCCESS (29.042s)
[478.130185] Subtest allocator-evict: SUCCESS (144.352s)
[478.342458] [055/131] (554s left) kms_psr (pr-primary-blt)
[480.389876] Subtest pr-primary-blt: SKIP (0.000s)
[480.464699] [056/131] (552s left) gem_exec_reloc (basic-write-cpu-active)
[480.525295] Subtest basic-write-cpu-active: SKIP (0.000s)
[480.621917] [057/131] (552s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[482.620849] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[482.622582] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.002s)
[482.736442] [058/131] (550s left) kms_draw_crc (draw-method-mmap-wc)
[484.746634] Starting subtest: draw-method-mmap-wc
[484.748327] Subtest draw-method-mmap-wc: SKIP (0.000s)
[484.965071] [059/131] (548s left) perf_pmu (busy-idle-check-all)
[485.021211] Starting subtest: busy-idle-check-all
[485.022159] Starting dynamic subtest: rcs0
[485.689083] Dynamic subtest rcs0: SUCCESS (0.667s)
[485.703440] Starting dynamic subtest: bcs0
[486.343062] Dynamic subtest bcs0: SUCCESS (0.652s)
[486.357573] Starting dynamic subtest: vcs0
[486.998111] Dynamic subtest vcs0: SUCCESS (0.653s)
[487.011294] Starting dynamic subtest: vcs1
[487.652806] Dynamic subtest vcs1: SUCCESS (0.652s)
[487.673609] Starting dynamic subtest: vecs0
[488.314740] Dynamic subtest vecs0: SUCCESS (0.656s)
[488.318068] Subtest busy-idle-check-all: SUCCESS (3.295s)
[488.437085] [060/131] (545s left) kms_big_fb (linear-64bpp-rotate-270)
[490.453209] Starting subtest: linear-64bpp-rotate-270
[490.532333] Subtest linear-64bpp-rotate-270: SKIP (0.078s)
[490.775711] [061/131] (542s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-wc)
[492.768160] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-wc
[492.770067] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[492.981940] [062/131] (540s left) gem_partial_pwrite_pread (writes-after-reads)
[493.036648] Subtest writes-after-reads: SKIP (0.000s)
[493.217609] [063/131] (540s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[495.219094] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[495.220833] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[495.419741] [064/131] (538s left) kms_pm_rpm (dpms-lpsp)
[500.152380] Starting subtest: dpms-lpsp
[500.156398] Subtest dpms-lpsp: SKIP (0.001s)
[501.346171] [065/131] (532s left) api_intel_allocator (reloc-allocator)
[501.411916] Starting subtest: reloc-allocator
[501.413043] Starting dynamic subtest: basic
[501.427673] Dynamic subtest basic: SUCCESS (0.016s)
[501.441954] Starting dynamic subtest: parallel-one
[501.442976] Dynamic subtest parallel-one: SUCCESS (0.005s)
[501.454205] Starting dynamic subtest: print
[501.455176] Dynamic subtest print: SUCCESS (0.000s)
[501.465332] Starting dynamic subtest: reuse
[501.466272] Dynamic subtest reuse: SUCCESS (0.000s)
[501.476355] Starting dynamic subtest: fork-reopen-allocator
[501.477377] Dynamic subtest fork-reopen-allocator: SUCCESS (0.022s)
[501.478289] Subtest reloc-allocator: SUCCESS (0.051s)
[501.625130] [066/131] (532s left) kms_feature_discovery (chamelium)
[503.623627] Starting subtest: chamelium
[503.625498] Subtest chamelium: SKIP (0.000s)
[503.758893] [067/131] (530s left) i915_pm_rpm (system-suspend-execbuf)
[508.075586] Starting subtest: system-suspend-execbuf
[569.494810] Subtest system-suspend-execbuf: SUCCESS (51.005s)
[570.728376] [068/131] (474s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-render)
[572.758454] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-render
[572.760150] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[572.943869] [069/131] (472s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[574.948089] Starting subtest: primary-y-tiled-reflect-x-90
[585.428627] Subtest primary-y-tiled-reflect-x-90: SUCCESS (10.480s)
[585.680164] [070/131] (459s left) gem_exec_reloc (basic-wc-cpu)
[585.734977] Subtest basic-wc-cpu: SKIP (0.000s)
[585.839948] [071/131] (459s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite)
[587.847607] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite
[587.849664] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[588.050769] [072/131] (457s left) sw_sync (alloc_fence)
[588.105726] Starting subtest: alloc_fence
[588.106686] Subtest alloc_fence: SUCCESS (0.000s)
[588.226467] [073/131] (457s left) gen9_exec_parse (bb-oversize)
[588.285235] Subtest bb-oversize: SKIP (0.000s)
[588.355889] [074/131] (457s left) gem_lmem_swapping (verify-random-ccs)
[593.671246] Starting subtest: verify-random-ccs
[593.675049] Starting dynamic subtest: lmem0
[593.677046] Dynamic subtest lmem0: SKIP (0.000s)
[593.679069] Subtest verify-random-ccs: SKIP (0.004s)
[594.920986] [FACT gem_lmem_swapping (verify-random-ccs)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[594.922281] [FACT gem_lmem_swapping (verify-random-ccs)] deleted: kernel.kmod_is_loaded.i915: true
[594.925184] [075/131] (450s left) gem_exec_parallel (engines)
[598.843773] Starting subtest: engines
[598.847335] Starting dynamic subtest: basic
[600.471033] Dynamic subtest basic: SUCCESS (1.627s)
[600.483066] Starting dynamic subtest: contexts
[603.805102] Dynamic subtest contexts: SUCCESS (3.329s)
[603.816184] Starting dynamic subtest: fds
[608.090424] Dynamic subtest fds: SUCCESS (4.284s)
[608.101191] Starting dynamic subtest: userptr
[609.625657] Dynamic subtest userptr: SUCCESS (1.537s)
[609.626531] Subtest engines: SUCCESS (10.783s)
[609.956697] [FACT gem_exec_parallel (engines)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[609.961151] [FACT gem_exec_parallel (engines)] new: kernel.kmod_is_loaded.i915: true
[609.964862] [076/131] (435s left) gem_exec_reloc (basic-write-wc-active)
[610.020692] Subtest basic-write-wc-active: SKIP (0.000s)
[610.164321] [077/131] (435s left) gem_mmap_gtt (big-copy-xy)
[610.216425] Subtest big-copy-XY: SKIP (0.000s)
[610.294676] [078/131] (435s left) kms_setmode (invalid-clone-exclusive-crtc)
[610.345362] Starting subtest: invalid-clone-exclusive-crtc
[610.347827] Subtest invalid-clone-exclusive-crtc: SKIP (0.000s)
[610.466571] [079/131] (435s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-sf)
[612.465114] Subtest pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[612.542453] [080/131] (433s left) kms_big_fb (4-tiled-64bpp-rotate-90)
[614.557590] Starting subtest: 4-tiled-64bpp-rotate-90
[614.559519] Subtest 4-tiled-64bpp-rotate-90: SKIP (0.000s)
[614.777718] [081/131] (431s left) gem_userptr_blits (access-control)
[614.860944] Starting subtest: access-control
[614.862724] Subtest access-control: SKIP (0.000s)
[615.049404] [082/131] (431s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[617.093208] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[617.210864] [083/131] (429s left) i915_query (query-topology-garbage-items)
[617.263653] Starting subtest: query-topology-garbage-items
[617.264597] Subtest query-topology-garbage-items: SUCCESS (0.000s)
[617.389943] [084/131] (428s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-submi
[617.441805] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-submitted
[617.547226] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-submitted: SUCCESS (0.103s)
[617.711299] [085/131] (428s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-factor-0-25)
[619.708829] Starting subtest: planes-downscale-factor-0-5-upscale-factor-0-25
[619.709826] Starting dynamic subtest: pipe-A
[619.872709] Dynamic subtest pipe-A: SUCCESS (0.164s)
[619.885429] Starting dynamic subtest: pipe-B
[620.012534] Dynamic subtest pipe-B: SUCCESS (0.139s)
[620.025520] Starting dynamic subtest: pipe-C
[620.152492] Dynamic subtest pipe-C: SUCCESS (0.139s)
[620.165080] Starting dynamic subtest: pipe-D
[620.293437] Dynamic subtest pipe-D: SUCCESS (0.140s)
[620.294299] Subtest planes-downscale-factor-0-5-upscale-factor-0-25: SUCCESS (0.586s)
[620.482168] [086/131] (425s left) kms_cursor_crc (cursor-size-change)
[622.483659] Starting subtest: cursor-size-change
[622.484744] Starting dynamic subtest: pipe-A-HDMI-A-4
[623.423800] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.938s)
[623.437028] Starting dynamic subtest: pipe-D-HDMI-A-4
[624.125802] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.700s)
[624.126695] Subtest cursor-size-change: SUCCESS (1.644s)
[624.701477] [087/131] (421s left) gem_render_copy (x-tiled-to-vebox-yf-tiled)
[624.761918] Starting subtest: x-tiled-to-vebox-yf-tiled
[624.762892] Starting dynamic subtest: smem
[624.844809] Dynamic subtest smem: SUCCESS (0.082s)
[624.856426] Starting dynamic subtest: lmem0
[625.605772] Dynamic subtest lmem0: SUCCESS (0.757s)
[625.606866] Subtest x-tiled-to-vebox-yf-tiled: SUCCESS (0.841s)
[625.872501] [088/131] (420s left) kms_addfb_basic (legacy-format)
[625.923941] Starting subtest: legacy-format
[625.963894] Subtest legacy-format: SUCCESS (0.040s)
[628.049642] [089/131] (418s left) gem_eio (create-ext)
[628.262681] Starting subtest: create-ext
[628.575219] Subtest create-ext: SUCCESS (0.313s)
[630.669604] [090/131] (416s left) syncobj_timeline (invalid-transfer-non-existent-point)
[630.730192] Starting subtest: invalid-transfer-non-existent-point
[630.731077] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[630.864044] [091/131] (415s left) syncobj_timeline (signal-array)
[630.914771] Starting subtest: signal-array
[630.915648] Subtest signal-array: SUCCESS (0.000s)
[631.033650] [092/131] (415s left) gem_exec_reloc (basic-wc-read-noreloc)
[631.089256] Subtest basic-wc-read-noreloc: SKIP (0.000s)
[631.205722] [093/131] (415s left) kms_big_fb (yf-tiled-addfb-size-overflow)
[633.218670] Starting subtest: yf-tiled-addfb-size-overflow
[633.220665] Subtest yf-tiled-addfb-size-overflow: SKIP (0.000s)
[633.429074] [094/131] (413s left) gem_ppgtt (blt-vs-render-ctx0)
[633.485528] Starting subtest: blt-vs-render-ctx0
[666.109291] Subtest blt-vs-render-ctx0: SUCCESS (32.620s)
[666.386862] [095/131] (380s left) kms_frontbuffer_tracking (fbc-modesetfrombusy)
[668.475990] Starting subtest: fbc-modesetfrombusy
[669.856752] Subtest fbc-modesetfrombusy: SUCCESS (1.382s)
[670.081203] [096/131] (377s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[672.100423] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[672.102325] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[672.314825] [097/131] (375s left) kms_selftest (drm_damage_helper)
[672.374883] Starting subtest: drm_damage_helper
[672.448586] Starting dynamic subtest: drm_test_damage_iter_no_damage
[672.549086] Dynamic subtest drm_test_damage_iter_no_damage: SUCCESS (0.139s)
[672.590208] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src
[672.645872] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src: SUCCESS (0.094s)
[672.688945] Starting dynamic subtest: drm_test_damage_iter_no_damage_src_moved
[672.762787] Dynamic subtest drm_test_damage_iter_no_damage_src_moved: SUCCESS (0.112s)
[672.813127] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src_moved
[672.872370] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src_moved: SUCCESS (0.104s)
[672.916048] Starting dynamic subtest: drm_test_damage_iter_no_damage_not_visible
[672.988545] Dynamic subtest drm_test_damage_iter_no_damage_not_visible: SUCCESS (0.111s)
[673.038069] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_crtc
[673.110984] Dynamic subtest drm_test_damage_iter_no_damage_no_crtc: SUCCESS (0.115s)
[673.159483] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_fb
[673.238401] Dynamic subtest drm_test_damage_iter_no_damage_no_fb: SUCCESS (0.121s)
[673.260200] Starting dynamic subtest: drm_test_damage_iter_simple_damage
[673.341131] Dynamic subtest drm_test_damage_iter_simple_damage: SUCCESS (0.096s)
[673.389474] Starting dynamic subtest: drm_test_damage_iter_single_damage
[673.468611] Dynamic subtest drm_test_damage_iter_single_damage: SUCCESS (0.120s)
[673.515385] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_src
[673.582085] Dynamic subtest drm_test_damage_iter_single_damage_intersect_src: SUCCESS (0.107s)
[673.629829] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_src
[673.699243] Dynamic subtest drm_test_damage_iter_single_damage_outside_src: SUCCESS (0.110s)
[673.748964] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src
[673.808761] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src: SUCCESS (0.103s)
[673.850239] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_fractional_src
[673.911474] Dynamic subtest drm_test_damage_iter_single_damage_intersect_fractional_src: SUCCESS (0.101s)
[673.957942] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_fractional_src
[674.030529] Dynamic subtest drm_test_damage_iter_single_damage_outside_fractional_src: SUCCESS (0.114s)
[674.079217] Starting dynamic subtest: drm_test_damage_iter_single_damage_src_moved
[674.133811] Dynamic subtest drm_test_damage_iter_single_damage_src_moved: SUCCESS (0.098s)
[674.170539] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src_moved
[674.241696] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src_moved: SUCCESS (0.104s)
[674.289581] Starting dynamic subtest: drm_test_damage_iter_damage
[674.375347] Dynamic subtest drm_test_damage_iter_damage: SUCCESS (0.127s)
[674.424215] Starting dynamic subtest: drm_test_damage_iter_damage_one_intersect
[674.500314] Dynamic subtest drm_test_damage_iter_damage_one_intersect: SUCCESS (0.118s)
[674.514829] Starting dynamic subtest: drm_test_damage_iter_damage_one_outside
[674.595204] Dynamic subtest drm_test_damage_iter_damage_one_outside: SUCCESS (0.092s)
[674.609098] Starting dynamic subtest: drm_test_damage_iter_damage_src_moved
[674.717314] Dynamic subtest drm_test_damage_iter_damage_src_moved: SUCCESS (0.120s)
[674.767803] Starting dynamic subtest: drm_test_damage_iter_damage_not_visible
[674.812785] Dynamic subtest drm_test_damage_iter_damage_not_visible: SUCCESS (0.089s)
[674.813866] Subtest drm_damage_helper: SUCCESS (2.438s)
[675.048755] [098/131] (372s left) gem_exec_reloc (basic-wc-read-active)
[675.105791] Subtest basic-wc-read-active: SKIP (0.000s)
[675.197013] [099/131] (372s left) kms_content_protection (legacy)
[677.255082] Starting subtest: legacy
[678.655702] Subtest legacy: SKIP (1.392s)
[678.913470] [100/131] (368s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs)
[680.913284] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs
[680.914163] Starting dynamic subtest: pipe-A-HDMI-A-4
[681.501139] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.585s)
[681.513362] Starting dynamic subtest: pipe-B-HDMI-A-4
[682.092835] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.589s)
[682.105224] Starting dynamic subtest: pipe-C-HDMI-A-4
[682.682617] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.587s)
[682.694988] Starting dynamic subtest: pipe-D-HDMI-A-4
[683.273815] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.588s)
[683.274959] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SUCCESS (2.359s)
[683.456916] [101/131] (364s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc)
[685.468472] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc
[685.470220] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[685.681754] [102/131] (362s left) kms_psr (fbc-psr2-cursor-mmap-cpu)
[687.682068] Subtest fbc-psr2-cursor-mmap-cpu: SKIP (0.000s)
[687.750492] [103/131] (360s left) kms_cursor_legacy (torture-bo)
[689.750892] Starting subtest: torture-bo
[689.751738] Starting dynamic subtest: pipe-A
[695.297678] Dynamic subtest pipe-A: SUCCESS (5.541s)
[695.310516] Starting dynamic subtest: pipe-B
[701.068306] Dynamic subtest pipe-B: SUCCESS (5.771s)
[701.080538] Starting dynamic subtest: pipe-C
[706.636806] Dynamic subtest pipe-C: SUCCESS (5.567s)
[706.648727] Starting dynamic subtest: pipe-D
[712.478906] Dynamic subtest pipe-D: SUCCESS (5.841s)
[712.491671] Starting dynamic subtest: all-pipes
[718.364031] Dynamic subtest all-pipes: SUCCESS (5.884s)
[718.364870] Subtest torture-bo: SUCCESS (28.611s)
[718.468667] [104/131] (329s left) kms_vblank (ts-continuation-suspend)
[720.466027] Starting subtest: ts-continuation-suspend
[720.466938] Starting dynamic subtest: pipe-A-HDMI-A-4
[741.159464] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (9.986s)
[741.174976] Starting dynamic subtest: pipe-D-HDMI-A-4
[763.153442] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (9.388s)
[763.154371] Subtest ts-continuation-suspend: SUCCESS (19.381s)
[769.369893] [105/131] (308s left) kms_psr (psr2-primary-blt)
[771.372757] Subtest psr2-primary-blt: SKIP (0.000s)
[771.440419] [106/131] (306s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[773.454584] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[773.456428] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[773.640253] [107/131] (304s left) gem_exec_balancer (sliced)
[773.707185] Starting subtest: sliced
[773.709194] Subtest sliced: SKIP (0.000s)
[774.145252] [108/131] (303s left) syncobj_eventfd (binary-wait-signaled)
[774.198053] Starting subtest: binary-wait-signaled
[774.198987] Subtest binary-wait-signaled: SUCCESS (0.000s)
[774.318412] [109/131] (303s left) kms_flip (plain-flip-ts-check-interruptible)
[776.324855] Starting subtest: plain-flip-ts-check-interruptible
[776.333354] Starting dynamic subtest: A-HDMI-A4
[784.363260] Dynamic subtest A-HDMI-A4: SUCCESS (8.029s)
[784.411497] Starting dynamic subtest: B-HDMI-A4
[792.340160] Dynamic subtest B-HDMI-A4: SUCCESS (7.970s)
[792.356220] Starting dynamic subtest: C-HDMI-A4
[800.290721] Dynamic subtest C-HDMI-A4: SUCCESS (7.948s)
[800.329690] Starting dynamic subtest: D-HDMI-A4
[808.272014] Dynamic subtest D-HDMI-A4: SUCCESS (7.974s)
[808.272975] Subtest plain-flip-ts-check-interruptible: SUCCESS (31.948s)
[808.492496] [110/131] (269s left) gem_ctx_persistence (engines-mixed-process)
[808.549958] Starting subtest: engines-mixed-process
[808.550939] Starting dynamic subtest: rcs0
[810.631927] Dynamic subtest rcs0: SUCCESS (2.081s)
[810.646543] Starting dynamic subtest: bcs0
[812.620986] Dynamic subtest bcs0: SUCCESS (1.988s)
[812.636189] Starting dynamic subtest: vcs0
[814.605365] Dynamic subtest vcs0: SUCCESS (1.983s)
[814.620772] Starting dynamic subtest: vcs1
[816.661332] Dynamic subtest vcs1: SUCCESS (2.054s)
[816.676836] Starting dynamic subtest: vecs0
[818.634171] Dynamic subtest vecs0: SUCCESS (1.971s)
[818.635183] Subtest engines-mixed-process: SUCCESS (10.085s)
[818.765879] [111/131] (259s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[820.769946] Starting subtest: psr-shrfb-scaledprimary
[820.771743] Subtest psr-shrfb-scaledprimary: SKIP (0.000s)
[820.986848] [112/131] (257s left) kms_psr (psr-sprite-mmap-cpu)
[822.988243] Subtest psr-sprite-mmap-cpu: SKIP (0.000s)
[823.070044] [113/131] (255s left) core_getversion (all-cards)
[823.118688] Starting subtest: all-cards
[823.144700] Subtest all-cards: SUCCESS (0.026s)
[823.225255] [114/131] (255s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc)
[825.226680] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc
[825.227521] Starting dynamic subtest: pipe-A-HDMI-A-4
[829.682955] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (4.450s)
[829.706238] Starting dynamic subtest: pipe-B-HDMI-A-4
[830.426409] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.733s)
[830.470355] Starting dynamic subtest: pipe-C-HDMI-A-4
[831.167873] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.729s)
[831.210711] Starting dynamic subtest: pipe-D-HDMI-A-4
[831.908203] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.728s)
[831.910243] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SUCCESS (6.680s)
[832.120535] [115/131] (246s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt)
[834.124112] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt
[834.125967] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[834.317186] [116/131] (244s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[836.322047] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt
[836.323880] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[836.512083] [117/131] (242s left) kms_flip (basic-plain-flip)
[838.510806] Starting subtest: basic-plain-flip
[838.519004] Starting dynamic subtest: A-HDMI-A4
[839.231187] Dynamic subtest A-HDMI-A4: SUCCESS (0.712s)
[839.254818] Starting dynamic subtest: B-HDMI-A4
[839.910828] Dynamic subtest B-HDMI-A4: SUCCESS (0.677s)
[839.932850] Starting dynamic subtest: C-HDMI-A4
[840.576881] Dynamic subtest C-HDMI-A4: SUCCESS (0.664s)
[840.591485] Starting dynamic subtest: D-HDMI-A4
[841.245030] Dynamic subtest D-HDMI-A4: SUCCESS (0.666s)
[841.245939] Subtest basic-plain-flip: SUCCESS (2.735s)
[841.482684] [118/131] (237s left) drm_fdinfo (virtual-busy-hang)
[841.537654] Starting subtest: virtual-busy-hang
[841.539341] Subtest virtual-busy-hang: SKIP (0.000s)
[841.668290] [119/131] (237s left) gem_barrier_race (remote-request)
[841.735733] Starting subtest: remote-request
[841.806904] Starting dynamic subtest: rcs0
[846.902393] Dynamic subtest rcs0: SUCCESS (5.166s)
[846.903678] Subtest remote-request: SUCCESS (5.167s)
[847.040055] [120/131] (231s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[849.045421] Starting subtest: nonblocking-crc-frame-sequence
[849.046581] Starting dynamic subtest: pipe-A-HDMI-A-4
[849.807060] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.760s)
[849.821545] Starting dynamic subtest: pipe-B-HDMI-A-4
[850.364175] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.554s)
[850.379032] Starting dynamic subtest: pipe-C-HDMI-A-4
[850.957647] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.591s)
[850.972221] Starting dynamic subtest: pipe-D-HDMI-A-4
[851.556282] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.597s)
[851.557177] Subtest nonblocking-crc-frame-sequence: SUCCESS (2.512s)
[851.737199] [121/131] (227s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[853.741251] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[853.743101] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[853.940158] [122/131] (225s left) gem_render_copy (y-tiled-ccs-to-linear)
[854.002620] Starting subtest: y-tiled-ccs-to-linear
[854.003533] Starting dynamic subtest: smem
[854.085258] Dynamic subtest smem: SUCCESS (0.083s)
[854.099778] Starting dynamic subtest: lmem0
[854.392037] Dynamic subtest lmem0: SUCCESS (0.302s)
[854.393320] Subtest y-tiled-ccs-to-linear: SUCCESS (0.388s)
[854.660011] [123/131] (224s left) sysfs_defaults (readonly)
[854.714470] Starting subtest: readonly
[854.717057] Starting dynamic subtest: vecs0
[854.718051] Dynamic subtest vecs0: SUCCESS (0.000s)
[854.731262] Starting dynamic subtest: vcs0
[854.732513] Dynamic subtest vcs0: SUCCESS (0.000s)
[854.745367] Starting dynamic subtest: bcs0
[854.746657] Dynamic subtest bcs0: SUCCESS (0.000s)
[854.759307] Starting dynamic subtest: rcs0
[854.760598] Dynamic subtest rcs0: SUCCESS (0.000s)
[854.773482] Starting dynamic subtest: vcs1
[854.774733] Dynamic subtest vcs1: SUCCESS (0.000s)
[854.775949] Subtest readonly: SUCCESS (0.010s)
[854.853998] [124/131] (224s left) kms_joiner (basic-max-non-joiner)
[856.854282] Starting subtest: basic-max-non-joiner
[856.856169] Subtest basic-max-non-joiner: SKIP (0.000s)
[857.015340] [125/131] (222s left) gem_wait (write-busy)
[857.095261] Starting subtest: write-busy
[857.096254] Starting dynamic subtest: all-engines
[857.681350] Dynamic subtest all-engines: SUCCESS (0.585s)
[857.698126] Starting dynamic subtest: rcs0
[858.226907] Dynamic subtest rcs0: SUCCESS (0.544s)
[858.241294] Starting dynamic subtest: bcs0
[858.769929] Dynamic subtest bcs0: SUCCESS (0.542s)
[858.784380] Starting dynamic subtest: vcs0
[859.311867] Dynamic subtest vcs0: SUCCESS (0.541s)
[859.326461] Starting dynamic subtest: vcs1
[859.854892] Dynamic subtest vcs1: SUCCESS (0.542s)
[859.869319] Starting dynamic subtest: vecs0
[860.396925] Dynamic subtest vecs0: SUCCESS (0.541s)
[860.397933] Subtest write-busy: SUCCESS (3.302s)
[860.676316] [126/131] (218s left) gem_fence_thrash (bo-write-verify-y)
[860.725736] Starting subtest: bo-write-verify-y
[860.728451] Subtest bo-write-verify-y: SKIP (0.002s)
[860.797431] [127/131] (218s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-render)
[862.799828] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-render
[865.706156] Subtest fbc-1p-primscrn-pri-indfb-draw-render: SUCCESS (2.905s)
[865.899240] [128/131] (213s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt)
[867.925461] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt
[867.927294] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[868.148271] [129/131] (211s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt)
[870.152043] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt
[873.455205] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (3.302s)
[873.668329] [130/131] (206s left) gem_create (create-ext-placement-all)
[873.838148] Starting subtest: create-ext-placement-all
[873.839265] Subtest create-ext-placement-all: SUCCESS (0.000s)
[874.024515] [131/131] (205s left) kms_frontbuffer_tracking (fbc-2p-rte)
[876.025410] Starting subtest: fbc-2p-rte
[876.027097] Subtest fbc-2p-rte: SKIP (0.000s)
[876.253175] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: gem_spin_batch
results: parsing output: 2/ for test: kms_flip_scaled_crc
results: parsing output: 3/ for test: gem_exec_fence
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_flip
results: parsing output: 6/ for test: syncobj_wait
results: parsing output: 7/ for test: gem_ctx_shared
results: parsing output: 8/ for test: gem_userptr_blits
results: parsing output: 9/ for test: kms_ccs
results: parsing output: 10/ for test: perf
results: parsing output: 11/ for test: gem_exec_balancer
results: parsing output: 12/ for test: kms_cursor_crc
results: parsing output: 13/ for test: kms_setmode
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_setmode
results: parsing output: 16/ for test: i915_hangman
results: parsing output: 17/ for test: kms_vblank
results: parsing output: 18/ for test: kms_rotation_crc
results: parsing output: 19/ for test: gem_exec_schedule
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: gem_exec_reloc
results: parsing output: 23/ for test: kms_cursor_crc
results: parsing output: 24/ for test: gem_pxp
results: parsing output: 25/ for test: syncobj_timeline
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: kms_plane_multiple
results: parsing output: 28/ for test: gem_lmem_swapping
results: parsing output: 29/ for test: gem_exec_whisper
results: parsing output: 30/ for test: vgem_basic
results: parsing output: 31/ for test: gem_exec_params
results: parsing output: 32/ for test: perf_pmu
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_prime
results: parsing output: 35/ for test: kms_lease
results: parsing output: 36/ for test: kms_psr2_sf
results: parsing output: 37/ for test: kms_busy
results: parsing output: 38/ for test: kms_psr
results: parsing output: 39/ for test: prime_self_import
results: parsing output: 40/ for test: kms_ccs
results: parsing output: 41/ for test: kms_flip_scaled_crc
results: parsing output: 42/ for test: device_reset
results: parsing output: 43/ for test: gem_exec_schedule
results: parsing output: 44/ for test: kms_plane_scaling
results: parsing output: 45/ for test: kms_chamelium_color
results: parsing output: 46/ for test: kms_addfb_basic
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_mmap_offset
results: parsing output: 49/ for test: gem_exec_params
results: parsing output: 50/ for test: sysfs_preempt_timeout
results: parsing output: 51/ for test: kms_ccs
results: parsing output: 52/ for test: kms_chamelium_hpd
results: parsing output: 53/ for test: gem_softpin
results: parsing output: 54/ for test: kms_psr
results: parsing output: 55/ for test: gem_exec_reloc
results: parsing output: 56/ for test: kms_cursor_legacy
results: parsing output: 57/ for test: kms_draw_crc
results: parsing output: 58/ for test: perf_pmu
results: parsing output: 59/ for test: kms_big_fb
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: gem_partial_pwrite_pread
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_pm_rpm
results: parsing output: 64/ for test: api_intel_allocator
results: parsing output: 65/ for test: kms_feature_discovery
results: parsing output: 66/ for test: i915_pm_rpm
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: kms_rotation_crc
results: parsing output: 69/ for test: gem_exec_reloc
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: sw_sync
results: parsing output: 72/ for test: gen9_exec_parse
results: parsing output: 73/ for test: gem_lmem_swapping
results: parsing output: 74/ for test: gem_exec_parallel
results: parsing output: 75/ for test: gem_exec_reloc
results: parsing output: 76/ for test: gem_mmap_gtt
results: parsing output: 77/ for test: kms_setmode
results: parsing output: 78/ for test: kms_psr2_sf
results: parsing output: 79/ for test: kms_big_fb
results: parsing output: 80/ for test: gem_userptr_blits
results: parsing output: 81/ for test: kms_chamelium_hpd
results: parsing output: 82/ for test: i915_query
results: parsing output: 83/ for test: syncobj_timeline
results: parsing output: 84/ for test: kms_plane_scaling
results: parsing output: 85/ for test: kms_cursor_crc
results: parsing output: 86/ for test: gem_render_copy
results: parsing output: 87/ for test: kms_addfb_basic
results: parsing output: 88/ for test: gem_eio
results: parsing output: 89/ for test: syncobj_timeline
results: parsing output: 90/ for test: syncobj_timeline
results: parsing output: 91/ for test: gem_exec_reloc
results: parsing output: 92/ for test: kms_big_fb
results: parsing output: 93/ for test: gem_ppgtt
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: kms_selftest
results: parsing output: 97/ for test: gem_exec_reloc
results: parsing output: 98/ for test: kms_content_protection
results: parsing output: 99/ for test: kms_ccs
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_psr
results: parsing output: 102/ for test: kms_cursor_legacy
results: parsing output: 103/ for test: kms_vblank
results: parsing output: 104/ for test: kms_psr
results: parsing output: 105/ for test: kms_big_fb
results: parsing output: 106/ for test: gem_exec_balancer
results: parsing output: 107/ for test: syncobj_eventfd
results: parsing output: 108/ for test: kms_flip
results: parsing output: 109/ for test: gem_ctx_persistence
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_psr
results: parsing output: 112/ for test: core_getversion
results: parsing output: 113/ for test: kms_ccs
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_flip
results: parsing output: 117/ for test: drm_fdinfo
results: parsing output: 118/ for test: gem_barrier_race
results: parsing output: 119/ for test: kms_pipe_crc_basic
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_render_copy
results: parsing output: 122/ for test: sysfs_defaults
results: parsing output: 123/ for test: kms_joiner
results: parsing output: 124/ for test: gem_wait
results: parsing output: 125/ for test: gem_fence_thrash
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: gem_create
results: parsing output: 130/ for test: kms_frontbuffer_tracking
Done.