[94.321954] Initializing watchdogs
[94.322290]   /dev/watchdog0
[94.362681] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600]
[94.377547] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[94.385876] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[94.391670] [001/132] (960s left) kms_pm_dc (dc9-dpms)
[95.605138] Starting subtest: dc9-dpms
[95.610803] Subtest dc9-dpms: SKIP (0.000s)
[95.746594] [002/132] (959s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[95.932997] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[95.935627] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.000s)
[96.068483] [003/132] (958s left) gem_exec_params (invalid-bsd2-flag-on-render)
[96.188305] Starting subtest: invalid-bsd2-flag-on-render
[96.190120] Subtest invalid-bsd2-flag-on-render: SUCCESS (0.001s)
[96.318309] [004/132] (958s left) gem_userptr_blits (sync-unmap-cycles)
[96.453988] Starting subtest: sync-unmap-cycles
[101.856293] Subtest sync-unmap-cycles: SUCCESS (5.400s)
[102.021171] [005/132] (953s left) gen9_exec_parse (allowed-all)
[102.148248] Starting subtest: allowed-all
[102.153194] Subtest allowed-all: SUCCESS (0.004s)
[102.402084] [006/132] (952s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted)
[102.506392] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[102.507677] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.003s)
[102.636569] [007/132] (952s left) kms_psr (fbc-psr2-primary-blt)
[102.825129] Subtest fbc-psr2-primary-blt: SKIP (0.000s)
[102.934366] [008/132] (952s left) gem_ctx_persistence (engines-mixed)
[103.090078] Starting subtest: engines-mixed
[103.095473] Starting dynamic subtest: rcs0
[103.132483] Dynamic subtest rcs0: SUCCESS (0.041s)
[103.163107] Starting dynamic subtest: bcs0
[103.169086] Dynamic subtest bcs0: SUCCESS (0.036s)
[103.197490] Starting dynamic subtest: vcs0
[103.203181] Dynamic subtest vcs0: SUCCESS (0.036s)
[103.222283] Starting dynamic subtest: vecs0
[103.245192] Dynamic subtest vecs0: SUCCESS (0.038s)
[103.246773] Subtest engines-mixed: SUCCESS (0.155s)
[103.387299] [009/132] (952s left) gem_softpin (allocator-basic)
[103.502490] Starting subtest: allocator-basic
[103.739585] Subtest allocator-basic: SUCCESS (0.230s)
[103.885462] [010/132] (951s left) kms_cursor_legacy (cursorb-vs-flipb-atomic)
[104.064483] Starting subtest: cursorB-vs-flipB-atomic
[115.449396] Subtest cursorB-vs-flipB-atomic: SUCCESS (11.380s)
[115.750708] [011/132] (939s left) gem_exec_params (no-blt)
[115.872231] Starting subtest: no-blt
[115.880082] Subtest no-blt: SUCCESS (0.003s)
[116.022072] [012/132] (939s left) kms_cursor_crc (cursor-onscreen-32x10)
[116.215084] Starting subtest: cursor-onscreen-32x10
[116.454124] Subtest cursor-onscreen-32x10: SKIP (0.238s)
[116.602672] [013/132] (939s left) template (a)
[116.708525] Starting subtest: A
[116.710235] Subtest A: SUCCESS (0.000s)
[116.836549] [014/132] (939s left) gem_exec_fence (parallel)
[117.101172] Starting subtest: parallel
[117.102427] Starting dynamic subtest: rcs0
[119.253153] Dynamic subtest rcs0: SUCCESS (2.150s)
[119.277951] Starting dynamic subtest: bcs0
[121.407072] Dynamic subtest bcs0: SUCCESS (2.153s)
[121.437447] Starting dynamic subtest: vcs0
[123.560868] Dynamic subtest vcs0: SUCCESS (2.156s)
[123.589370] Starting dynamic subtest: vecs0
[125.711838] Dynamic subtest vecs0: SUCCESS (2.152s)
[125.713193] Subtest parallel: SUCCESS (8.613s)
[126.477318] [FACT gem_exec_fence (parallel)] new: kernel.kmod_is_loaded.vgem: true
[126.483260] [015/132] (929s left) i915_drm_fdinfo (memory-info-idle)
[126.589075] Starting subtest: memory-info-idle
[126.591292] Starting dynamic subtest: smem0
[126.623652] Dynamic subtest smem0: SUCCESS (0.034s)
[126.627826] Subtest memory-info-idle: SUCCESS (0.034s)
[126.764775] [016/132] (929s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)
[126.956900] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt
[129.908726] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (2.948s)
[130.218063] [017/132] (926s left) kms_sequence (queue-idle)
[130.398244] Starting subtest: queue-idle
[130.400339] Starting dynamic subtest: pipe-A-HDMI-A-1
[133.170459] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.770s)
[133.215094] Starting dynamic subtest: pipe-A-HDMI-A-2
[135.607104] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.430s)
[135.640395] Starting dynamic subtest: pipe-B-HDMI-A-1
[138.028141] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.416s)
[138.065446] Starting dynamic subtest: pipe-B-HDMI-A-2
[140.450099] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (2.417s)
[140.469722] Starting dynamic subtest: pipe-C-HDMI-A-1
[142.852943] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.401s)
[142.875044] Starting dynamic subtest: pipe-C-HDMI-A-2
[145.264383] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.402s)
[145.267590] Subtest queue-idle: SUCCESS (14.860s)
[145.542695] [018/132] (910s left) gem_exec_capture (capture-recoverable)
[145.662596] Starting subtest: capture-recoverable
[145.665577] Subtest capture-recoverable: SKIP (0.000s)
[145.806807] [019/132] (910s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[146.005246] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt
[146.008591] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[146.159342] [020/132] (910s left) syncobj_timeline (single-wait-for-submit-signaled)
[146.264318] Starting subtest: single-wait-for-submit-signaled
[146.265578] Subtest single-wait-for-submit-signaled: SUCCESS (0.001s)
[146.410724] [021/132] (910s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[146.606514] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt
[146.612102] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[146.757852] [022/132] (909s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-pwrite)
[146.959125] Starting subtest: psr-1p-primscrn-cur-indfb-draw-pwrite
[146.962736] Subtest psr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[147.107863] [023/132] (909s left) gem_exec_schedule (u-fairslice)
[147.242194] Starting subtest: u-fairslice
[147.245462] Starting dynamic subtest: rcs0
[149.276457] Dynamic subtest rcs0: SUCCESS (2.029s)
[149.295119] Starting dynamic subtest: bcs0
[151.309391] Dynamic subtest bcs0: SUCCESS (2.032s)
[151.327813] Starting dynamic subtest: vcs0
[153.333324] Dynamic subtest vcs0: SUCCESS (2.024s)
[153.351856] Starting dynamic subtest: vecs0
[155.353839] Dynamic subtest vecs0: SUCCESS (2.022s)
[155.355138] Subtest u-fairslice: SUCCESS (8.110s)
[155.760318] [024/132] (901s left) gem_exec_schedule (implicit-write-read)
[155.888600] Starting subtest: implicit-write-read
[155.890885] Starting dynamic subtest: rcs0
[156.014465] Dynamic subtest rcs0: SUCCESS (0.120s)
[156.039362] Starting dynamic subtest: bcs0
[156.151341] Dynamic subtest bcs0: SUCCESS (0.134s)
[156.182461] Starting dynamic subtest: vcs0
[156.279527] Dynamic subtest vcs0: SUCCESS (0.121s)
[156.298619] Starting dynamic subtest: vecs0
[156.396949] Dynamic subtest vecs0: SUCCESS (0.123s)
[156.403822] Subtest implicit-write-read: SUCCESS (0.504s)
[156.794713] [025/132] (900s left) kms_frontbuffer_tracking (basic)
[156.995475] Starting subtest: basic
[160.484484] Subtest basic: SUCCESS (3.486s)
[160.724939] [026/132] (896s left) syncobj_basic (bad-fd-to-handle)
[160.831196] Starting subtest: bad-fd-to-handle
[160.833299] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[160.977686] [027/132] (896s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[161.169766] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[161.173245] Subtest psr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[161.309065] [028/132] (895s left) perf (gen12-unprivileged-single-ctx-counters)
[161.517115] Starting subtest: gen12-unprivileged-single-ctx-counters
[161.520579] Subtest gen12-unprivileged-single-ctx-counters: SKIP (0.000s)
[161.626599] [029/132] (895s left) kms_scaling_modes (scaling-mode-center)
[161.807670] Starting subtest: scaling-mode-center
[161.822172] Subtest scaling-mode-center: SKIP (0.004s)
[161.941981] [030/132] (895s left) kms_big_fb (x-tiled-16bpp-rotate-270)
[162.158070] Starting subtest: x-tiled-16bpp-rotate-270
[162.490699] Subtest x-tiled-16bpp-rotate-270: SKIP (0.330s)
[162.725649] [031/132] (894s left) sysfs_preempt_timeout (timeout)
[162.844423] Starting subtest: timeout
[162.846337] Starting dynamic subtest: vecs0
[163.749323] Dynamic subtest vecs0: SUCCESS (0.900s)
[163.774383] Starting dynamic subtest: vcs0
[164.579951] Dynamic subtest vcs0: SUCCESS (0.830s)
[164.603447] Starting dynamic subtest: bcs0
[165.410167] Dynamic subtest bcs0: SUCCESS (0.831s)
[165.433365] Starting dynamic subtest: rcs0
[166.234109] Dynamic subtest rcs0: SUCCESS (0.823s)
[166.236726] Subtest timeout: SUCCESS (3.389s)
[166.407073] [032/132] (891s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[166.598185] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[166.602327] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[166.743589] [033/132] (891s left) kms_psr (fbc-pr-no-drrs)
[166.919334] Subtest fbc-pr-no-drrs: SKIP (0.000s)
[167.033752] [034/132] (890s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt)
[167.234102] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt
[170.169462] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (2.930s)
[170.442281] [035/132] (887s left) gem_lmem_swapping (parallel-multi)
[170.556162] Subtest parallel-multi: SKIP (0.000s)
[170.667864] [036/132] (887s left) i915_query (hwconfig_table)
[170.768413] Starting subtest: hwconfig_table
[170.771882] Subtest hwconfig_table: SKIP (0.000s)
[170.908085] [037/132] (887s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping)
[171.088021] Starting subtest: pixel-format-y-tiled-modifier-source-clamping
[171.314699] Starting dynamic subtest: pipe-A-plane-0
[172.148326] Dynamic subtest pipe-A-plane-0: SUCCESS (0.833s)
[172.167751] Starting dynamic subtest: pipe-A-plane-1
[172.930165] Dynamic subtest pipe-A-plane-1: SUCCESS (0.783s)
[172.950591] Starting dynamic subtest: pipe-A-plane-2
[173.514255] Dynamic subtest pipe-A-plane-2: SUCCESS (0.582s)
[173.533534] Starting dynamic subtest: pipe-A-plane-3
[174.079983] Dynamic subtest pipe-A-plane-3: SUCCESS (0.565s)
[174.451114] Starting dynamic subtest: pipe-B-plane-0
[175.167518] Dynamic subtest pipe-B-plane-0: SUCCESS (0.733s)
[175.187251] Starting dynamic subtest: pipe-B-plane-1
[175.950658] Dynamic subtest pipe-B-plane-1: SUCCESS (0.782s)
[175.970883] Starting dynamic subtest: pipe-B-plane-2
[176.501319] Dynamic subtest pipe-B-plane-2: SUCCESS (0.550s)
[176.520492] Starting dynamic subtest: pipe-B-plane-3
[177.082905] Dynamic subtest pipe-B-plane-3: SUCCESS (0.582s)
[177.302342] Subtest pixel-format-y-tiled-modifier-source-clamping: SUCCESS (6.218s)
[177.620713] [038/132] (880s left) i915_pm_rc6_residency (rc6-accuracy)
[177.725103] Starting subtest: rc6-accuracy
[177.727192] Starting dynamic subtest: gt0
[180.904612] Dynamic subtest gt0: SUCCESS (3.174s)
[180.905991] Subtest rc6-accuracy: SUCCESS (3.177s)
[181.043081] [039/132] (877s left) gem_fenced_exec_thrash (2-spare-fences)
[181.151552] Starting subtest: 2-spare-fences
[183.333934] Subtest 2-spare-fences: SUCCESS (2.168s)
[183.473759] [040/132] (874s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[183.658106] Starting subtest: basic-flip-before-cursor-atomic
[184.970299] Subtest basic-flip-before-cursor-atomic: SUCCESS (1.318s)
[185.253955] [041/132] (873s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa
[185.366934] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled
[185.370440] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.002s)
[185.519776] [042/132] (873s left) kms_cursor_legacy (single-move)
[185.710551] Starting subtest: single-move
[185.715033] Starting dynamic subtest: pipe-A
[191.116073] Dynamic subtest pipe-A: SUCCESS (5.401s)
[191.137111] Starting dynamic subtest: pipe-B
[196.536062] Dynamic subtest pipe-B: SUCCESS (5.417s)
[196.624936] Starting dynamic subtest: pipe-C
[201.947124] Dynamic subtest pipe-C: SUCCESS (5.407s)
[201.974984] Starting dynamic subtest: all-pipes
[207.343335] Dynamic subtest all-pipes: SUCCESS (5.399s)
[207.345368] Subtest single-move: SUCCESS (21.631s)
[207.507136] [043/132] (851s left) kms_ccs (crc-primary-suspend-y-tiled-ccs)
[207.685165] Starting subtest: crc-primary-suspend-y-tiled-ccs
[207.687602] Starting dynamic subtest: pipe-A-HDMI-A-1