[85.097788] Initializing watchdogs [85.098057] /dev/watchdog0 [85.135785] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600] [85.150861] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [85.158954] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [85.164757] [001/131] (960s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc) [85.378449] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc [87.841445] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SUCCESS (2.463s) [88.050923] [002/131] (957s left) kms_addfb_basic (bo-too-small-due-to-tiling) [88.231877] Starting subtest: bo-too-small-due-to-tiling [88.233375] Subtest bo-too-small-due-to-tiling: SUCCESS (0.001s) [88.398693] [003/131] (957s left) gem_tiled_pread_pwrite [89.483181] [004/131] (956s left) kms_psr (fbc-pr-dpms) [89.794542] Subtest fbc-pr-dpms: SKIP (0.000s) [89.894319] [005/131] (956s left) gen9_exec_parse (batch-zero-length) [90.021132] Starting subtest: batch-zero-length [90.024423] Subtest batch-zero-length: SUCCESS (0.005s) [90.316210] [006/131] (955s left) gem_ctx_param (invalid-get-no-zeromap) [90.418722] Starting subtest: invalid-get-no-zeromap [90.420364] Subtest invalid-get-no-zeromap: SUCCESS (0.000s) [90.583831] [007/131] (955s left) prime_vgem (sync) [90.797415] Starting subtest: sync [90.798966] Starting dynamic subtest: rcs0 [90.824613] Dynamic subtest rcs0: SUCCESS (0.028s) [90.845309] Starting dynamic subtest: vcs0 [90.852501] Dynamic subtest vcs0: SUCCESS (0.025s) [90.875341] Starting dynamic subtest: vecs0 [90.877276] Dynamic subtest vecs0: SUCCESS (0.021s) [90.879636] Subtest sync: SUCCESS (0.081s) [91.071664] [FACT prime_vgem (sync)] new: kernel.kmod_is_loaded.vgem: true [91.076420] [008/131] (955s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-cpu) [91.267600] Starting subtest: psr-rgb565-draw-mmap-cpu [91.270750] Subtest psr-rgb565-draw-mmap-cpu: SKIP (0.000s) [91.438864] [009/131] (954s left) gem_exec_schedule (timeslicing) [91.568735] Starting subtest: timeslicing [91.570774] Starting dynamic subtest: rcs0 [91.578453] Dynamic subtest rcs0: SUCCESS (0.010s) [91.603026] Starting dynamic subtest: bcs0 [91.605148] Dynamic subtest bcs0: SUCCESS (0.009s) [91.623413] Starting dynamic subtest: vcs0 [91.625249] Dynamic subtest vcs0: SUCCESS (0.007s) [91.647656] Starting dynamic subtest: vecs0 [91.650323] Dynamic subtest vecs0: SUCCESS (0.008s) [91.652383] Subtest timeslicing: SUCCESS (0.036s) [92.010435] [010/131] (954s left) gem_exec_flush (basic-uc-pro-default) [92.132534] Starting subtest: basic-uc-pro-default [97.549701] Subtest basic-uc-pro-default: SUCCESS (5.417s) [97.845575] [011/131] (948s left) api_intel_allocator (fork-simple-once) [97.943940] Starting subtest: fork-simple-once [97.981503] Subtest fork-simple-once: SUCCESS (0.037s) [98.160754] [012/131] (948s left) gem_spin_batch (resubmit-all) [98.281960] Starting subtest: resubmit-all [98.284512] Starting dynamic subtest: rcs0 [98.295052] Dynamic subtest rcs0: SUCCESS (0.012s) [98.313949] Starting dynamic subtest: bcs0 [98.315465] Dynamic subtest bcs0: SUCCESS (0.011s) [98.333047] Starting dynamic subtest: vcs0 [98.334634] Dynamic subtest vcs0: SUCCESS (0.012s) [98.352134] Starting dynamic subtest: vecs0 [98.354317] Dynamic subtest vecs0: SUCCESS (0.011s) [98.356243] Subtest resubmit-all: SUCCESS (0.052s) [98.629595] [013/131] (948s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-sf) [98.826315] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s) [98.920908] [014/131] (947s left) kms_content_protection (uevent) [99.123824] Starting subtest: uevent [99.163177] Subtest uevent: SKIP (0.034s) [99.342849] [015/131] (947s left) i915_pm_freq_api (freq-suspend) [99.458188] Subtest freq-suspend: SKIP (0.000s) [99.572255] [016/131] (947s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt) [99.766995] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt [101.691171] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SUCCESS (1.925s) [101.927914] [017/131] (945s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0) [102.134277] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0 [103.639021] Subtest y-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.503s) [103.909708] [018/131] (943s left) sysfs_heartbeat_interval (nopreempt) [104.018226] Starting subtest: nopreempt [104.019826] Starting dynamic subtest: vecs0 [107.674220] Dynamic subtest vecs0: SUCCESS (3.654s) [107.741363] Starting dynamic subtest: vcs0 [111.276013] Dynamic subtest vcs0: SUCCESS (3.602s) [111.344059] Starting dynamic subtest: bcs0 [114.909231] Dynamic subtest bcs0: SUCCESS (3.632s) [114.944993] Starting dynamic subtest: rcs0 [118.691977] Dynamic subtest rcs0: SUCCESS (3.782s) [118.693762] Subtest nopreempt: SUCCESS (14.675s) [118.858868] [019/131] (928s left) kms_lease (lease-revoke) [119.039196] Starting subtest: lease-revoke [119.044411] Starting dynamic subtest: pipe-A-HDMI-A-1 [119.088672] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.043s) [119.153069] Starting dynamic subtest: pipe-A-HDMI-A-2 [119.155092] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.039s) [119.185866] Starting dynamic subtest: pipe-B-HDMI-A-1 [119.197658] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.062s) [119.220291] Starting dynamic subtest: pipe-B-HDMI-A-2 [119.250269] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.051s) [119.293472] Starting dynamic subtest: pipe-C-HDMI-A-1 [119.311793] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.055s) [119.352952] Starting dynamic subtest: pipe-C-HDMI-A-2 [119.373674] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.053s) [119.375108] Subtest lease-revoke: SUCCESS (0.335s) [119.562924] [020/131] (927s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180) [119.765969] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180 [119.770795] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s) [119.942179] [021/131] (927s left) perf_pmu (interrupts) [120.054815] Starting subtest: interrupts [121.160448] Subtest interrupts: SUCCESS (1.103s) [121.326180] [022/131] (926s left) i915_drm_fdinfo (busy-check-all) [121.430154] Starting subtest: busy-check-all [121.432834] Starting dynamic subtest: rcs0 [121.955807] Dynamic subtest rcs0: SUCCESS (0.524s) [121.975484] Starting dynamic subtest: bcs0 [122.492224] Dynamic subtest bcs0: SUCCESS (0.536s) [122.512284] Starting dynamic subtest: vcs0 [123.019602] Dynamic subtest vcs0: SUCCESS (0.526s) [123.040565] Starting dynamic subtest: vecs0 [123.551885] Dynamic subtest vecs0: SUCCESS (0.531s) [123.553480] Subtest busy-check-all: SUCCESS (2.122s) [123.729081] [023/131] (923s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt) [123.911638] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt [123.915299] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [124.094561] [024/131] (923s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled) [124.202776] Starting subtest: multi-wait-all-for-submit-available-signaled [124.206332] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.003s) [124.376600] [025/131] (923s left) kms_big_fb (x-tiled-32bpp-rotate-270) [124.567300] Starting subtest: x-tiled-32bpp-rotate-270 [124.853950] Subtest x-tiled-32bpp-rotate-270: SKIP (0.285s) [125.110585] [026/131] (922s left) i915_suspend (forcewake) [125.208536] Starting subtest: forcewake