[88.791147] Initializing watchdogs
[88.791364]   /dev/watchdog0
[88.831460] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600]
[88.846638] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[88.854658] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[88.860985] [001/133] (960s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[89.065681] Starting subtest: compare-crc-sanitycheck-nv12
[89.069067] Starting dynamic subtest: pipe-A-HDMI-A-1
[90.063493] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.998s)
[90.095187] Starting dynamic subtest: pipe-B-HDMI-A-2
[90.776097] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.700s)
[90.801884] Starting dynamic subtest: pipe-C-HDMI-A-1
[91.445162] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.665s)
[91.448114] Subtest compare-crc-sanitycheck-nv12: SUCCESS (2.383s)
[91.777680] [002/133] (957s left) kms_addfb_basic (bad-pitch-256)
[91.888721] Starting subtest: bad-pitch-256
[91.891081] Subtest bad-pitch-256: SUCCESS (0.000s)
[92.115706] [003/133] (957s left) gem_mmap_wc (write-read-distinct)
[92.222814] Starting subtest: write-read-distinct
[92.231206] Subtest write-read-distinct: SUCCESS (0.010s)
[92.366526] [004/133] (957s left) gem_render_copy (mixed-tiled-to-yf-tiled-ccs)
[92.485745] Starting subtest: mixed-tiled-to-yf-tiled-ccs
[92.487477] Starting dynamic subtest: smem
[92.842604] Dynamic subtest smem: SUCCESS (0.357s)
[92.844272] Subtest mixed-tiled-to-yf-tiled-ccs: SUCCESS (0.358s)
[93.097473] [005/133] (956s left) gem_render_linear_blits (basic)
[93.221255] Starting subtest: basic
[93.297965] Subtest basic: SUCCESS (0.076s)
[93.409175] [006/133] (956s left) kms_chamelium_hpd (vga-hpd)
[93.994133] Subtest vga-hpd: SKIP (0.000s)
[94.274160] [007/133] (955s left) kms_psr (fbc-pr-sprite-plane-onoff)
[94.474052] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[94.568070] [008/133] (955s left) syncobj_eventfd (timeline-wait-before-signal)
[94.677128] Starting subtest: timeline-wait-before-signal
[94.713892] Subtest timeline-wait-before-signal: SUCCESS (0.035s)
[94.877336] [009/133] (955s left) sriov_basic (enable-vfs-bind-unbind-each-numvfs-all)
[94.985080] Subtest enable-vfs-bind-unbind-each-numvfs-all: SKIP (0.000s)
[95.089536] [010/133] (955s left) kms_plane_multiple (tiling-none)
[95.269237] Starting subtest: tiling-none
[95.270775] Starting dynamic subtest: pipe-A-HDMI-A-1
[97.074938] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.803s)
[97.112451] Starting dynamic subtest: pipe-A-HDMI-A-2
[98.758834] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (1.679s)
[98.802303] Starting dynamic subtest: pipe-B-HDMI-A-1
[100.442416] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (1.674s)
[100.483587] Starting dynamic subtest: pipe-B-HDMI-A-2
[102.103218] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (1.655s)
[102.130603] Starting dynamic subtest: pipe-C-HDMI-A-1
[103.732062] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.626s)
[103.775088] Starting dynamic subtest: pipe-C-HDMI-A-2
[105.333350] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (1.597s)
[105.336035] Subtest tiling-none: SUCCESS (10.062s)
[105.713243] [011/133] (944s left) gem_render_copy (y-tiled-ccs-to-y-tiled-mc-ccs)
[105.848112] Starting subtest: y-tiled-ccs-to-y-tiled-mc-ccs
[105.851309] Subtest y-tiled-ccs-to-y-tiled-mc-ccs: SKIP (0.000s)
[106.122408] [012/133] (944s left) gem_ctx_isolation (dirty-switch)
[106.255930] Starting subtest: dirty-switch
[106.257770] Starting dynamic subtest: rcs0
[106.862294] Dynamic subtest rcs0: SUCCESS (0.610s)
[106.885282] Starting dynamic subtest: bcs0
[107.846357] Dynamic subtest bcs0: SUCCESS (0.975s)
[107.867839] Starting dynamic subtest: vcs0
[108.451152] Dynamic subtest vcs0: SUCCESS (0.607s)
[108.470118] Starting dynamic subtest: vecs0
[109.049282] Dynamic subtest vecs0: SUCCESS (0.598s)
[109.052641] Subtest dirty-switch: SUCCESS (2.798s)
[109.297526] [013/133] (941s left) gem_flink_basic (bad-open)
[109.397614] Starting subtest: bad-open
[109.399377] Subtest bad-open: SUCCESS (0.000s)
[109.529601] [014/133] (940s left) gem_exec_balancer (bonded-false-hang)
[109.776861] Starting subtest: bonded-false-hang
[113.993444] Subtest bonded-false-hang: SUCCESS (4.215s)
[114.134536] [015/133] (936s left) gem_softpin (allocator-nopin-reserve)
[114.251088] Starting subtest: allocator-nopin-reserve
[114.496907] Subtest allocator-nopin-reserve: SUCCESS (0.232s)
[114.649308] [016/133] (935s left) kms_chamelium_color (ctm-green-to-red)
[114.847594] Subtest ctm-green-to-red: SKIP (0.000s)
[114.949177] [017/133] (935s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[115.150336] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[115.155130] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[115.289318] [018/133] (935s left) perf_pmu (most-busy-check-all)
[115.405136] Starting subtest: most-busy-check-all
[115.409143] Starting dynamic subtest: rcs0
[115.933169] Dynamic subtest rcs0: SUCCESS (0.526s)
[115.952396] Starting dynamic subtest: bcs0
[116.452861] Dynamic subtest bcs0: SUCCESS (0.519s)
[116.472262] Starting dynamic subtest: vcs0
[116.976047] Dynamic subtest vcs0: SUCCESS (0.522s)
[116.995501] Starting dynamic subtest: vecs0
[117.501166] Dynamic subtest vecs0: SUCCESS (0.523s)
[117.504110] Subtest most-busy-check-all: SUCCESS (2.094s)
[117.661698] [019/133] (933s left) gem_exec_balancer (parallel-contexts)
[117.908245] Subtest parallel-contexts: SKIP (0.000s)
[118.049446] [020/133] (932s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-pwrite)
[118.241084] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-pwrite
[120.433691] Subtest fbc-2p-scndscrn-spr-indfb-draw-pwrite: SUCCESS (2.189s)
[120.663700] [021/133] (930s left) kms_rotation_crc (primary-y-tiled-reflect-x-270)
[120.845764] Starting subtest: primary-y-tiled-reflect-x-270
[120.854096] Subtest primary-y-tiled-reflect-x-270: SKIP (0.004s)
[120.979232] [022/133] (930s left) perf (create-destroy-userspace-config)
[121.193115] Starting subtest: create-destroy-userspace-config
[121.247158] Subtest create-destroy-userspace-config: SUCCESS (0.054s)
[121.348504] [023/133] (929s left) gem_pxp (display-protected-crc)
[123.994650] Starting subtest: display-protected-crc
[123.998340] Subtest display-protected-crc: SKIP (0.000s)
[124.135532] [024/133] (927s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[124.324637] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[124.327514] Starting dynamic subtest: pipe-A-valid-mode
[124.931832] Dynamic subtest pipe-A-valid-mode: SKIP (0.607s)
[124.935476] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SKIP (0.612s)
[125.379629] [025/133] (926s left) kms_psr (psr-primary-page-flip)
[125.572807] Subtest psr-primary-page-flip: SKIP (0.000s)
[125.665198] [026/133] (925s left) gem_exec_parallel (basic)
[125.795974] Starting subtest: basic
[125.798122] Starting dynamic subtest: rcs0
[128.890996] Dynamic subtest rcs0: SUCCESS (3.096s)
[128.916722] Starting dynamic subtest: bcs0
[132.160589] Dynamic subtest bcs0: SUCCESS (3.266s)
[132.186019] Starting dynamic subtest: vcs0
[135.288082] Dynamic subtest vcs0: SUCCESS (3.125s)
[135.311145] Starting dynamic subtest: vecs0
[138.472919] Dynamic subtest vecs0: SUCCESS (3.184s)
[138.474482] Subtest basic: SUCCESS (12.679s)
[138.734821] [027/133] (912s left) kms_color (ctm-0-75)
[138.906085] Starting subtest: ctm-0-75
[138.908095] Starting dynamic subtest: pipe-A-HDMI-A-1
[141.754152] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.844s)
[141.776302] Starting dynamic subtest: pipe-A-HDMI-A-2
[144.354157] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.596s)
[144.385199] Starting dynamic subtest: pipe-B-HDMI-A-1
[146.821309] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.464s)
[146.843892] Starting dynamic subtest: pipe-B-HDMI-A-2
[149.379642] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (2.554s)
[149.409853] Starting dynamic subtest: pipe-C-HDMI-A-1
[151.865070] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.483s)
[151.884755] Starting dynamic subtest: pipe-C-HDMI-A-2
[154.384994] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.515s)
[154.388891] Subtest ctm-0-75: SUCCESS (15.475s)
[154.672284] [028/133] (897s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[154.901636] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[154.907173] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[155.039472] [029/133] (896s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier)
[155.232807] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier
[155.237160] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier: SKIP (0.000s)
[155.426918] [030/133] (896s left) kms_addfb_basic (basic-y-tiled-legacy)
[155.533150] Starting subtest: basic-y-tiled-legacy
[155.535139] Subtest basic-y-tiled-legacy: SUCCESS (0.001s)
[155.754560] [031/133] (896s left) kms_big_fb (yf-tiled-32bpp-rotate-180)
[155.949160] Starting subtest: yf-tiled-32bpp-rotate-180
[161.033799] Subtest yf-tiled-32bpp-rotate-180: SUCCESS (5.085s)
[161.455808] [032/133] (890s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[161.639234] Starting subtest: cursorA-vs-flipA-toggle
[172.988452] Subtest cursorA-vs-flipA-toggle: SUCCESS (11.348s)
[173.317033] [033/133] (878s left) kms_plane (plane-position-hole-dpms)
[173.513571] Starting subtest: plane-position-hole-dpms
[174.312674] Starting dynamic subtest: pipe-A-plane-1
[175.225168] Dynamic subtest pipe-A-plane-1: SUCCESS (0.907s)
[175.273450] Starting dynamic subtest: pipe-A-plane-2
[176.098775] Dynamic subtest pipe-A-plane-2: SUCCESS (0.868s)
[176.120262] Starting dynamic subtest: pipe-A-plane-3
[177.082803] Dynamic subtest pipe-A-plane-3: SUCCESS (0.978s)
[177.128276] Starting dynamic subtest: pipe-A-plane-4
[177.139539] Dynamic subtest pipe-A-plane-4: SUCCESS (0.012s)
[177.594417] Starting dynamic subtest: pipe-B-plane-1
[178.381833] Dynamic subtest pipe-B-plane-1: SUCCESS (0.819s)
[178.421089] Starting dynamic subtest: pipe-B-plane-2
[179.216334] Dynamic subtest pipe-B-plane-2: SUCCESS (0.826s)
[179.264523] Starting dynamic subtest: pipe-B-plane-3
[180.065733] Dynamic subtest pipe-B-plane-3: SUCCESS (0.849s)
[180.099459] Starting dynamic subtest: pipe-B-plane-4
[180.106391] Dynamic subtest pipe-B-plane-4: SUCCESS (0.012s)
[180.108300] Subtest plane-position-hole-dpms: SUCCESS (6.565s)
[180.476290] [034/133] (871s left) gem_ctx_persistence (legacy-engines-hang)
[180.592097] Starting subtest: legacy-engines-hang
[180.599196] Starting dynamic subtest: render
[180.623734] Dynamic subtest render: SUCCESS (0.028s)
[180.647991] Starting dynamic subtest: bsd
[180.668934] Dynamic subtest bsd: SUCCESS (0.034s)
[180.696765] Starting dynamic subtest: blt
[180.701373] Dynamic subtest blt: SKIP (0.005s)
[180.725463] Starting dynamic subtest: vebox
[180.727247] Dynamic subtest vebox: SUCCESS (0.036s)
[180.729891] Subtest legacy-engines-hang: SUCCESS (0.124s)
[180.866920] [035/133] (871s left) kms_cursor_legacy (flip-vs-cursor-crc-legacy)
[181.043067] Starting subtest: flip-vs-cursor-crc-legacy
[182.009644] Subtest flip-vs-cursor-crc-legacy: SUCCESS (0.964s)
[182.342929] [036/133] (870s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-render)
[182.561109] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-render
[185.170694] Subtest fbc-2p-primscrn-spr-indfb-draw-render: SUCCESS (2.611s)
[185.439432] [037/133] (867s left) kms_prime (basic-crc-vgem)
[185.759693] Starting subtest: basic-crc-vgem
[185.761389] Starting dynamic subtest: second-to-first
[187.393122] Dynamic subtest second-to-first: SUCCESS (1.628s)
[187.401279] Subtest basic-crc-vgem: SUCCESS (1.632s)
[187.678225] [FACT kms_prime (basic-crc-vgem)] new: kernel.kmod_is_loaded.vgem: true
[187.684627] [038/133] (864s left) gem_lmem_swapping (heavy-verify-random-ccs)
[187.803422] Subtest heavy-verify-random-ccs: SKIP (0.000s)
[187.927423] [039/133] (864s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-move)
[188.121116] Starting subtest: fbc-1p-primscrn-spr-indfb-move
[191.387623] Subtest fbc-1p-primscrn-spr-indfb-move: SUCCESS (3.267s)
[191.688216] [040/133] (861s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[191.903555] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[191.907396] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[192.054165] [041/133] (860s left) api_intel_bb (object-noreloc-keep-cache-simple)
[192.160322] Starting subtest: object-noreloc-keep-cache-simple
[192.172800] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.010s)
[192.367432] [042/133] (860s left) gem_workarounds (suspend-resume-context)
[192.510263] Starting subtest: suspend-resume-context