[42.031468] Initializing watchdogs
[42.031531]   /dev/watchdog0
[42.046711] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:9a49 Intel Tigerlake (Gen12) TigerLake-LP GT2 [Iris Xe Graphics]
[42.052740] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[42.055483] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[42.057272] [001/133] (960s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[42.100905] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[42.135656] [002/133] (960s left) prime_mmap (test_userptr)
[42.169182] Starting subtest: test_userptr
[42.169892] Starting dynamic subtest: test_userptr-smem
[42.170574] Dynamic subtest test_userptr-smem: SUCCESS (0.000s)
[42.171272] Subtest test_userptr: SUCCESS (0.001s)
[42.261027] [003/133] (960s left) kms_big_fb (yf-tiled-64bpp-rotate-270)
[42.359741] Starting subtest: yf-tiled-64bpp-rotate-270
[42.361072] Subtest yf-tiled-64bpp-rotate-270: SKIP (0.001s)
[42.429187] [004/133] (960s left) gem_exec_schedule (noreorder)
[42.596661] Starting subtest: noreorder
[42.597634] Starting dynamic subtest: rcs0
[42.647588] Dynamic subtest rcs0: SUCCESS (0.050s)
[42.662081] Starting dynamic subtest: bcs0
[42.714665] Dynamic subtest bcs0: SUCCESS (0.066s)
[42.727937] Starting dynamic subtest: vcs0
[42.773571] Dynamic subtest vcs0: SUCCESS (0.058s)
[42.788946] Starting dynamic subtest: vcs1
[42.828697] Dynamic subtest vcs1: SUCCESS (0.054s)
[42.845409] Starting dynamic subtest: vecs0
[42.879809] Dynamic subtest vecs0: SUCCESS (0.050s)
[42.880976] Subtest noreorder: SUCCESS (0.283s)
[43.051010] [005/133] (959s left) syncobj_eventfd (binary-wait-signaled)
[43.086105] Starting subtest: binary-wait-signaled
[43.086795] Subtest binary-wait-signaled: SUCCESS (0.000s)
[43.142706] [006/133] (959s left) gem_mmap_gtt (basic-read-write-distinct)
[43.175605] Starting subtest: basic-read-write-distinct
[43.179926] Subtest basic-read-write-distinct: SUCCESS (0.005s)
[43.267650] [007/133] (959s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-move)
[43.355834] Starting subtest: fbc-2p-scndscrn-cur-indfb-move
[43.357264] Subtest fbc-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[43.451859] [008/133] (959s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-downscaling)
[43.536502] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-downscaling
[43.537969] Starting dynamic subtest: pipe-A-valid-mode
[44.698319] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.160s)
[44.699036] Subtest flip-64bpp-xtile-to-16bpp-xtile-downscaling: SUCCESS (1.162s)
[44.841070] [009/133] (958s left) sw_sync (alloc_timeline)
[44.876435] Starting subtest: alloc_timeline
[44.877146] Subtest alloc_timeline: SUCCESS (0.000s)
[44.920872] [010/133] (957s left) kms_prime (d3hot)
[45.015468] Subtest D3hot: SKIP (0.000s)
[45.125083] [FACT kms_prime (d3hot)] new: kernel.kmod_is_loaded.vgem: true
[45.126500] [011/133] (957s left) gem_exec_schedule (u-submit-early-slice)
[45.171995] Starting subtest: u-submit-early-slice
[45.172769] Starting dynamic subtest: rcs0
[45.202635] Dynamic subtest rcs0: SUCCESS (0.030s)
[45.208178] Starting dynamic subtest: bcs0
[45.229031] Dynamic subtest bcs0: SUCCESS (0.026s)
[45.235067] Starting dynamic subtest: vcs0
[45.260108] Dynamic subtest vcs0: SUCCESS (0.031s)
[45.265892] Starting dynamic subtest: vcs1
[45.288832] Dynamic subtest vcs1: SUCCESS (0.028s)
[45.294601] Starting dynamic subtest: vecs0
[45.315331] Dynamic subtest vecs0: SUCCESS (0.026s)
[45.316102] Subtest u-submit-early-slice: SUCCESS (0.143s)
[45.621304] [012/133] (957s left) kms_plane_scaling (plane-downscale-factor-0-75-with-pixel-format)
[45.704597] Starting subtest: plane-downscale-factor-0-75-with-pixel-format
[45.705324] Starting dynamic subtest: pipe-A
[46.995151] Dynamic subtest pipe-A: SUCCESS (1.291s)
[47.001661] Starting dynamic subtest: pipe-B
[48.246876] Dynamic subtest pipe-B: SUCCESS (1.250s)
[48.256034] Starting dynamic subtest: pipe-C
[48.445336] Dynamic subtest pipe-C: SUCCESS (0.199s)
[48.451645] Starting dynamic subtest: pipe-D
[48.646146] Dynamic subtest pipe-D: SUCCESS (0.201s)
[48.646928] Subtest plane-downscale-factor-0-75-with-pixel-format: SUCCESS (2.942s)
[48.822246] [013/133] (954s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset)
[48.914345] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset
[48.923122] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset: SKIP (0.009s)
[48.987905] [014/133] (954s left) kms_flip (2x-flip-vs-dpms-on-nop)
[49.072306] Starting subtest: 2x-flip-vs-dpms-on-nop
[49.081289] Subtest 2x-flip-vs-dpms-on-nop: SKIP (0.009s)
[49.176836] [015/133] (953s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[49.264450] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[49.265779] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[49.367659] [016/133] (953s left) kms_vblank (wait-idle-hang)
[49.451473] Starting subtest: wait-idle-hang
[49.452250] Starting dynamic subtest: pipe-A-HDMI-A-1
[63.632932] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (14.180s)
[63.641814] Starting dynamic subtest: pipe-D-HDMI-A-1
[77.455872] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (13.820s)
[77.457386] Subtest wait-idle-hang: SUCCESS (28.006s)
[77.623425] [017/133] (925s left) gem_exec_schedule (fifo)
[77.668968] Starting subtest: fifo
[77.669732] Starting dynamic subtest: rcs0
[77.730109] Dynamic subtest rcs0: SUCCESS (0.060s)
[77.739775] Starting dynamic subtest: bcs0
[77.795217] Dynamic subtest bcs0: SUCCESS (0.064s)
[77.805273] Starting dynamic subtest: vcs0
[77.858799] Dynamic subtest vcs0: SUCCESS (0.063s)
[77.868823] Starting dynamic subtest: vcs1
[77.921894] Dynamic subtest vcs1: SUCCESS (0.062s)
[77.932114] Starting dynamic subtest: vecs0
[77.986229] Dynamic subtest vecs0: SUCCESS (0.064s)
[77.987314] Subtest fifo: SUCCESS (0.317s)
[78.284330] [018/133] (924s left) gem_mmap (bad-offset)
[78.317202] Starting subtest: bad-offset
[78.317888] Subtest bad-offset: SUCCESS (0.000s)
[78.394750] [019/133] (924s left) syncobj_wait (wait-any-snapshot)
[78.429035] Starting subtest: wait-any-snapshot
[78.511157] Subtest wait-any-snapshot: SUCCESS (0.082s)
[78.582372] [020/133] (924s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[78.673465] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt
[78.674846] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[78.783847] [021/133] (924s left) sw_sync (sync_merge)
[78.816357] Starting subtest: sync_merge
[78.817103] Subtest sync_merge: SUCCESS (0.000s)
[78.872663] [022/133] (924s left) kms_feature_discovery (display)
[78.956865] Starting subtest: display
[78.957646] Subtest display: SUCCESS (0.000s)
[79.009187] [023/133] (924s left) kms_flip (flip-vs-absolute-wf_vblank)
[79.095682] Starting subtest: flip-vs-absolute-wf_vblank
[79.098028] Starting dynamic subtest: A-HDMI-A1
[86.951494] Dynamic subtest A-HDMI-A1: SUCCESS (7.830s)
[86.957220] Starting dynamic subtest: B-HDMI-A1
[94.765558] Dynamic subtest B-HDMI-A1: SUCCESS (7.801s)
[94.770997] Starting dynamic subtest: C-HDMI-A1
[102.574535] Dynamic subtest C-HDMI-A1: SUCCESS (7.807s)
[102.580889] Starting dynamic subtest: D-HDMI-A1
[110.345656] Dynamic subtest D-HDMI-A1: SUCCESS (7.792s)
[110.346337] Subtest flip-vs-absolute-wf_vblank: SUCCESS (31.240s)
[110.490348] [024/133] (892s left) kms_cursor_crc (cursor-rapid-movement-max-size)
[110.590696] Starting subtest: cursor-rapid-movement-max-size
[110.592704] Subtest cursor-rapid-movement-max-size: SKIP (0.000s)
[110.676529] [025/133] (892s left) gem_exec_fence (syncobj-export)
[111.007472] Starting subtest: syncobj-export
[111.009880] Subtest syncobj-export: SUCCESS (0.002s)
[111.309303] [026/133] (892s left) gem_exec_reloc (basic-cpu-gtt-active)
[111.346490] Starting subtest: basic-cpu-gtt-active
[111.476535] Subtest basic-cpu-gtt-active: SUCCESS (0.121s)
[111.583497] [027/133] (891s left) kms_big_fb (x-tiled-16bpp-rotate-270)
[111.678061] Starting subtest: x-tiled-16bpp-rotate-270
[111.756299] Subtest x-tiled-16bpp-rotate-270: SKIP (0.077s)
[111.896806] [028/133] (891s left) kms_big_fb (4-tiled-addfb-size-offset-overflow)
[111.991263] Starting subtest: 4-tiled-addfb-size-offset-overflow
[111.992735] Subtest 4-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[112.058397] [029/133] (891s left) gem_ctx_shared (q-out-order)
[112.100744] Starting subtest: Q-out-order
[112.101449] Starting dynamic subtest: rcs0
[112.147999] Dynamic subtest rcs0: SUCCESS (0.048s)
[112.156277] Starting dynamic subtest: bcs0
[112.197825] Dynamic subtest bcs0: SUCCESS (0.049s)
[112.207494] Starting dynamic subtest: vcs0
[112.249597] Dynamic subtest vcs0: SUCCESS (0.050s)
[112.259173] Starting dynamic subtest: vcs1
[112.301288] Dynamic subtest vcs1: SUCCESS (0.051s)
[112.312076] Starting dynamic subtest: vecs0
[112.352202] Dynamic subtest vecs0: SUCCESS (0.049s)
[112.353355] Subtest Q-out-order: SUCCESS (0.253s)
[112.542615] [030/133] (891s left) gem_exec_balancer (sliced)
[112.584790] Starting subtest: sliced
[114.033440] Subtest sliced: SUCCESS (1.439s)
[114.223055] [031/133] (889s left) gem_ctx_persistence (heartbeat-hang)
[114.259122] Starting subtest: heartbeat-hang
[115.757739] Subtest heartbeat-hang: SUCCESS (1.498s)
[115.827536] [032/133] (887s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render)
[115.917544] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render
[115.918910] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[116.001210] [033/133] (887s left) i915_pm_rpm (gem-mmap-type)
[117.396475] Starting subtest: gem-mmap-type
[117.397732] Starting dynamic subtest: gtt-smem0
[123.626940] Dynamic subtest gtt-smem0: SUCCESS (6.231s)
[123.633460] Starting dynamic subtest: wb-smem0
[126.178099] Dynamic subtest wb-smem0: SUCCESS (2.547s)
[126.206511] Starting dynamic subtest: wc-smem0
[128.769081] Dynamic subtest wc-smem0: SUCCESS (2.569s)
[128.778867] Starting dynamic subtest: uc-smem0
[131.299275] Dynamic subtest uc-smem0: SUCCESS (2.554s)
[131.299995] Subtest gem-mmap-type: SUCCESS (13.904s)
[131.412894] [034/133] (872s left) prime_vgem (basic-read)
[131.472035] Starting subtest: basic-read
[131.494623] Subtest basic-read: SUCCESS (0.022s)
[131.586358] [035/133] (872s left) gem_exec_balancer (bonded-sync)
[131.629106] Starting subtest: bonded-sync
[146.381158] Subtest bonded-sync: SUCCESS (14.743s)
[146.556274] [036/133] (857s left) gem_wait (invalid-buf)
[146.592697] Starting subtest: invalid-buf
[146.593425] Subtest invalid-buf: SUCCESS (0.000s)
[146.806351] [037/133] (857s left) kms_plane (pixel-format-4-tiled-modifier)
[146.892544] Starting subtest: pixel-format-4-tiled-modifier
[146.893885] Subtest pixel-format-4-tiled-modifier: SKIP (0.000s)
[146.953852] [038/133] (857s left) gem_userptr_blits (sync-overlap)
[146.998794] Starting subtest: sync-overlap
[146.999552] Subtest sync-overlap: SUCCESS (0.000s)
[147.100046] [039/133] (856s left) kms_universal_plane (cursor-fb-leak)
[147.185703] Starting subtest: cursor-fb-leak
[147.186392] Starting dynamic subtest: pipe-A-HDMI-A-1
[147.395201] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.208s)
[147.409557] Starting dynamic subtest: pipe-B-HDMI-A-1
[147.662088] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.263s)
[147.669760] Starting dynamic subtest: pipe-C-HDMI-A-1
[147.940857] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.277s)
[147.957789] Starting dynamic subtest: pipe-D-HDMI-A-1
[148.221535] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.277s)
[148.222261] Subtest cursor-fb-leak: SUCCESS (1.037s)
[148.367746] [040/133] (855s left) syncobj_wait (wait-all-delayed-signal)
[148.403204] Starting subtest: wait-all-delayed-signal
[148.504476] Subtest wait-all-delayed-signal: SUCCESS (0.101s)
[148.579680] [041/133] (855s left) gem_render_copy (linear-to-vebox-yf-tiled)
[148.620180] Starting subtest: linear-to-vebox-yf-tiled
[148.620891] Starting dynamic subtest: smem
[148.687636] Dynamic subtest smem: SUCCESS (0.067s)
[148.688354] Subtest linear-to-vebox-yf-tiled: SUCCESS (0.068s)
[148.870515] [042/133] (855s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc)
[148.957551] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc
[148.958231] Starting dynamic subtest: pipe-A-HDMI-A-1
[148.964636] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[148.970907] Starting dynamic subtest: pipe-B-HDMI-A-1
[148.977280] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[148.983485] Starting dynamic subtest: pipe-C-HDMI-A-1
[148.989864] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[148.995877] Starting dynamic subtest: pipe-D-HDMI-A-1
[149.002445] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s)
[149.003725] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.008s)
[149.202729] [043/133] (854s left) gem_softpin (evict-active-interruptible)
[149.245608] Starting subtest: evict-active-interruptible
[149.250510] Subtest evict-active-interruptible: SUCCESS (0.005s)
[149.363403] [044/133] (854s left) gem_partial_pwrite_pread (writes-after-reads)
[149.399685] Starting subtest: writes-after-reads
[161.723159] Subtest writes-after-reads: SUCCESS (12.323s)
[161.828429] [045/133] (842s left) kms_cursor_legacy (cursora-vs-flipb-atomic)
[161.915748] Starting subtest: cursorA-vs-flipB-atomic
[161.917160] Subtest cursorA-vs-flipB-atomic: SKIP (0.001s)
[161.978085] [046/133] (842s left) gen7_exec_parse (basic-allowed)
[162.015245] Subtest basic-allowed: SKIP (0.000s)
[162.056767] [047/133] (842s left) kms_chamelium_frames (hdmi-crc-fast)
[162.191957] Subtest hdmi-crc-fast: SKIP (0.000s)
[162.285574] [048/133] (842s left) kms_chamelium_frames (vga-frame-dump)
[162.428357] Subtest vga-frame-dump: SKIP (0.000s)
[162.529367] [049/133] (841s left) gem_caching (reads)
[162.568485] Starting subtest: reads
[164.495676] Subtest reads: SUCCESS (1.927s)
[164.591875] [050/133] (839s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[164.627403] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[164.628102] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[164.691673] [051/133] (839s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[164.780164] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[164.782152] Starting dynamic subtest: pipe-A-HDMI-A-1
[164.789263] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[164.798229] Starting dynamic subtest: pipe-B-HDMI-A-1
[164.805228] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[164.813890] Starting dynamic subtest: pipe-C-HDMI-A-1
[164.820859] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[164.828837] Starting dynamic subtest: pipe-D-HDMI-A-1
[164.835687] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[164.837013] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SKIP (0.007s)
[165.018341] [052/133] (839s left) kms_async_flips (invalid-async-flip-atomic)
[165.104963] Starting subtest: invalid-async-flip-atomic
[165.217940] Starting dynamic subtest: pipe-A-HDMI-A-1
[165.348897] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.131s)
[165.471123] Starting dynamic subtest: pipe-B-HDMI-A-1
[165.565895] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.100s)
[165.718912] Starting dynamic subtest: pipe-C-HDMI-A-1
[165.813124] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.102s)
[165.933586] Starting dynamic subtest: pipe-D-HDMI-A-1
[166.020049] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.092s)
[166.020847] Subtest invalid-async-flip-atomic: SUCCESS (0.916s)
[166.236208] [053/133] (838s left) gem_render_copy (y-tiled-to-vebox-yf-tiled)
[166.276772] Starting subtest: y-tiled-to-vebox-yf-tiled
[166.277499] Starting dynamic subtest: smem
[166.343870] Dynamic subtest smem: SUCCESS (0.067s)
[166.344619] Subtest y-tiled-to-vebox-yf-tiled: SUCCESS (0.068s)
[166.521684] [054/133] (838s left) gem_create (create-ext-set-pat)
[166.678361] Starting subtest: create-ext-set-pat
[166.680345] Subtest create-ext-set-pat: SKIP (0.000s)
[166.737431] [055/133] (837s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[166.833295] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip
[167.409898] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (0.576s)
[167.529961] [056/133] (837s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted)
[167.564175] Starting subtest: etime-multi-wait-for-submit-unsubmitted
[167.671944] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.107s)
[167.747761] [057/133] (837s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[167.840112] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc
[167.841495] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[167.934441] [058/133] (836s left) gem_pread (self)
[167.968202] Starting subtest: self
[167.973548] Subtest self: SUCCESS (0.006s)
[168.063034] [059/133] (836s left) gem_exec_reloc (basic-softpin)
[168.100631] Starting subtest: basic-softpin
[168.102420] Subtest basic-softpin: SUCCESS (0.002s)
[168.213705] [060/133] (836s left) prime_vgem (fence-read-hang)
[168.292064] Subtest fence-read-hang: SKIP (0.000s)
[168.391988] [061/133] (836s left) kms_plane_alpha_blend (alpha-transparent-fb)
[168.477069] Starting subtest: alpha-transparent-fb
[168.542765] Starting dynamic subtest: pipe-A-HDMI-A-1
[168.818165] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.274s)
[168.826038] Starting dynamic subtest: pipe-D-HDMI-A-1
[169.158732] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.339s)
[169.159473] Subtest alpha-transparent-fb: SUCCESS (0.682s)
[169.322562] [062/133] (835s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[169.412961] Starting subtest: fbc-rgb565-draw-pwrite
[170.777069] Subtest fbc-rgb565-draw-pwrite: SUCCESS (1.364s)
[170.900646] [063/133] (834s left) kms_joiner (basic-max-non-joiner)
[170.991474] Starting subtest: basic-max-non-joiner
[170.992911] Subtest basic-max-non-joiner: SKIP (0.000s)
[171.043936] [064/133] (833s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[171.131541] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[171.132287] Starting dynamic subtest: pipe-A-HDMI-A-1
[171.139168] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[171.148088] Starting dynamic subtest: pipe-B-HDMI-A-1
[171.154883] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[171.163612] Starting dynamic subtest: pipe-C-HDMI-A-1
[171.170350] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[171.178928] Starting dynamic subtest: pipe-D-HDMI-A-1
[171.185655] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[171.186983] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SKIP (0.008s)
[171.372623] [065/133] (833s left) kms_cursor_edge_walk (256x256-top-edge)
[171.458090] Starting subtest: 256x256-top-edge
[171.458978] Starting dynamic subtest: pipe-A-HDMI-A-1
[173.219755] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.760s)
[173.230914] Starting dynamic subtest: pipe-D-HDMI-A-1
[174.912396] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.690s)
[174.913096] Subtest 256x256-top-edge: SUCCESS (3.455s)
[175.019711] [066/133] (830s left) kms_content_protection (atomic-dpms-hdcp14)
[175.115303] Starting subtest: atomic-dpms-hdcp14
[175.120904] Subtest atomic-dpms-hdcp14: SKIP (0.003s)
[175.218749] [067/133] (829s left) perf_pmu (gt-awake)
[175.255752] Starting subtest: gt-awake
[178.294549] Subtest gt-awake: SUCCESS (3.030s)
[178.372779] [068/133] (826s left) kms_getfb (getfb2-handle-not-fb)
[178.460013] Starting subtest: getfb2-handle-not-fb
[178.460760] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[178.558907] [069/133] (826s left) gen9_exec_parse (batch-invalid-length)
[178.596042] Subtest batch-invalid-length: SKIP (0.000s)
[178.637755] [070/133] (826s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format)
[178.721981] Starting subtest: plane-upscale-20x20-with-pixel-format
[178.722681] Starting dynamic subtest: pipe-A
[179.840340] Dynamic subtest pipe-A: SUCCESS (1.119s)
[179.850319] Starting dynamic subtest: pipe-B
[181.009755] Dynamic subtest pipe-B: SUCCESS (1.167s)
[181.018089] Starting dynamic subtest: pipe-C
[181.210272] Dynamic subtest pipe-C: SUCCESS (0.201s)
[181.218516] Starting dynamic subtest: pipe-D
[181.412107] Dynamic subtest pipe-D: SUCCESS (0.201s)
[181.412825] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (2.691s)
[181.581053] [071/133] (823s left) kms_rotation_crc (primary-rotation-180)
[181.670907] Starting subtest: primary-rotation-180
[185.240809] Subtest primary-rotation-180: SUCCESS (3.570s)
[185.423632] [072/133] (819s left) kms_big_fb (yf-tiled-32bpp-rotate-0)
[185.523225] Starting subtest: yf-tiled-32bpp-rotate-0
[185.524609] Subtest yf-tiled-32bpp-rotate-0: SKIP (0.000s)
[185.617016] [073/133] (819s left) device_reset (unbind-cold-reset-rebind)
[185.664693] Starting subtest: unbind-cold-reset-rebind
[185.666139] Subtest unbind-cold-reset-rebind: SKIP (0.000s)
[185.725580] [074/133] (819s left) kms_psr (psr2-no-drrs)
[185.810654] Subtest psr2-no-drrs: SKIP (0.000s)
[185.852437] [075/133] (819s left) gem_fence_thrash (bo-write-verify-threaded-y)
[185.884449] Starting subtest: bo-write-verify-threaded-y
[190.275213] Subtest bo-write-verify-threaded-y: SUCCESS (4.357s)
[190.354822] [076/133] (815s left) kms_lease (master-vs-lease)
[190.442412] Starting subtest: master-vs-lease
[190.443171] Subtest master-vs-lease: SUCCESS (0.001s)
[190.506164] [077/133] (815s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-render)
[190.595789] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-render
[190.597167] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[190.684888] [078/133] (814s left) kms_big_fb (linear-8bpp-rotate-270)
[190.779364] Starting subtest: linear-8bpp-rotate-270
[190.853380] Subtest linear-8bpp-rotate-270: SKIP (0.073s)
[190.955883] [079/133] (814s left) kms_cursor_crc (cursor-offscreen-512x170)
[191.047743] Starting subtest: cursor-offscreen-512x170
[191.049232] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[191.139275] [080/133] (814s left) gem_exec_reloc (basic-write-wc-active)
[191.178703] Starting subtest: basic-write-wc-active
[191.309709] Subtest basic-write-wc-active: SUCCESS (0.122s)
[191.423352] [081/133] (814s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[191.511764] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[191.513234] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[191.618899] [082/133] (814s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-blt)
[191.707740] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-blt
[191.709074] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[191.799691] [083/133] (813s left) kms_rotation_crc (primary-4-tiled-reflect-x-0)
[191.885087] Starting subtest: primary-4-tiled-reflect-x-0
[191.938724] Subtest primary-4-tiled-reflect-x-0: SKIP (0.054s)
[192.019827] [084/133] (813s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[192.110319] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[193.305475] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (1.196s)
[193.434132] [085/133] (812s left) prime_mmap_coherency (ioctl-errors)
[193.471239] Starting subtest: ioctl-errors
[198.322984] Subtest ioctl-errors: SUCCESS (4.851s)
[198.581414] [086/133] (807s left) kms_pm_dc (dc5-dpms)
[199.748741] Starting subtest: dc5-dpms
[201.077897] Subtest dc5-dpms: SUCCESS (1.320s)
[201.141665] [087/133] (804s left) gem_busy (extended)
[201.321087] Starting subtest: extended
[201.322064] Starting dynamic subtest: rcs0
[201.347544] Dynamic subtest rcs0: SUCCESS (0.034s)
[201.361419] Starting dynamic subtest: bcs0
[201.369072] Dynamic subtest bcs0: SUCCESS (0.020s)
[201.382067] Starting dynamic subtest: vcs0
[201.391159] Dynamic subtest vcs0: SUCCESS (0.020s)
[201.407060] Starting dynamic subtest: vcs1
[201.413797] Dynamic subtest vcs1: SUCCESS (0.020s)
[201.424457] Starting dynamic subtest: vecs0
[201.436098] Dynamic subtest vecs0: SUCCESS (0.021s)
[201.438752] Subtest extended: SUCCESS (0.125s)
[201.665626] [088/133] (804s left) kms_cursor_legacy (torture-move)
[201.757531] Starting subtest: torture-move
[201.758289] Starting dynamic subtest: pipe-A
[207.315818] Dynamic subtest pipe-A: SUCCESS (5.524s)
[207.325136] Starting dynamic subtest: pipe-B
[212.783751] Dynamic subtest pipe-B: SUCCESS (5.492s)
[212.793040] Starting dynamic subtest: pipe-C
[218.287555] Dynamic subtest pipe-C: SUCCESS (5.478s)
[218.297703] Starting dynamic subtest: pipe-D
[223.739979] Dynamic subtest pipe-D: SUCCESS (5.485s)
[223.748436] Starting dynamic subtest: all-pipes
[229.263168] Dynamic subtest all-pipes: SUCCESS (5.487s)
[229.264430] Subtest torture-move: SUCCESS (27.471s)
[229.343712] [089/133] (776s left) prime_mmap (test_refcounting)
[229.378449] Starting subtest: test_refcounting
[229.379143] Starting dynamic subtest: test_refcounting-smem
[229.380871] Dynamic subtest test_refcounting-smem: SUCCESS (0.002s)
[229.381544] Subtest test_refcounting: SUCCESS (0.003s)
[229.467861] [090/133] (776s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[229.557145] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[229.600857] [091/133] (776s left) syncobj_timeline (invalid-signal-zero-handles)
[229.635697] Starting subtest: invalid-signal-zero-handles
[229.636441] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[229.727545] [092/133] (776s left) kms_big_fb (y-tiled-addfb)
[229.824016] Starting subtest: y-tiled-addfb
[229.824739] Subtest y-tiled-addfb: SUCCESS (0.000s)
[229.913411] [093/133] (776s left) i915_drm_fdinfo (busy)
[229.949430] Starting subtest: busy
[229.950131] Starting dynamic subtest: rcs0
[230.471354] Dynamic subtest rcs0: SUCCESS (0.521s)
[230.485047] Starting dynamic subtest: bcs0
[231.000467] Dynamic subtest bcs0: SUCCESS (0.526s)
[231.011878] Starting dynamic subtest: vcs0
[231.523320] Dynamic subtest vcs0: SUCCESS (0.521s)
[231.535012] Starting dynamic subtest: vcs1
[232.045929] Dynamic subtest vcs1: SUCCESS (0.518s)
[232.057673] Starting dynamic subtest: vecs0
[232.572338] Dynamic subtest vecs0: SUCCESS (0.526s)
[232.575593] Subtest busy: SUCCESS (2.624s)
[232.650485] [094/133] (773s left) i915_drm_fdinfo (virtual-busy-idle-all)
[232.686438] Starting subtest: virtual-busy-idle-all
[233.305874] Subtest virtual-busy-idle-all: SUCCESS (0.617s)
[233.371509] [095/133] (772s left) gem_close (many-handles-one-vma)
[233.408142] Starting subtest: many-handles-one-vma
[233.432049] Subtest many-handles-one-vma: SUCCESS (0.024s)
[233.531758] [096/133] (772s left) api_intel_bb (reset-bb)
[233.565860] Starting subtest: reset-bb
[233.567850] Subtest reset-bb: SUCCESS (0.003s)
[233.684287] [097/133] (772s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[233.777348] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc
[233.778849] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[233.873772] [098/133] (772s left) prime_mmap (test_invalid_sync_flags)
[233.906736] Starting subtest: test_invalid_sync_flags
[233.907423] Starting dynamic subtest: test_invalid_sync_flags-smem
[233.908121] Dynamic subtest test_invalid_sync_flags-smem: SUCCESS (0.000s)
[233.908826] Subtest test_invalid_sync_flags: SUCCESS (0.001s)
[233.999263] [099/133] (772s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[234.086305] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[234.087078] Starting dynamic subtest: pipe-A-valid-mode
[234.863662] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.776s)
[234.864362] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SUCCESS (0.778s)
[235.016244] [100/133] (771s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions)
[235.106722] Starting subtest: flip-vs-cursor-atomic-transitions
[241.866954] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (6.760s)
[241.997796] [101/133] (764s left) kms_psr (fbc-psr2-cursor-render)
[242.089488] Subtest fbc-psr2-cursor-render: SKIP (0.000s)
[242.134248] [102/133] (764s left) kms_color_pipeline (plane-lut1d-ctm3x4)
[242.223922] Starting subtest: plane-lut1d-ctm3x4
[242.311622] Starting dynamic subtest: pipe-A-plane-0
[242.410614] Dynamic subtest pipe-A-plane-0: SUCCESS (0.099s)
[242.426878] Starting dynamic subtest: pipe-A-plane-1
[242.502374] Dynamic subtest pipe-A-plane-1: SUCCESS (0.089s)
[242.518427] Starting dynamic subtest: pipe-A-plane-2
[242.594096] Dynamic subtest pipe-A-plane-2: SUCCESS (0.089s)
[242.796763] Starting dynamic subtest: pipe-B-plane-0
[242.876617] Dynamic subtest pipe-B-plane-0: SUCCESS (0.083s)
[242.887783] Starting dynamic subtest: pipe-B-plane-1
[242.963924] Dynamic subtest pipe-B-plane-1: SUCCESS (0.089s)
[242.978691] Starting dynamic subtest: pipe-B-plane-2
[243.055908] Dynamic subtest pipe-B-plane-2: SUCCESS (0.089s)
[243.255190] Starting dynamic subtest: pipe-C-plane-0
[243.331649] Dynamic subtest pipe-C-plane-0: SUCCESS (0.083s)
[243.345960] Starting dynamic subtest: pipe-C-plane-1
[243.423811] Dynamic subtest pipe-C-plane-1: SUCCESS (0.089s)
[243.438347] Starting dynamic subtest: pipe-C-plane-2
[243.515028] Dynamic subtest pipe-C-plane-2: SUCCESS (0.089s)
[243.731092] Starting dynamic subtest: pipe-D-plane-0
[243.814498] Dynamic subtest pipe-D-plane-0: SUCCESS (0.091s)
[243.827894] Starting dynamic subtest: pipe-D-plane-1
[243.914634] Dynamic subtest pipe-D-plane-1: SUCCESS (0.098s)
[243.929686] Starting dynamic subtest: pipe-D-plane-2
[244.014615] Dynamic subtest pipe-D-plane-2: SUCCESS (0.098s)
[244.062797] Subtest plane-lut1d-ctm3x4: SUCCESS (1.839s)
[244.176125] [103/133] (762s left) gem_mmap_gtt (hang-busy)
[244.211698] Starting subtest: hang-busy
[280.194901] Subtest hang-busy: SUCCESS (35.984s)
[280.304634] [104/133] (726s left) kms_plane_lowres (tiling-none)
[280.394007] Starting subtest: tiling-none
[280.395870] Starting dynamic subtest: pipe-A-HDMI-A-1
[285.554776] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (5.160s)
[285.639873] Starting dynamic subtest: pipe-B-HDMI-A-1
[290.613060] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (4.983s)
[290.661806] Starting dynamic subtest: pipe-C-HDMI-A-1
[295.672760] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (5.018s)
[295.764839] Starting dynamic subtest: pipe-D-HDMI-A-1
[300.774148] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (5.018s)
[300.814215] Subtest tiling-none: SUCCESS (20.422s)
[300.969013] [105/133] (705s left) gem_ctx_isolation (nonpriv)
[301.021540] Starting subtest: nonpriv
[301.022273] Starting dynamic subtest: rcs0
[301.258993] Dynamic subtest rcs0: SUCCESS (0.231s)
[301.274437] Starting dynamic subtest: bcs0
[301.531255] Dynamic subtest bcs0: SUCCESS (0.271s)
[301.538796] Starting dynamic subtest: vcs0
[301.815092] Dynamic subtest vcs0: SUCCESS (0.280s)
[301.822736] Starting dynamic subtest: vcs1
[302.101352] Dynamic subtest vcs1: SUCCESS (0.284s)
[302.108715] Starting dynamic subtest: vecs0
[302.370768] Dynamic subtest vecs0: SUCCESS (0.270s)
[302.371506] Subtest nonpriv: SUCCESS (1.341s)
[302.547499] [106/133] (704s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[302.638803] Starting subtest: addfb25-x-tiled-mismatch-legacy
[302.639541] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s)
[302.733162] [107/133] (704s left) prime_busy (before)
[302.772081] Starting subtest: before
[302.777385] Starting dynamic subtest: rcs0
[302.805155] Dynamic subtest rcs0: SUCCESS (0.027s)
[302.817901] Starting dynamic subtest: bcs0
[302.832468] Dynamic subtest bcs0: SUCCESS (0.025s)
[302.848603] Starting dynamic subtest: vcs0
[302.851529] Dynamic subtest vcs0: SUCCESS (0.017s)
[302.862077] Starting dynamic subtest: vcs1
[302.865027] Dynamic subtest vcs1: SUCCESS (0.012s)
[302.873962] Starting dynamic subtest: vecs0
[302.880024] Dynamic subtest vecs0: SUCCESS (0.014s)
[302.989205] Subtest before: SUCCESS (0.216s)
[303.058688] [108/133] (703s left) kms_cdclk (plane-scaling)
[303.093726] Subtest plane-scaling: SKIP (0.000s)
[303.138128] [109/133] (703s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[303.228803] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[303.230141] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[303.317287] [110/133] (703s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[303.407897] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[303.409285] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[303.510708] [111/133] (703s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt)
[303.600799] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt
[303.602181] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[303.693908] [112/133] (703s left) gem_softpin (allocator-nopin-reserve)
[303.732142] Starting subtest: allocator-nopin-reserve
[303.822964] Subtest allocator-nopin-reserve: SUCCESS (0.090s)
[303.936571] [113/133] (703s left) perf (gen12-unprivileged-single-ctx-counters)
[304.029847] Starting subtest: gen12-unprivileged-single-ctx-counters
[304.030540] Starting dynamic subtest: rcs0
[304.132976] Dynamic subtest rcs0: SUCCESS (0.102s)
[304.133765] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.104s)
[304.174233] [114/133] (702s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-msflip-blt)
[304.265545] Starting subtest: psr-2p-primscrn-indfb-msflip-blt
[304.266867] Subtest psr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[304.359084] [115/133] (702s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[304.447301] Starting subtest: primary-x-tiled-reflect-x-180
[308.001897] Subtest primary-x-tiled-reflect-x-180: SUCCESS (3.555s)
[308.180137] [116/133] (698s left) sysfs_heartbeat_interval (mixed)
[308.223215] Starting subtest: mixed
[308.223937] Starting dynamic subtest: vecs0
[313.366234] Dynamic subtest vecs0: SUCCESS (5.143s)
[313.377205] Starting dynamic subtest: vcs0
[318.501576] Dynamic subtest vcs0: SUCCESS (5.132s)
[318.514113] Starting dynamic subtest: bcs0
[323.704392] Dynamic subtest bcs0: SUCCESS (5.200s)
[323.715721] Starting dynamic subtest: rcs0
[328.893472] Dynamic subtest rcs0: SUCCESS (5.187s)
[328.907759] Starting dynamic subtest: vcs1
[334.058403] Dynamic subtest vcs1: SUCCESS (5.162s)
[334.059492] Subtest mixed: SUCCESS (25.840s)
[334.130180] [117/133] (673s left) i915_selftest (live)
[335.052745] Starting subtest: live
[335.053676] Starting dynamic subtest: sanitycheck
[336.277688] Dynamic subtest sanitycheck: SUCCESS (1.216s)
[336.284881] Starting dynamic subtest: uncore
[337.460532] Dynamic subtest uncore: SUCCESS (1.181s)
[337.472953] Starting dynamic subtest: workarounds
[338.995444] Dynamic subtest workarounds: SUCCESS (1.533s)
[339.002188] Starting dynamic subtest: gt_engines
[340.735445] Dynamic subtest gt_engines: SUCCESS (1.738s)
[340.741853] Starting dynamic subtest: gt_timelines
[349.682589] Dynamic subtest gt_timelines: SUCCESS (8.945s)
[349.691600] Starting dynamic subtest: gt_contexts
[350.976580] Dynamic subtest gt_contexts: SUCCESS (1.292s)
[350.984017] Starting dynamic subtest: gt_lrc
[355.184678] Dynamic subtest gt_lrc: SUCCESS (4.206s)
[355.192352] Starting dynamic subtest: gt_mocs
[356.531677] Dynamic subtest gt_mocs: SUCCESS (1.345s)
[356.542627] Starting dynamic subtest: gt_pm
[377.934595] Dynamic subtest gt_pm: SUCCESS (21.402s)
[377.941720] Starting dynamic subtest: gt_heartbeat
[379.154659] Dynamic subtest gt_heartbeat: SUCCESS (1.218s)
[379.167033] Starting dynamic subtest: gt_tlb
[382.626504] Dynamic subtest gt_tlb: SUCCESS (3.470s)
[382.633484] Starting dynamic subtest: requests
[391.223605] Dynamic subtest requests: SUCCESS (8.595s)
[391.235111] Starting dynamic subtest: migrate
[395.516666] Dynamic subtest migrate: SUCCESS (4.291s)
[395.524274] Starting dynamic subtest: active
[396.726690] Dynamic subtest active: SUCCESS (1.208s)
[396.737483] Starting dynamic subtest: objects
[398.441477] Dynamic subtest objects: SUCCESS (1.712s)
[398.448977] Starting dynamic subtest: mman
[403.124531] Dynamic subtest mman: SUCCESS (4.681s)
[403.131720] Starting dynamic subtest: dmabuf
[404.348654] Dynamic subtest dmabuf: SUCCESS (1.222s)
[404.359378] Starting dynamic subtest: vma
[405.571559] Dynamic subtest vma: SUCCESS (1.221s)
[405.582102] Starting dynamic subtest: coherency
[408.468573] Dynamic subtest coherency: SUCCESS (2.895s)
[408.479594] Starting dynamic subtest: gtt
[416.829564] Dynamic subtest gtt: SUCCESS (8.359s)
[416.839994] Starting dynamic subtest: gem
[418.949556] Dynamic subtest gem: SUCCESS (2.118s)
[418.956698] Starting dynamic subtest: evict
[421.231384] Dynamic subtest evict: SUCCESS (2.280s)
[421.238864] Starting dynamic subtest: hugepages
[428.880554] Dynamic subtest hugepages: SUCCESS (7.647s)
[428.889681] Starting dynamic subtest: gem_contexts
[444.346573] Dynamic subtest gem_contexts: SUCCESS (15.464s)
[444.353942] Starting dynamic subtest: client
[445.597788] Dynamic subtest client: SUCCESS (1.249s)
[445.608337] Starting dynamic subtest: gem_migrate
[446.821707] Dynamic subtest gem_migrate: SUCCESS (1.222s)
[446.829323] Starting dynamic subtest: reset
[451.793783] Dynamic subtest reset: SUCCESS (4.970s)
[451.800670] Starting dynamic subtest: memory_region
[452.954592] Dynamic subtest memory_region: SUCCESS (1.159s)
[452.966621] Starting dynamic subtest: hangcheck
[482.843771] Dynamic subtest hangcheck: SUCCESS (29.888s)
[482.859645] Starting dynamic subtest: execlists
[496.618602] Dynamic subtest execlists: SUCCESS (13.773s)
[496.625739] Starting dynamic subtest: ring_submission
[497.804711] Dynamic subtest ring_submission: SUCCESS (1.184s)
[497.811305] Starting dynamic subtest: perf
[499.100618] Dynamic subtest perf: SUCCESS (1.294s)
[499.116366] Starting dynamic subtest: slpc
[500.275490] Dynamic subtest slpc: SUCCESS (1.173s)
[500.286551] Starting dynamic subtest: guc
[501.461451] Dynamic subtest guc: SUCCESS (1.184s)
[501.469054] Starting dynamic subtest: guc_multi_lrc
[502.674561] Dynamic subtest guc_multi_lrc: SUCCESS (1.211s)
[502.682352] Starting dynamic subtest: guc_hang
[503.861573] Dynamic subtest guc_hang: SUCCESS (1.185s)
[503.868706] Starting dynamic subtest: late_gt_pm
[505.122567] Dynamic subtest late_gt_pm: SUCCESS (1.259s)
[505.123326] Subtest live: SUCCESS (170.069s)
[505.154242] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[505.155063] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[505.160391] [118/133] (502s left) gem_exec_flush (basic-uc-set-default)
[506.215209] Starting subtest: basic-uc-set-default
[511.640853] Subtest basic-uc-set-default: SUCCESS (5.426s)
[511.831908] [FACT gem_exec_flush (basic-uc-set-default)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[511.833459] [FACT gem_exec_flush (basic-uc-set-default)] new: kernel.kmod_is_loaded.i915: true
[511.838865] [119/133] (495s left) gem_exec_schedule (u-submit-late-slice)
[511.886120] Starting subtest: u-submit-late-slice
[511.886883] Starting dynamic subtest: rcs0
[511.917424] Dynamic subtest rcs0: SUCCESS (0.030s)
[511.926987] Starting dynamic subtest: bcs0
[511.943265] Dynamic subtest bcs0: SUCCESS (0.025s)
[511.951725] Starting dynamic subtest: vcs0
[511.970405] Dynamic subtest vcs0: SUCCESS (0.026s)
[511.979248] Starting dynamic subtest: vcs1
[511.996137] Dynamic subtest vcs1: SUCCESS (0.025s)
[512.006738] Starting dynamic subtest: vecs0
[512.023245] Dynamic subtest vecs0: SUCCESS (0.026s)
[512.024040] Subtest u-submit-late-slice: SUCCESS (0.138s)
[512.327014] [120/133] (495s left) gem_ctx_bad_destroy (invalid-pad)
[512.360730] Starting subtest: invalid-pad
[512.361392] Subtest invalid-pad: SUCCESS (0.000s)
[512.424941] [121/133] (494s left) kms_psr2_su (page_flip-xrgb8888)
[512.459343] Subtest page_flip-XRGB8888: SKIP (0.000s)
[512.500505] [122/133] (494s left) kms_flip (2x-busy-flip)
[512.590412] Starting subtest: 2x-busy-flip
[512.599468] Subtest 2x-busy-flip: SKIP (0.009s)
[512.663548] [123/133] (494s left) syncobj_timeline (multi-wait-for-submit-signaled)
[512.697256] Starting subtest: multi-wait-for-submit-signaled
[512.699430] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[512.754448] [124/133] (494s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs)
[512.839928] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs
[512.841716] Starting dynamic subtest: pipe-A-HDMI-A-1
[513.574332] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.730s)
[513.588946] Starting dynamic subtest: pipe-B-HDMI-A-1
[513.959027] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.380s)
[513.977622] Starting dynamic subtest: pipe-C-HDMI-A-1
[514.351347] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.388s)
[514.369304] Starting dynamic subtest: pipe-D-HDMI-A-1
[514.736348] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.380s)
[514.737491] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SUCCESS (1.895s)
[514.926246] [125/133] (492s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-blt)
[515.022371] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-blt
[515.023794] Subtest fbc-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[515.107792] [126/133] (492s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[515.198727] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[515.200080] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[515.282598] [127/133] (492s left) kms_properties (colorop-properties-atomic)
[515.368570] Starting subtest: colorop-properties-atomic
[515.370893] Starting dynamic subtest: pipe-A-HDMI-A-1
[515.455910] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.086s)
[515.466943] Starting dynamic subtest: pipe-B-HDMI-A-1
[515.563161] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.105s)
[515.572728] Starting dynamic subtest: pipe-C-HDMI-A-1
[515.670853] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.106s)
[515.680389] Starting dynamic subtest: pipe-D-HDMI-A-1
[515.776393] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.104s)
[515.777074] Subtest colorop-properties-atomic: SUCCESS (0.408s)
[515.897396] [128/133] (491s left) syncobj_wait (multi-wait-submitted)
[515.933480] Starting subtest: multi-wait-submitted
[516.039722] Subtest multi-wait-submitted: SUCCESS (0.106s)
[516.107878] [129/133] (491s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[516.199823] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[516.201213] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[516.287604] [130/133] (491s left) kms_psr (pr-cursor-mmap-gtt)
[516.373567] Subtest pr-cursor-mmap-gtt: SKIP (0.000s)
[516.421716] [131/133] (491s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[516.455916] Starting subtest: single-wait-all-for-submit-signaled
[516.456608] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[516.512789] [132/133] (491s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted)
[516.552355] Starting subtest: multi-wait-for-submit-unsubmitted-submitted
[516.655636] Subtest multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.108s)
[516.733514] [133/133] (491s left) kms_psr (fbc-psr-cursor-mmap-cpu)
[516.820571] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.000s)
[516.865299] Closing watchdogs
results: parsing output: 0/ for test: gem_lmem_swapping
results: parsing output: 1/ for test: prime_mmap
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: gem_exec_schedule
results: parsing output: 4/ for test: syncobj_eventfd
results: parsing output: 5/ for test: gem_mmap_gtt
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_flip_scaled_crc
results: parsing output: 8/ for test: sw_sync
results: parsing output: 9/ for test: kms_prime
results: parsing output: 10/ for test: gem_exec_schedule
results: parsing output: 11/ for test: kms_plane_scaling
results: parsing output: 12/ for test: kms_flip
results: parsing output: 13/ for test: kms_flip
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_vblank
results: parsing output: 16/ for test: gem_exec_schedule
results: parsing output: 17/ for test: gem_mmap
results: parsing output: 18/ for test: syncobj_wait
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: sw_sync
results: parsing output: 21/ for test: kms_feature_discovery
results: parsing output: 22/ for test: kms_flip
results: parsing output: 23/ for test: kms_cursor_crc
results: parsing output: 24/ for test: gem_exec_fence
results: parsing output: 25/ for test: gem_exec_reloc
results: parsing output: 26/ for test: kms_big_fb
results: parsing output: 27/ for test: kms_big_fb
results: parsing output: 28/ for test: gem_ctx_shared
results: parsing output: 29/ for test: gem_exec_balancer
results: parsing output: 30/ for test: gem_ctx_persistence
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: i915_pm_rpm
results: parsing output: 33/ for test: prime_vgem
results: parsing output: 34/ for test: gem_exec_balancer
results: parsing output: 35/ for test: gem_wait
results: parsing output: 36/ for test: kms_plane
results: parsing output: 37/ for test: gem_userptr_blits
results: parsing output: 38/ for test: kms_universal_plane
results: parsing output: 39/ for test: syncobj_wait
results: parsing output: 40/ for test: gem_render_copy
results: parsing output: 41/ for test: kms_ccs
results: parsing output: 42/ for test: gem_softpin
results: parsing output: 43/ for test: gem_partial_pwrite_pread
results: parsing output: 44/ for test: kms_cursor_legacy
results: parsing output: 45/ for test: gen7_exec_parse
results: parsing output: 46/ for test: kms_chamelium_frames
results: parsing output: 47/ for test: kms_chamelium_frames
results: parsing output: 48/ for test: gem_caching
results: parsing output: 49/ for test: syncobj_wait
results: parsing output: 50/ for test: kms_ccs
results: parsing output: 51/ for test: kms_async_flips
results: parsing output: 52/ for test: gem_render_copy
results: parsing output: 53/ for test: gem_create
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: syncobj_timeline
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: gem_pread
results: parsing output: 58/ for test: gem_exec_reloc
results: parsing output: 59/ for test: prime_vgem
results: parsing output: 60/ for test: kms_plane_alpha_blend
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_joiner
results: parsing output: 63/ for test: kms_ccs
results: parsing output: 64/ for test: kms_cursor_edge_walk
results: parsing output: 65/ for test: kms_content_protection
results: parsing output: 66/ for test: perf_pmu
results: parsing output: 67/ for test: kms_getfb
results: parsing output: 68/ for test: gen9_exec_parse
results: parsing output: 69/ for test: kms_plane_scaling
results: parsing output: 70/ for test: kms_rotation_crc
results: parsing output: 71/ for test: kms_big_fb
results: parsing output: 72/ for test: device_reset
results: parsing output: 73/ for test: kms_psr
results: parsing output: 74/ for test: gem_fence_thrash
results: parsing output: 75/ for test: kms_lease
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: kms_cursor_crc
results: parsing output: 79/ for test: gem_exec_reloc
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_rotation_crc
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: prime_mmap_coherency
results: parsing output: 85/ for test: kms_pm_dc
results: parsing output: 86/ for test: gem_busy
results: parsing output: 87/ for test: kms_cursor_legacy
results: parsing output: 88/ for test: prime_mmap
results: parsing output: 89/ for test: kms_psr2_sf
results: parsing output: 90/ for test: syncobj_timeline
results: parsing output: 91/ for test: kms_big_fb
results: parsing output: 92/ for test: i915_drm_fdinfo
results: parsing output: 93/ for test: i915_drm_fdinfo
results: parsing output: 94/ for test: gem_close
results: parsing output: 95/ for test: api_intel_bb
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: prime_mmap
results: parsing output: 98/ for test: kms_flip_scaled_crc
results: parsing output: 99/ for test: kms_cursor_legacy
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: kms_color_pipeline
results: parsing output: 102/ for test: gem_mmap_gtt
results: parsing output: 103/ for test: kms_plane_lowres
results: parsing output: 104/ for test: gem_ctx_isolation
results: parsing output: 105/ for test: kms_addfb_basic
results: parsing output: 106/ for test: prime_busy
results: parsing output: 107/ for test: kms_cdclk
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: gem_softpin
results: parsing output: 112/ for test: perf
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_rotation_crc
results: parsing output: 115/ for test: sysfs_heartbeat_interval
results: parsing output: 116/ for test: i915_selftest
results: parsing output: 117/ for test: gem_exec_flush
results: parsing output: 118/ for test: gem_exec_schedule
results: parsing output: 119/ for test: gem_ctx_bad_destroy
results: parsing output: 120/ for test: kms_psr2_su
results: parsing output: 121/ for test: kms_flip
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: kms_ccs
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: kms_properties
results: parsing output: 127/ for test: syncobj_wait
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_psr
results: parsing output: 130/ for test: syncobj_timeline
results: parsing output: 131/ for test: syncobj_wait
results: parsing output: 132/ for test: kms_psr
Done.