[69.924826] Initializing watchdogs
[69.924926]   /dev/watchdog0
[69.955156] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics]
[69.969694] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[69.974670] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[69.978026] [001/133] (960s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions-varying-size)
[71.481220] Starting subtest: short-flip-after-cursor-atomic-transitions-varying-size
[72.595760] Subtest short-flip-after-cursor-atomic-transitions-varying-size: SUCCESS (1.115s)
[72.810351] [002/133] (957s left) gem_ctx_param (non-root-set)
[72.858796] Starting subtest: non-root-set
[72.878543] Subtest non-root-set: SUCCESS (0.022s)
[73.060687] [003/133] (957s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render)
[74.554459] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render
[74.557520] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[74.720638] [004/133] (956s left) kms_big_fb (4-tiled-16bpp-rotate-90)
[76.238439] Starting subtest: 4-tiled-16bpp-rotate-90
[76.241482] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.000s)
[76.411051] [005/133] (954s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[77.903954] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[77.906580] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[78.076259] [006/133] (952s left) api_intel_bb (object-noreloc-keep-cache-simple)
[78.128384] Starting subtest: object-noreloc-keep-cache-simple
[78.149873] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.022s)
[78.310734] [007/133] (952s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt)
[79.814131] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt
[79.819573] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[80.030854] [008/133] (951s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-render)
[81.521668] Starting subtest: fbcpsr-rgb565-draw-render
[81.524247] Subtest fbcpsr-rgb565-draw-render: SKIP (0.000s)
[81.693872] [009/133] (949s left) kms_color (ctm-green-to-red)
[83.183725] Starting subtest: ctm-green-to-red
[83.185477] Starting dynamic subtest: pipe-A-HDMI-A-4
[83.881832] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.697s)
[83.890288] Starting dynamic subtest: pipe-B-HDMI-A-4
[84.406703] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.525s)
[84.416278] Starting dynamic subtest: pipe-C-HDMI-A-4
[84.944981] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.537s)
[84.953921] Starting dynamic subtest: pipe-D-HDMI-A-4
[85.438999] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.495s)
[85.440508] Subtest ctm-green-to-red: SUCCESS (2.255s)
[85.612531] [010/133] (945s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs)
[85.667082] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs
[85.668716] Starting dynamic subtest: smem
[85.768804] Dynamic subtest smem: SUCCESS (0.102s)
[85.777240] Starting dynamic subtest: lmem0
[86.880253] Dynamic subtest lmem0: SUCCESS (1.108s)
[86.881981] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SUCCESS (1.210s)
[87.138829] [011/133] (944s left) gem_exec_store (cachelines)
[87.200304] Starting subtest: cachelines
[87.201992] Starting dynamic subtest: rcs0
[87.280147] Dynamic subtest rcs0: SUCCESS (0.080s)
[87.290885] Starting dynamic subtest: bcs0
[87.332401] Dynamic subtest bcs0: SUCCESS (0.051s)
[87.353221] Starting dynamic subtest: vcs0
[87.384707] Dynamic subtest vcs0: SUCCESS (0.052s)
[87.402395] Starting dynamic subtest: vcs1
[87.449672] Dynamic subtest vcs1: SUCCESS (0.063s)
[87.484884] Starting dynamic subtest: vecs0
[87.527407] Dynamic subtest vecs0: SUCCESS (0.077s)
[87.529661] Subtest cachelines: SUCCESS (0.327s)
[87.816157] [012/133] (943s left) kms_psr (psr2-primary-page-flip)
[89.304024] Subtest psr2-primary-page-flip: SKIP (0.000s)
[89.375041] [013/133] (942s left) testdisplay
[95.558539] [014/133] (936s left) kms_cursor_legacy (cursora-vs-flipa-varying-size)
[97.049144] Starting subtest: cursorA-vs-flipA-varying-size
[107.954819] Subtest cursorA-vs-flipA-varying-size: SUCCESS (10.906s)
[108.128677] [015/133] (923s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[109.623878] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[109.627158] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[109.815947] [016/133] (921s left) gem_partial_pwrite_pread (reads-display)
[109.871226] Subtest reads-display: SKIP (0.000s)
[109.973171] [017/133] (921s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[111.477712] Starting subtest: x-tiled-16bpp-rotate-180
[113.352672] Subtest x-tiled-16bpp-rotate-180: SUCCESS (1.872s)
[113.533814] [018/133] (918s left) kms_cursor_crc (cursor-offscreen-max-size)
[115.327182] Starting subtest: cursor-offscreen-max-size
[115.331924] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[115.534895] [019/133] (916s left) gem_workarounds (reset-fd)
[115.607737] Starting subtest: reset-fd
[115.775366] Subtest reset-fd: SUCCESS (0.167s)
[115.973122] [020/133] (916s left) kms_getfb (getfb-addfb-different-handles)
[117.456528] Starting subtest: getfb-addfb-different-handles
[117.458212] Subtest getfb-addfb-different-handles: SUCCESS (0.000s)
[117.640327] [021/133] (914s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-mc-ccs)
[119.129365] Starting subtest: crc-primary-suspend-4-tiled-dg2-mc-ccs
[119.130813] Starting dynamic subtest: pipe-A-HDMI-A-4
[119.136491] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.000s)
[119.145940] Starting dynamic subtest: pipe-B-HDMI-A-4
[119.151988] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.000s)
[119.161259] Starting dynamic subtest: pipe-C-HDMI-A-4
[119.167296] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.000s)
[119.176359] Starting dynamic subtest: pipe-D-HDMI-A-4
[119.182282] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.000s)
[119.185289] Subtest crc-primary-suspend-4-tiled-dg2-mc-ccs: SKIP (0.007s)
[119.353583] [022/133] (912s left) vgem_basic (bad-handle)
[119.497739] Starting subtest: bad-handle
[119.499604] Subtest bad-handle: SUCCESS (0.000s)
[119.593042] [FACT vgem_basic (bad-handle)] new: kernel.kmod_is_loaded.vgem: true
[119.596086] [023/133] (912s left) kms_atomic (plane-overlay-legacy)
[121.080521] Starting subtest: plane-overlay-legacy
[121.082155] Starting dynamic subtest: pipe-A-HDMI-A-4
[121.551052] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.468s)
[121.552769] Subtest plane-overlay-legacy: SUCCESS (0.470s)
[121.719738] [024/133] (910s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-blt)
[123.213026] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-blt
[123.216322] Subtest psr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[123.376867] [025/133] (909s left) prime_self_import (basic-llseek-bad)
[123.424412] Starting subtest: basic-llseek-bad
[123.438224] Subtest basic-llseek-bad: SUCCESS (0.003s)
[123.622044] [026/133] (909s left) gem_pxp (verify-pxp-stale-buf-execution)
[126.192869] Starting subtest: verify-pxp-stale-buf-execution
[126.196211] Subtest verify-pxp-stale-buf-execution: SKIP (0.000s)
[126.315209] [027/133] (906s left) i915_drm_fdinfo (most-busy-check-all)
[126.370255] Starting subtest: most-busy-check-all
[126.371749] Starting dynamic subtest: rcs0
[126.387892] Dynamic subtest rcs0: SKIP (0.017s)
[126.397632] Starting dynamic subtest: bcs0
[126.400840] Dynamic subtest bcs0: SKIP (0.000s)
[126.410244] Starting dynamic subtest: vcs0
[126.413724] Dynamic subtest vcs0: SKIP (0.000s)
[126.422947] Starting dynamic subtest: vcs1
[126.426380] Dynamic subtest vcs1: SKIP (0.000s)
[126.435759] Starting dynamic subtest: vecs0
[126.439554] Dynamic subtest vecs0: SKIP (0.001s)
[126.442707] Subtest most-busy-check-all: SKIP (0.022s)
[126.503865] [028/133] (906s left) gem_exec_reloc (basic-cpu-read)
[126.592930] Subtest basic-cpu-read: SKIP (0.000s)
[126.700285] [029/133] (906s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[128.190664] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[128.193617] Subtest psr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[128.369106] [030/133] (904s left) kms_plane_scaling (planes-downscale-factor-0-75)
[129.854429] Starting subtest: planes-downscale-factor-0-75
[129.855971] Starting dynamic subtest: pipe-A
[129.971014] Dynamic subtest pipe-A: SUCCESS (0.116s)
[129.981012] Starting dynamic subtest: pipe-B
[130.112297] Dynamic subtest pipe-B: SUCCESS (0.141s)
[130.122395] Starting dynamic subtest: pipe-C
[130.253328] Dynamic subtest pipe-C: SUCCESS (0.140s)
[130.262915] Starting dynamic subtest: pipe-D
[130.393867] Dynamic subtest pipe-D: SUCCESS (0.140s)
[130.395326] Subtest planes-downscale-factor-0-75: SUCCESS (0.540s)
[130.563974] [031/133] (902s left) kms_psr (pr-cursor-plane-move)
[132.051544] Subtest pr-cursor-plane-move: SKIP (0.000s)
[132.127935] [032/133] (900s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-signaled)
[132.177588] Starting subtest: multi-wait-for-submit-unsubmitted-signaled
[132.179202] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.001s)
[132.282697] [033/133] (900s left) kms_chamelium_frames (dp-crc-single)
[133.807689] Subtest dp-crc-single: SKIP (0.000s)
[133.920493] [034/133] (899s left) gem_exec_reloc (basic-wc-active)
[133.974109] Subtest basic-wc-active: SKIP (0.000s)
[134.072434] [035/133] (899s left) gem_basic (multigpu-create-close)
[134.118718] Starting subtest: multigpu-create-close
[134.121710] Subtest multigpu-create-close: SKIP (0.000s)
[134.234376] [036/133] (899s left) kms_plane_scaling (plane-scaler-unity-scaling-with-modifiers)
[135.720773] Starting subtest: plane-scaler-unity-scaling-with-modifiers
[135.722263] Starting dynamic subtest: pipe-A
[136.471889] Dynamic subtest pipe-A: SUCCESS (0.753s)
[136.483551] Starting dynamic subtest: pipe-B
[137.229306] Dynamic subtest pipe-B: SUCCESS (0.756s)
[137.242266] Starting dynamic subtest: pipe-C
[137.986282] Dynamic subtest pipe-C: SUCCESS (0.756s)
[138.000751] Starting dynamic subtest: pipe-D
[138.741790] Dynamic subtest pipe-D: SUCCESS (0.754s)
[138.743282] Subtest plane-scaler-unity-scaling-with-modifiers: SUCCESS (3.023s)
[138.929876] [037/133] (894s left) kms_addfb_basic (too-high)
[140.445451] Starting subtest: too-high
[140.446929] Subtest too-high: SUCCESS (0.001s)
[140.631617] [038/133] (892s left) gem_userptr_blits (sync-unmap-cycles)
[140.722515] Starting subtest: sync-unmap-cycles
[146.096417] Subtest sync-unmap-cycles: SUCCESS (5.376s)
[146.288068] [039/133] (887s left) syncobj_wait (wait-any-interrupted)
[146.335819] Starting subtest: wait-any-interrupted
[146.442695] Subtest wait-any-interrupted: SUCCESS (0.103s)
[146.598938] [040/133] (887s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[148.112689] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip
[148.115406] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[148.287505] [041/133] (885s left) kms_hdr (static-toggle)
[149.775516] Starting subtest: static-toggle
[149.780573] Subtest static-toggle: SKIP (0.001s)
[149.897529] [042/133] (884s left) kms_busy (extended-pageflip-modeset-hang-oldfb)
[151.397269] Starting subtest: extended-pageflip-modeset-hang-oldfb
[151.399151] Starting dynamic subtest: pipe-A
[159.135995] Dynamic subtest pipe-A: SUCCESS (7.737s)
[159.147731] Starting dynamic subtest: pipe-D
[166.849502] Dynamic subtest pipe-D: SUCCESS (7.708s)
[166.851025] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (15.453s)
[167.046723] [043/133] (867s left) kms_sequence (get-forked)
[168.533150] Starting subtest: get-forked
[168.534851] Starting dynamic subtest: pipe-A-HDMI-A-4
[171.022067] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (2.489s)
[171.031876] Starting dynamic subtest: pipe-B-HDMI-A-4
[173.279084] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (2.256s)
[173.290438] Starting dynamic subtest: pipe-C-HDMI-A-4
[175.552581] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (2.270s)
[175.562565] Starting dynamic subtest: pipe-D-HDMI-A-4
[177.801230] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (2.247s)
[177.802859] Subtest get-forked: SUCCESS (9.271s)
[177.988884] [044/133] (856s left) gem_exec_schedule (reorder-wide)
[178.210900] Subtest reorder-wide: SKIP (0.000s)
[178.470917] [045/133] (855s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling)
[179.954090] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling
[179.957337] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.000s)
[180.070165] [046/133] (854s left) gem_pwrite (basic-self)
[180.125786] Subtest basic-self: SKIP (0.000s)
[180.212351] [047/133] (854s left) i915_selftest (perf)
[181.210393] Starting subtest: perf
[181.211918] Starting dynamic subtest: engine_cs
[182.606624] Dynamic subtest engine_cs: SUCCESS (1.396s)
[182.626355] Starting dynamic subtest: request
[187.029375] Dynamic subtest request: SUCCESS (4.422s)
[187.037193] Starting dynamic subtest: migrate
[188.499575] Dynamic subtest migrate: SUCCESS (1.469s)
[188.507653] Starting dynamic subtest: region
[202.210599] Dynamic subtest region: SUCCESS (13.710s)
[202.212419] Subtest perf: SUCCESS (21.001s)
[202.251468] [FACT i915_selftest (perf)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[202.252588] [FACT i915_selftest (perf)] deleted: kernel.kmod_is_loaded.i915: true
[202.255882] [048/133] (832s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)
[206.988236] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc
[206.991355] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[207.230942] [FACT kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[207.234355] [FACT kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)] new: kernel.kmod_is_loaded.i915: true
[207.241377] [049/133] (827s left) kms_dsc (dsc-with-bpc-formats)
[208.732816] Starting subtest: dsc-with-bpc-formats
[208.816064] Subtest dsc-with-bpc-formats: SKIP (0.005s)
[208.916900] [050/133] (825s left) kms_flip (plain-flip-fb-recreate)
[210.404631] Starting subtest: plain-flip-fb-recreate
[210.411809] Starting dynamic subtest: A-HDMI-A4
[218.437185] Dynamic subtest A-HDMI-A4: SUCCESS (8.024s)
[218.477225] Starting dynamic subtest: B-HDMI-A4
[226.431854] Dynamic subtest B-HDMI-A4: SUCCESS (7.987s)
[226.465792] Starting dynamic subtest: C-HDMI-A4
[234.427151] Dynamic subtest C-HDMI-A4: SUCCESS (7.987s)
[234.462776] Starting dynamic subtest: D-HDMI-A4
[242.422572] Dynamic subtest D-HDMI-A4: SUCCESS (7.987s)
[242.431982] Subtest plain-flip-fb-recreate: SUCCESS (32.021s)
[242.675900] [051/133] (792s left) gem_ccs (suspend-resume)
[242.733958] Starting subtest: suspend-resume
[242.737033] Subtest suspend-resume: SKIP (0.000s)
[242.848602] [052/133] (791s left) kms_big_fb (yf-tiled-32bpp-rotate-270)
[244.354931] Starting subtest: yf-tiled-32bpp-rotate-270
[244.358422] Subtest yf-tiled-32bpp-rotate-270: SKIP (0.000s)
[244.548972] [053/133] (790s left) kms_cursor_legacy (2x-long-cursor-vs-flip-atomic)
[246.036697] Starting subtest: 2x-long-cursor-vs-flip-atomic
[246.039971] Subtest 2x-long-cursor-vs-flip-atomic: SKIP (0.003s)
[246.146971] [054/133] (788s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[247.645961] Starting subtest: psr-shrfb-scaledprimary
[247.649159] Subtest psr-shrfb-scaledprimary: SKIP (0.000s)
[247.819783] [055/133] (787s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal
[247.873142] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled
[247.977875] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.103s)
[248.186275] [056/133] (787s left) i915_pm_rpm (system-suspend-execbuf)
[252.004687] Starting subtest: system-suspend-execbuf
[313.935723] Subtest system-suspend-execbuf: SUCCESS (52.077s)
[314.863397] [057/133] (720s left) gem_exec_balancer (sliced)
[314.926501] Starting subtest: sliced
[314.929738] Subtest sliced: SKIP (0.000s)
[315.419214] [058/133] (719s left) kms_pm_rpm (modeset-non-lpsp)
[318.853643] Starting subtest: modeset-non-lpsp
[320.034860] Subtest modeset-non-lpsp: SUCCESS (1.181s)
[320.891267] [059/133] (714s left) kms_vrr (flip-basic)
[322.389478] Starting subtest: flip-basic
[322.394014] Subtest flip-basic: SKIP (0.000s)
[322.509517] [060/133] (713s left) kms_chamelium_hpd (dp-hpd-storm-disable)
[324.059420] Subtest dp-hpd-storm-disable: SKIP (0.000s)
[324.171402] [061/133] (711s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[325.676589] Starting subtest: y-tiled-32bpp-rotate-0
[327.625747] Subtest y-tiled-32bpp-rotate-0: SUCCESS (1.945s)
[327.826297] [062/133] (707s left) syncobj_wait (reset-signaled)
[327.874054] Starting subtest: reset-signaled
[327.875857] Subtest reset-signaled: SUCCESS (0.000s)
[328.013671] [063/133] (707s left) gem_exec_fence (syncobj-wait)
[328.422776] Starting subtest: syncobj-wait
[328.475798] Subtest syncobj-wait: SUCCESS (0.053s)
[328.965061] [064/133] (706s left) kms_ccs (bad-pixel-format-y-tiled-ccs)
[330.451700] Starting subtest: bad-pixel-format-y-tiled-ccs
[330.453438] Starting dynamic subtest: pipe-A-HDMI-A-4
[330.471512] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.000s)
[330.483520] Starting dynamic subtest: pipe-B-HDMI-A-4
[330.511665] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.000s)
[330.522857] Starting dynamic subtest: pipe-C-HDMI-A-4
[330.537782] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.000s)
[330.549040] Starting dynamic subtest: pipe-D-HDMI-A-4
[330.564798] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.000s)
[330.567935] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.010s)
[330.702155] [065/133] (705s left) gem_spin_batch (engines)
[330.759489] Starting subtest: engines
[330.761206] Starting dynamic subtest: rcs0
[334.012967] Dynamic subtest rcs0: SUCCESS (3.246s)
[334.028969] Starting dynamic subtest: bcs0
[337.253019] Dynamic subtest bcs0: SUCCESS (3.232s)
[337.269263] Starting dynamic subtest: vcs0
[340.493159] Dynamic subtest vcs0: SUCCESS (3.232s)
[340.509196] Starting dynamic subtest: vcs1
[343.733484] Dynamic subtest vcs1: SUCCESS (3.233s)
[343.749532] Starting dynamic subtest: vecs0
[346.973995] Dynamic subtest vecs0: SUCCESS (3.234s)
[346.976009] Subtest engines: SUCCESS (16.212s)
[347.279342] [066/133] (688s left) gem_ctx_persistence (engines-hang)
[347.336260] Starting subtest: engines-hang
[347.338020] Starting dynamic subtest: rcs0
[347.401698] Dynamic subtest rcs0: SUCCESS (0.065s)
[347.415891] Starting dynamic subtest: bcs0
[347.495776] Dynamic subtest bcs0: SUCCESS (0.092s)
[347.520834] Starting dynamic subtest: vcs0
[347.541942] Dynamic subtest vcs0: SUCCESS (0.044s)
[347.571415] Starting dynamic subtest: vcs1
[347.586812] Dynamic subtest vcs1: SUCCESS (0.042s)
[347.607888] Starting dynamic subtest: vecs0
[347.639825] Dynamic subtest vecs0: SUCCESS (0.051s)
[347.641334] Subtest engines-hang: SUCCESS (0.305s)
[347.816163] [067/133] (688s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[349.320072] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[349.323424] Subtest psr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[349.500872] [068/133] (686s left) kms_cursor_legacy (basic-busy-flip-before-cursor-varying-size)
[350.990596] Starting subtest: basic-busy-flip-before-cursor-varying-size
[350.993727] Subtest basic-busy-flip-before-cursor-varying-size: SKIP (0.000s)
[351.193089] [069/133] (685s left) i915_hangman (detector)
[351.257243] Starting subtest: detector
[351.258846] Starting dynamic subtest: rcs0
[360.983392] Dynamic subtest rcs0: SUCCESS (9.727s)
[361.001178] Starting dynamic subtest: bcs0
[370.955934] Dynamic subtest bcs0: SUCCESS (9.970s)
[370.974282] Starting dynamic subtest: vcs0
[380.962006] Dynamic subtest vcs0: SUCCESS (10.005s)
[380.979630] Starting dynamic subtest: vcs1
[390.938941] Dynamic subtest vcs1: SUCCESS (9.975s)
[390.954999] Starting dynamic subtest: vecs0
[400.991115] Dynamic subtest vecs0: SUCCESS (10.051s)
[400.992760] Subtest detector: SUCCESS (49.737s)
[401.185016] [070/133] (635s left) kms_fbcon_fbt (fbc-suspend)
[401.237654] Starting subtest: fbc-suspend
[456.762624] Subtest fbc-suspend: SUCCESS (33.585s)
[457.901831] [071/133] (579s left) kms_psr (psr-cursor-render)
[459.394191] Subtest psr-cursor-render: SKIP (0.000s)
[459.472407] [072/133] (578s left) gem_exec_flush (basic-batch-kernel-default-wb)
[459.524997] Subtest basic-batch-kernel-default-wb: SKIP (0.000s)
[459.628420] [073/133] (578s left) gem_vm_create (invalid-destroy)
[459.682405] Starting subtest: invalid-destroy
[459.686411] Subtest invalid-destroy: SUCCESS (0.002s)
[459.857848] [074/133] (577s left) kms_lease (lessee-list)
[461.342954] Starting subtest: lessee-list
[461.344444] Starting dynamic subtest: pipe-A-HDMI-A-4
[461.348680] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.002s)
[461.361541] Starting dynamic subtest: pipe-B-HDMI-A-4
[461.363033] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.001s)
[461.375833] Starting dynamic subtest: pipe-C-HDMI-A-4
[461.377483] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.001s)
[461.390467] Starting dynamic subtest: pipe-D-HDMI-A-4
[461.392243] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.001s)
[461.394018] Subtest lessee-list: SUCCESS (0.016s)
[461.530381] [075/133] (576s left) device_reset (unbind-cold-reset-rebind)
[461.610589] Starting subtest: unbind-cold-reset-rebind
[461.614098] Subtest unbind-cold-reset-rebind: SKIP (0.000s)
[461.730615] [076/133] (576s left) gem_tiled_blits (basic)
[461.782376] Subtest basic: SKIP (0.000s)
[461.857909] [077/133] (576s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc)
[463.352331] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc
[463.355266] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[463.545469] [078/133] (574s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[465.032180] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[465.033732] Starting dynamic subtest: pipe-A-HDMI-A-4
[465.048255] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.000s)
[465.060629] Starting dynamic subtest: pipe-B-HDMI-A-4
[465.075465] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.000s)
[465.087556] Starting dynamic subtest: pipe-C-HDMI-A-4
[465.102792] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.000s)
[465.115021] Starting dynamic subtest: pipe-D-HDMI-A-4
[465.131372] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.000s)
[465.134582] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SKIP (0.011s)
[465.275107] [079/133] (573s left) kms_psr2_su (frontbuffer-xrgb8888)
[465.326735] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[465.404307] [080/133] (572s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[466.889319] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[466.890946] Starting dynamic subtest: pipe-A-HDMI-A-4
[466.932345] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.003s)
[466.944962] Starting dynamic subtest: pipe-B-HDMI-A-4
[466.994165] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.003s)
[467.006425] Starting dynamic subtest: pipe-C-HDMI-A-4
[467.043767] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.003s)
[467.056137] Starting dynamic subtest: pipe-D-HDMI-A-4
[467.099509] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.003s)
[467.103024] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SKIP (0.022s)
[467.177040] [081/133] (571s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[468.665496] Starting subtest: addfb25-y-tiled-legacy
[468.667071] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[468.846104] [082/133] (569s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping)
[470.332132] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping
[470.335174] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping: SKIP (0.000s)
[470.478591] [083/133] (568s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[471.981764] Starting subtest: fbc-rgb565-draw-pwrite
[475.069746] Subtest fbc-rgb565-draw-pwrite: SUCCESS (3.089s)
[475.245821] [084/133] (563s left) syncobj_timeline (single-wait-all-available-submitted)
[475.296859] Starting subtest: single-wait-all-available-submitted
[475.298535] Subtest single-wait-all-available-submitted: SUCCESS (0.000s)
[475.457432] [085/133] (563s left) gem_exec_reloc (basic-write-gtt-noreloc)
[475.512118] Subtest basic-write-gtt-noreloc: SKIP (0.000s)
[475.618165] [086/133] (563s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[477.112288] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc
[477.115654] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[477.271676] [087/133] (561s left) gem_userptr_blits (dmabuf-sync)
[477.339099] Starting subtest: dmabuf-sync
[477.343737] Subtest dmabuf-sync: SKIP (0.003s)
[477.558284] [088/133] (561s left) gem_mmap_gtt (bad-object)
[477.606875] Subtest bad-object: SKIP (0.000s)
[477.683937] [089/133] (561s left) kms_properties (plane-properties-legacy)
[479.170460] Starting subtest: plane-properties-legacy
[479.172133] Starting dynamic subtest: pipe-A-HDMI-A-4
[479.640247] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.468s)
[479.655132] Starting dynamic subtest: pipe-B-HDMI-A-4
[480.100092] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.456s)
[480.113030] Starting dynamic subtest: pipe-C-HDMI-A-4
[480.566163] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.463s)
[480.579175] Starting dynamic subtest: pipe-D-HDMI-A-4
[481.032196] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.465s)
[481.033697] Subtest plane-properties-legacy: SUCCESS (1.863s)
[481.203443] [090/133] (558s left) gem_exec_fence (syncobj-invalid-wait)
[481.628209] Starting subtest: syncobj-invalid-wait
[481.629829] Subtest syncobj-invalid-wait: SUCCESS (0.001s)
[482.076146] [091/133] (557s left) kms_cursor_legacy (modeset-atomic-cursor-hotspot)
[483.561402] Starting subtest: modeset-atomic-cursor-hotspot
[483.564625] Subtest modeset-atomic-cursor-hotspot: SKIP (0.000s)
[483.674410] [092/133] (555s left) gem_exec_reloc (basic-cpu-wc-noreloc)
[483.733571] Subtest basic-cpu-wc-noreloc: SKIP (0.000s)
[483.840067] [093/133] (555s left) gem_exec_balancer (full)
[483.898407] Starting subtest: full
[486.276333] Subtest full: SUCCESS (2.378s)
[486.742664] [094/133] (552s left) gem_ctx_shared (q-out-order)
[486.801548] Starting subtest: Q-out-order
[486.803327] Starting dynamic subtest: rcs0
[486.981443] Dynamic subtest rcs0: SUCCESS (0.176s)
[486.995426] Starting dynamic subtest: bcs0
[487.100774] Dynamic subtest bcs0: SUCCESS (0.120s)
[487.113897] Starting dynamic subtest: vcs0
[487.228530] Dynamic subtest vcs0: SUCCESS (0.124s)
[487.242079] Starting dynamic subtest: vcs1
[487.365142] Dynamic subtest vcs1: SUCCESS (0.135s)
[487.378286] Starting dynamic subtest: vecs0
[487.500938] Dynamic subtest vecs0: SUCCESS (0.134s)
[487.502502] Subtest Q-out-order: SUCCESS (0.697s)
[487.830883] [095/133] (551s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[489.327139] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[489.330630] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[489.501465] [096/133] (550s left) gem_eio (wait-wedge-immediate)
[489.694131] Starting subtest: wait-wedge-immediate
[490.636935] Subtest wait-wedge-immediate: SUCCESS (0.943s)
[492.189437] [097/133] (547s left) kms_cursor_crc (cursor-size-change)
[493.680852] Starting subtest: cursor-size-change
[493.682446] Starting dynamic subtest: pipe-A-HDMI-A-4
[494.589923] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.909s)
[494.605531] Starting dynamic subtest: pipe-D-HDMI-A-4
[495.294681] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.703s)
[495.296225] Subtest cursor-size-change: SUCCESS (1.617s)
[495.998553] [098/133] (543s left) gem_exec_schedule (noreorder-priority)
[496.177540] Starting subtest: noreorder-priority
[496.179019] Starting dynamic subtest: rcs0
[497.321079] Dynamic subtest rcs0: SUCCESS (1.143s)
[497.334613] Starting dynamic subtest: bcs0
[498.444024] Dynamic subtest bcs0: SUCCESS (1.121s)
[498.457800] Starting dynamic subtest: vcs0
[499.566104] Dynamic subtest vcs0: SUCCESS (1.121s)
[499.579871] Starting dynamic subtest: vcs1
[500.689143] Dynamic subtest vcs1: SUCCESS (1.121s)
[500.702749] Starting dynamic subtest: vecs0
[501.809174] Dynamic subtest vecs0: SUCCESS (1.118s)
[501.811004] Subtest noreorder-priority: SUCCESS (5.633s)
[502.074114] [099/133] (537s left) gem_tiled_partial_pwrite_pread (writes-after-reads)
[502.127004] Subtest writes-after-reads: SKIP (0.000s)
[502.212205] [100/133] (537s left) kms_chamelium_audio (dp-audio)
[503.740451] Subtest dp-audio: SKIP (0.000s)
[503.854963] [101/133] (536s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move)
[505.349052] Starting subtest: fbc-2p-primscrn-cur-indfb-move
[505.351969] Subtest fbc-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[505.607781] [102/133] (534s left) gem_ctx_persistence (legacy-engines-queued)
[505.660496] Starting subtest: legacy-engines-queued
[505.662122] Starting dynamic subtest: render
[505.727105] Dynamic subtest render: SUCCESS (0.066s)
[505.743231] Starting dynamic subtest: bsd1
[505.768156] Dynamic subtest bsd1: SUCCESS (0.039s)
[505.785647] Starting dynamic subtest: bsd2
[505.816169] Dynamic subtest bsd2: SUCCESS (0.046s)
[505.840319] Starting dynamic subtest: blt
[505.852455] Dynamic subtest blt: SUCCESS (0.034s)
[505.876153] Starting dynamic subtest: vebox
[505.923260] Dynamic subtest vebox: SUCCESS (0.068s)
[505.925361] Subtest legacy-engines-queued: SUCCESS (0.264s)
[506.142435] [103/133] (534s left) kms_cursor_crc (cursor-random-64x64)
[507.761385] Starting subtest: cursor-random-64x64
[507.768492] Starting dynamic subtest: pipe-A-HDMI-A-4
[512.373549] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (4.605s)
[512.410645] Starting dynamic subtest: pipe-D-HDMI-A-4
[516.850206] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (4.453s)
[516.851695] Subtest cursor-random-64x64: SUCCESS (9.089s)
[517.345707] [104/133] (523s left) kms_pipe_crc_basic (read-crc)
[518.834795] Starting subtest: read-crc
[518.836405] Starting dynamic subtest: pipe-A-HDMI-A-4
[519.513434] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.678s)
[519.530235] Starting dynamic subtest: pipe-B-HDMI-A-4
[519.971337] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.455s)
[519.988572] Starting dynamic subtest: pipe-C-HDMI-A-4
[520.484015] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.510s)
[520.500405] Starting dynamic subtest: pipe-D-HDMI-A-4
[521.020494] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.532s)
[521.022253] Subtest read-crc: SUCCESS (2.187s)
[521.199283] [105/133] (519s left) syncobj_timeline (invalid-query-one-illegal-handle)
[521.248666] Starting subtest: invalid-query-one-illegal-handle
[521.250026] Subtest invalid-query-one-illegal-handle: SUCCESS (0.000s)
[521.372889] [106/133] (519s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-gtt)
[522.865423] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-gtt
[522.868645] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[523.044968] [107/133] (517s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling)
[524.533456] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling
[524.535421] Starting dynamic subtest: pipe-A-valid-mode
[525.765722] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.230s)
[525.767277] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SUCCESS (1.233s)
[525.952990] [108/133] (514s left) kms_plane_cursor (overlay)
[527.440233] Starting subtest: overlay
[527.443512] Starting dynamic subtest: pipe-A-HDMI-A-4-size-64
[530.518067] Dynamic subtest pipe-A-HDMI-A-4-size-64: SUCCESS (3.076s)
[530.601520] Starting dynamic subtest: pipe-A-HDMI-A-4-size-128
[533.634521] Dynamic subtest pipe-A-HDMI-A-4-size-128: SUCCESS (3.049s)
[533.716325] Starting dynamic subtest: pipe-A-HDMI-A-4-size-256
[536.734411] Dynamic subtest pipe-A-HDMI-A-4-size-256: SUCCESS (3.032s)
[536.858989] Starting dynamic subtest: pipe-B-HDMI-A-4-size-64
[539.882831] Dynamic subtest pipe-B-HDMI-A-4-size-64: SUCCESS (3.037s)
[539.947502] Starting dynamic subtest: pipe-B-HDMI-A-4-size-128
[542.982756] Dynamic subtest pipe-B-HDMI-A-4-size-128: SUCCESS (3.049s)
[543.047385] Starting dynamic subtest: pipe-B-HDMI-A-4-size-256
[546.049669] Dynamic subtest pipe-B-HDMI-A-4-size-256: SUCCESS (3.016s)
[546.156428] Starting dynamic subtest: pipe-C-HDMI-A-4-size-64
[549.236019] Dynamic subtest pipe-C-HDMI-A-4-size-64: SUCCESS (3.093s)
[549.305041] Starting dynamic subtest: pipe-C-HDMI-A-4-size-128
[552.303140] Dynamic subtest pipe-C-HDMI-A-4-size-128: SUCCESS (3.016s)
[552.380670] Starting dynamic subtest: pipe-C-HDMI-A-4-size-256
[555.469263] Dynamic subtest pipe-C-HDMI-A-4-size-256: SUCCESS (3.115s)
[555.561319] Starting dynamic subtest: pipe-D-HDMI-A-4-size-64
[558.643840] Dynamic subtest pipe-D-HDMI-A-4-size-64: SUCCESS (3.097s)
[558.708282] Starting dynamic subtest: pipe-D-HDMI-A-4-size-128
[561.710595] Dynamic subtest pipe-D-HDMI-A-4-size-128: SUCCESS (3.016s)
[561.772815] Starting dynamic subtest: pipe-D-HDMI-A-4-size-256
[564.777036] Dynamic subtest pipe-D-HDMI-A-4-size-256: SUCCESS (3.016s)
[564.855066] Subtest overlay: SUCCESS (37.413s)
[565.024661] [109/133] (475s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-cpu)
[566.518794] Starting subtest: fbc-rgb101010-draw-mmap-cpu
[569.437762] Subtest fbc-rgb101010-draw-mmap-cpu: SUCCESS (2.919s)
[569.637738] [110/133] (471s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[571.124337] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.000s)
[571.201647] [111/133] (469s left) api_intel_allocator (two-level-inception-interruptible)
[571.247808] Starting subtest: two-level-inception-interruptible
[576.696097] Subtest two-level-inception-interruptible: SUCCESS (5.449s)
[576.906250] [112/133] (464s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[578.401324] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-wc
[578.403981] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[578.583724] [113/133] (462s left) perf_pmu (init-sema)
[578.637806] Starting subtest: init-sema
[578.639329] Starting dynamic subtest: rcs0
[578.640776] Dynamic subtest rcs0: SUCCESS (0.002s)
[578.654841] Starting dynamic subtest: bcs0
[578.656536] Dynamic subtest bcs0: SUCCESS (0.001s)
[578.669952] Starting dynamic subtest: vcs0
[578.671500] Dynamic subtest vcs0: SUCCESS (0.001s)
[578.685018] Starting dynamic subtest: vcs1
[578.686409] Dynamic subtest vcs1: SUCCESS (0.001s)
[578.700105] Starting dynamic subtest: vecs0
[578.701807] Dynamic subtest vecs0: SUCCESS (0.001s)
[578.704039] Subtest init-sema: SUCCESS (0.013s)
[578.772042] [114/133] (462s left) vgem_basic (second-client)
[578.821403] Starting subtest: second-client
[578.856528] Subtest second-client: SUCCESS (0.033s)
[578.970078] [115/133] (462s left) kms_pm_backlight (fade-with-dpms)
[580.458023] Subtest fade-with-dpms: SKIP (0.000s)
[580.536663] [116/133] (460s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-gtt)
[582.029777] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-gtt
[582.032528] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[582.190866] [117/133] (459s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[582.243436] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[582.354193] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.108s)
[582.493104] [118/133] (459s left) kms_psr (fbc-psr2-suspend)
[583.982440] Subtest fbc-psr2-suspend: SKIP (0.000s)
[584.069087] [119/133] (457s left) kms_big_fb (linear-8bpp-rotate-0)
[585.575323] Starting subtest: linear-8bpp-rotate-0
[587.490598] Subtest linear-8bpp-rotate-0: SUCCESS (1.911s)
[587.679258] [120/133] (454s left) gen3_mixed_blits
[587.801215] [121/133] (454s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-fully-sf)
[589.288857] Subtest psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[589.367967] [122/133] (452s left) gem_exec_reloc (basic-gtt-wc-noreloc)
[589.420472] Subtest basic-gtt-wc-noreloc: SKIP (0.000s)
[589.561690] [123/133] (452s left) gem_exec_reloc (basic-gtt-cpu)
[589.614585] Subtest basic-gtt-cpu: SKIP (0.000s)
[589.723378] [124/133] (452s left) prime_vgem (fence-wait)
[589.799462] Starting subtest: fence-wait
[589.801203] Starting dynamic subtest: rcs0
[590.874807] Dynamic subtest rcs0: SUCCESS (1.070s)
[590.889139] Starting dynamic subtest: bcs0
[591.938495] Dynamic subtest bcs0: SUCCESS (1.058s)
[591.955132] Starting dynamic subtest: vcs0
[592.988671] Dynamic subtest vcs0: SUCCESS (1.044s)
[593.002948] Starting dynamic subtest: vcs1
[594.036810] Dynamic subtest vcs1: SUCCESS (1.042s)
[594.050775] Starting dynamic subtest: vecs0
[595.082152] Dynamic subtest vecs0: SUCCESS (1.039s)
[595.083957] Subtest fence-wait: SUCCESS (5.283s)
[595.244363] [125/133] (447s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render)
[596.735518] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render
[596.738518] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[596.929803] [126/133] (445s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf)
[598.420493] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[598.503467] [127/133] (443s left) gen9_exec_parse (secure-batches)
[598.556923] Subtest secure-batches: SKIP (0.000s)
[598.635559] [128/133] (443s left) perf (gen12-group-concurrent-oa-buffer-read)
[598.771206] Starting subtest: gen12-group-concurrent-oa-buffer-read
[608.828634] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.055s)
[608.905917] [129/133] (433s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[610.401569] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-cpu
[610.404611] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[610.584179] [130/133] (432s left) kms_content_protection (srm)
[612.129847] Starting subtest: srm
[612.138176] Subtest srm: SKIP (0.004s)
[612.342304] [131/133] (430s left) gem_exercise_blt (fast-copy-emit)
[612.394324] Starting subtest: fast-copy-emit
[612.396337] Starting dynamic subtest: linear-smem-smem-emit
[612.432629] Dynamic subtest linear-smem-smem-emit: SUCCESS (0.038s)
[612.446879] Starting dynamic subtest: linear-smem-lmem0-emit
[612.451033] Dynamic subtest linear-smem-lmem0-emit: SUCCESS (0.016s)
[612.465054] Starting dynamic subtest: linear-lmem0-smem-emit
[612.511300] Dynamic subtest linear-lmem0-smem-emit: SUCCESS (0.060s)
[612.525163] Starting dynamic subtest: linear-lmem0-lmem0-emit
[612.571805] Dynamic subtest linear-lmem0-lmem0-emit: SUCCESS (0.059s)
[612.585660] Starting dynamic subtest: ymajor-smem-smem-emit
[612.589768] Dynamic subtest ymajor-smem-smem-emit: SUCCESS (0.015s)
[612.604339] Starting dynamic subtest: ymajor-smem-lmem0-emit
[612.606849] Dynamic subtest ymajor-smem-lmem0-emit: SUCCESS (0.014s)
[612.620802] Starting dynamic subtest: ymajor-lmem0-smem-emit
[612.665801] Dynamic subtest ymajor-lmem0-smem-emit: SUCCESS (0.060s)
[612.679805] Starting dynamic subtest: ymajor-lmem0-lmem0-emit
[612.726830] Dynamic subtest ymajor-lmem0-lmem0-emit: SUCCESS (0.059s)
[612.740429] Starting dynamic subtest: tile4-smem-smem-emit
[612.743813] Dynamic subtest tile4-smem-smem-emit: SUCCESS (0.015s)
[612.757423] Starting dynamic subtest: tile4-smem-lmem0-emit
[612.760774] Dynamic subtest tile4-smem-lmem0-emit: SUCCESS (0.014s)
[612.774329] Starting dynamic subtest: tile4-lmem0-smem-emit
[612.820467] Dynamic subtest tile4-lmem0-smem-emit: SUCCESS (0.060s)
[612.836125] Starting dynamic subtest: tile4-lmem0-lmem0-emit
[612.881161] Dynamic subtest tile4-lmem0-lmem0-emit: SUCCESS (0.059s)
[612.896670] Starting dynamic subtest: tile64-smem-smem-emit
[612.898017] Dynamic subtest tile64-smem-smem-emit: SUCCESS (0.015s)
[612.913704] Starting dynamic subtest: tile64-smem-lmem0-emit
[612.915048] Dynamic subtest tile64-smem-lmem0-emit: SUCCESS (0.014s)
[612.928832] Starting dynamic subtest: tile64-lmem0-smem-emit
[612.975771] Dynamic subtest tile64-lmem0-smem-emit: SUCCESS (0.060s)
[612.991606] Starting dynamic subtest: tile64-lmem0-lmem0-emit
[613.037256] Dynamic subtest tile64-lmem0-lmem0-emit: SUCCESS (0.060s)
[613.038656] Subtest fast-copy-emit: SUCCESS (0.644s)
[613.223935] [132/133] (429s left) gem_mmap_offset (bad-extensions)
[613.269792] Starting subtest: bad-extensions
[613.271224] Subtest bad-extensions: SUCCESS (0.000s)
[613.448162] [133/133] (429s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[614.936577] Starting subtest: cursorA-vs-flipA-toggle
[625.844536] Subtest cursorA-vs-flipA-toggle: SUCCESS (10.908s)
[626.014335] Closing watchdogs
results: parsing output: 0/ for test: kms_cursor_legacy
results: parsing output: 1/ for test: gem_ctx_param
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_big_fb
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: api_intel_bb
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_color
results: parsing output: 9/ for test: gem_render_copy
results: parsing output: 10/ for test: gem_exec_store
results: parsing output: 11/ for test: kms_psr
results: parsing output: 12/ for test: testdisplay
results: parsing output: 13/ for test: kms_cursor_legacy
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: gem_partial_pwrite_pread
results: parsing output: 16/ for test: kms_big_fb
results: parsing output: 17/ for test: kms_cursor_crc
results: parsing output: 18/ for test: gem_workarounds
results: parsing output: 19/ for test: kms_getfb
results: parsing output: 20/ for test: kms_ccs
results: parsing output: 21/ for test: vgem_basic
results: parsing output: 22/ for test: kms_atomic
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: prime_self_import
results: parsing output: 25/ for test: gem_pxp
results: parsing output: 26/ for test: i915_drm_fdinfo
results: parsing output: 27/ for test: gem_exec_reloc
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: kms_plane_scaling
results: parsing output: 30/ for test: kms_psr
results: parsing output: 31/ for test: syncobj_timeline
results: parsing output: 32/ for test: kms_chamelium_frames
results: parsing output: 33/ for test: gem_exec_reloc
results: parsing output: 34/ for test: gem_basic
results: parsing output: 35/ for test: kms_plane_scaling
results: parsing output: 36/ for test: kms_addfb_basic
results: parsing output: 37/ for test: gem_userptr_blits
results: parsing output: 38/ for test: syncobj_wait
results: parsing output: 39/ for test: kms_big_fb
results: parsing output: 40/ for test: kms_hdr
results: parsing output: 41/ for test: kms_busy
results: parsing output: 42/ for test: kms_sequence
results: parsing output: 43/ for test: gem_exec_schedule
results: parsing output: 44/ for test: kms_flip_scaled_crc
results: parsing output: 45/ for test: gem_pwrite
results: parsing output: 46/ for test: i915_selftest
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_dsc
results: parsing output: 49/ for test: kms_flip
results: parsing output: 50/ for test: gem_ccs
results: parsing output: 51/ for test: kms_big_fb
results: parsing output: 52/ for test: kms_cursor_legacy
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: syncobj_timeline
results: parsing output: 55/ for test: i915_pm_rpm
results: parsing output: 56/ for test: gem_exec_balancer
results: parsing output: 57/ for test: kms_pm_rpm
results: parsing output: 58/ for test: kms_vrr
results: parsing output: 59/ for test: kms_chamelium_hpd
results: parsing output: 60/ for test: kms_big_fb
results: parsing output: 61/ for test: syncobj_wait
results: parsing output: 62/ for test: gem_exec_fence
results: parsing output: 63/ for test: kms_ccs
results: parsing output: 64/ for test: gem_spin_batch
results: parsing output: 65/ for test: gem_ctx_persistence
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: kms_cursor_legacy
results: parsing output: 68/ for test: i915_hangman
results: parsing output: 69/ for test: kms_fbcon_fbt
results: parsing output: 70/ for test: kms_psr
results: parsing output: 71/ for test: gem_exec_flush
results: parsing output: 72/ for test: gem_vm_create
results: parsing output: 73/ for test: kms_lease
results: parsing output: 74/ for test: device_reset
results: parsing output: 75/ for test: gem_tiled_blits
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_ccs
results: parsing output: 78/ for test: kms_psr2_su
results: parsing output: 79/ for test: kms_ccs
results: parsing output: 80/ for test: kms_addfb_basic
results: parsing output: 81/ for test: kms_plane
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: syncobj_timeline
results: parsing output: 84/ for test: gem_exec_reloc
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: gem_userptr_blits
results: parsing output: 87/ for test: gem_mmap_gtt
results: parsing output: 88/ for test: kms_properties
results: parsing output: 89/ for test: gem_exec_fence
results: parsing output: 90/ for test: kms_cursor_legacy
results: parsing output: 91/ for test: gem_exec_reloc
results: parsing output: 92/ for test: gem_exec_balancer
results: parsing output: 93/ for test: gem_ctx_shared
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: gem_eio
results: parsing output: 96/ for test: kms_cursor_crc
results: parsing output: 97/ for test: gem_exec_schedule
results: parsing output: 98/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 99/ for test: kms_chamelium_audio
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: gem_ctx_persistence
results: parsing output: 102/ for test: kms_cursor_crc
results: parsing output: 103/ for test: kms_pipe_crc_basic
results: parsing output: 104/ for test: syncobj_timeline
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_flip_scaled_crc
results: parsing output: 107/ for test: kms_plane_cursor
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_psr
results: parsing output: 110/ for test: api_intel_allocator
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: perf_pmu
results: parsing output: 113/ for test: vgem_basic
results: parsing output: 114/ for test: kms_pm_backlight
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: syncobj_timeline
results: parsing output: 117/ for test: kms_psr
results: parsing output: 118/ for test: kms_big_fb
results: parsing output: 119/ for test: gen3_mixed_blits
results: parsing output: 120/ for test: kms_psr2_sf
results: parsing output: 121/ for test: gem_exec_reloc
results: parsing output: 122/ for test: gem_exec_reloc
results: parsing output: 123/ for test: prime_vgem
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_psr2_sf
results: parsing output: 126/ for test: gen9_exec_parse
results: parsing output: 127/ for test: perf
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_content_protection
results: parsing output: 130/ for test: gem_exercise_blt
results: parsing output: 131/ for test: gem_mmap_offset
results: parsing output: 132/ for test: kms_cursor_legacy
Done.