[86.606844] Initializing watchdogs
[86.607033]   /dev/watchdog0
[86.644857] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3184 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 605]
[86.658585] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[86.664730] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[86.670205] [001/133] (960s left) kms_getfb (getfb2-handle-not-fb)
[86.854188] Starting subtest: getfb2-handle-not-fb
[86.855267] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[87.027672] [002/133] (960s left) kms_color (ctm-negative)
[87.190270] Starting subtest: ctm-negative
[87.191382] Starting dynamic subtest: pipe-A-HDMI-A-1
[88.352888] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.162s)
[88.367214] Starting dynamic subtest: pipe-A-HDMI-A-2
[89.024867] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.671s)
[89.040920] Starting dynamic subtest: pipe-B-HDMI-A-1
[89.687346] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.655s)
[89.701707] Starting dynamic subtest: pipe-B-HDMI-A-2
[90.327267] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.645s)
[90.342196] Starting dynamic subtest: pipe-C-HDMI-A-1
[90.973075] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.648s)
[90.987551] Starting dynamic subtest: pipe-C-HDMI-A-2
[91.624801] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.649s)
[91.628907] Subtest ctm-negative: SUCCESS (4.433s)
[91.903575] [003/133] (955s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[92.098882] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[92.101446] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[92.268562] [004/133] (955s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-pwrite)
[92.448867] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-pwrite
[95.101346] Subtest fbc-2p-primscrn-spr-indfb-draw-pwrite: SUCCESS (2.651s)
[95.345383] [005/133] (952s left) kms_chamelium_hpd (hdmi-hpd)
[95.861155] Subtest hdmi-hpd: SKIP (0.000s)
[96.082582] [006/133] (951s left) gem_render_copy (y-tiled)
[96.189390] Starting subtest: y-tiled
[96.190419] Starting dynamic subtest: smem
[96.409810] Dynamic subtest smem: SUCCESS (0.220s)
[96.410818] Subtest y-tiled: SUCCESS (0.221s)
[96.683539] [007/133] (950s left) kms_big_fb (linear-32bpp-rotate-0)
[96.865949] Starting subtest: linear-32bpp-rotate-0
[102.783262] Subtest linear-32bpp-rotate-0: SUCCESS (5.916s)
[103.418225] [008/133] (944s left) gem_create (create-clear)
[103.511860] Starting subtest: create-clear
[103.512861] Starting dynamic subtest: smem0
[136.897425] Dynamic subtest smem0: SUCCESS (33.385s)
[136.898230] Subtest create-clear: SUCCESS (33.386s)
[137.151698] [009/133] (910s left) gem_render_copy (yf-tiled-to-vebox-yf-tiled)
[137.264633] Starting subtest: yf-tiled-to-vebox-yf-tiled
[137.266365] Subtest yf-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[137.500904] [010/133] (910s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs)
[137.660257] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs
[137.663840] Starting dynamic subtest: pipe-A-HDMI-A-1
[137.672100] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.002s)
[137.687276] Starting dynamic subtest: pipe-A-HDMI-A-2
[137.695090] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.002s)
[137.710416] Starting dynamic subtest: pipe-B-HDMI-A-1
[137.719098] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.002s)
[137.735744] Starting dynamic subtest: pipe-B-HDMI-A-2
[137.745739] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.002s)
[137.761659] Starting dynamic subtest: pipe-C-HDMI-A-1
[137.769400] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.002s)
[137.784920] Starting dynamic subtest: pipe-C-HDMI-A-2
[137.792213] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.002s)
[137.793707] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SKIP (0.026s)
[138.558290] [011/133] (909s left) gem_ctx_persistence (legacy-engines-hostile-preempt)
[138.663966] Starting subtest: legacy-engines-hostile-preempt
[138.666373] Starting dynamic subtest: render
[138.763847] Dynamic subtest render: SUCCESS (0.097s)
[138.782232] Starting dynamic subtest: bsd
[138.864878] Dynamic subtest bsd: SUCCESS (0.098s)
[138.882940] Starting dynamic subtest: blt
[138.962590] Dynamic subtest blt: SUCCESS (0.095s)
[138.979982] Starting dynamic subtest: vebox
[139.059289] Dynamic subtest vebox: SUCCESS (0.092s)
[139.060415] Subtest legacy-engines-hostile-preempt: SUCCESS (0.393s)
[139.222538] [012/133] (908s left) perf_pmu (rc6-suspend)
[139.326039] Starting subtest: rc6-suspend
[161.859988] Subtest rc6-suspend: SUCCESS (8.083s)
[166.319632] [013/133] (885s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[166.496887] Starting subtest: plane-upscale-20x20-with-rotation
[166.499253] Starting dynamic subtest: pipe-A
[169.938265] Dynamic subtest pipe-A: SKIP (3.441s)
[169.957664] Starting dynamic subtest: pipe-B
[173.446062] Dynamic subtest pipe-B: SKIP (3.507s)
[173.465678] Starting dynamic subtest: pipe-C
[176.948967] Dynamic subtest pipe-C: SKIP (3.499s)
[176.950714] Subtest plane-upscale-20x20-with-rotation: SKIP (10.453s)
[177.438904] [014/133] (874s left) gem_pwrite (basic-random)
[177.582097] Starting subtest: basic-random
[183.596307] Subtest basic-random: SUCCESS (6.014s)
[183.767337] [015/133] (868s left) dmabuf_sync_file (import-basic)
[184.002018] Starting subtest: import-basic
[184.009040] Subtest import-basic: SUCCESS (0.007s)
[184.160353] [FACT dmabuf_sync_file (import-basic)] new: kernel.kmod_is_loaded.vgem: true
[184.165639] [016/133] (868s left) gem_ctx_param (non-root-set)
[184.258356] Starting subtest: non-root-set
[184.285602] Subtest non-root-set: SUCCESS (0.028s)
[184.448475] [017/133] (867s left) vgem_basic (dmabuf-fence-before)
[184.551808] Starting subtest: dmabuf-fence-before
[184.553077] Subtest dmabuf-fence-before: SUCCESS (0.002s)
[184.698498] [018/133] (867s left) gem_exec_fence (syncobj-timeline-unused-fence)
[185.323750] Starting subtest: syncobj-timeline-unused-fence
[185.329507] Subtest syncobj-timeline-unused-fence: SUCCESS (0.007s)
[185.633684] [019/133] (866s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt)
[185.820008] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt
[185.825377] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[185.997743] [020/133] (866s left) kms_vblank (accuracy-idle)
[186.162019] Starting subtest: accuracy-idle
[186.163565] Starting dynamic subtest: pipe-A-HDMI-A-1
[188.828977] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.659s)
[188.849956] Starting dynamic subtest: pipe-A-HDMI-A-2
[191.243256] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.412s)
[191.271442] Starting dynamic subtest: pipe-C-HDMI-A-1
[193.636040] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.380s)
[193.659024] Starting dynamic subtest: pipe-C-HDMI-A-2
[196.020202] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.380s)
[196.021526] Subtest accuracy-idle: SUCCESS (9.858s)
[196.326843] [021/133] (856s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area)
[196.495651] Subtest psr2-primary-plane-update-sf-dmg-area: SKIP (0.000s)
[196.603911] [022/133] (856s left) kms_plane_alpha_blend (constant-alpha-min)
[196.766322] Starting subtest: constant-alpha-min
[197.009461] Starting dynamic subtest: pipe-A-HDMI-A-1
[197.984705] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.974s)
[198.012242] Starting dynamic subtest: pipe-C-HDMI-A-1
[198.886172] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.896s)
[198.890188] Subtest constant-alpha-min: SUCCESS (2.122s)
[199.217233] [023/133] (853s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling)
[199.382255] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling
[199.384284] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling: SKIP (0.000s)
[199.549979] [024/133] (853s left) syncobj_timeline (invalid-signal-one-illegal-handle)
[199.645448] Starting subtest: invalid-signal-one-illegal-handle
[199.646479] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.001s)
[199.800665] [025/133] (853s left) kms_hdr (static-toggle)
[199.965422] Starting subtest: static-toggle
[226.797967] Subtest static-toggle: SKIP (26.832s)
[227.229937] [026/133] (826s left) kms_psr (fbc-psr-sprite-mmap-gtt)
[227.432975] Subtest fbc-psr-sprite-mmap-gtt: SKIP (0.000s)
[227.535720] [027/133] (825s left) kms_rotation_crc (primary-yf-tiled-reflect-x-270)
[227.699885] Starting subtest: primary-yf-tiled-reflect-x-270
[227.701838] Subtest primary-yf-tiled-reflect-x-270: SKIP (0.002s)
[227.858526] [028/133] (825s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-gtt)
[228.037989] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-gtt
[230.838323] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-gtt: SUCCESS (2.800s)
[231.095603] [029/133] (822s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[231.283837] Starting subtest: 4-tiled-16bpp-rotate-0
[231.285780] Subtest 4-tiled-16bpp-rotate-0: SKIP (0.000s)
[231.457900] [030/133] (822s left) gem_mmap_gtt (basic-small-copy)
[231.549545] Starting subtest: basic-small-copy
[233.679894] Subtest basic-small-copy: SUCCESS (2.128s)
[233.884683] [031/133] (819s left) prime_mmap_kms (buffer-sharing)
[234.170463] Starting subtest: buffer-sharing
[234.837475] Subtest buffer-sharing: SUCCESS (0.665s)
[235.140484] [032/133] (818s left) gem_softpin (noreloc)
[235.247591] Starting subtest: noreloc
[240.708999] Subtest noreloc: SUCCESS (5.462s)
[240.908769] [033/133] (812s left) kms_psr2_sf (pr-plane-move-sf-dmg-area)
[241.076451] Subtest pr-plane-move-sf-dmg-area: SKIP (0.000s)
[241.183597] [034/133] (812s left) kms_psr (fbc-pr-primary-page-flip)
[241.348935] Subtest fbc-pr-primary-page-flip: SKIP (0.000s)
[241.450529] [035/133] (812s left) gem_ctx_param (invalid-ctx-get)
[241.541730] Starting subtest: invalid-ctx-get
[241.542861] Subtest invalid-ctx-get: SUCCESS (0.000s)
[241.725534] [036/133] (812s left) gem_exec_schedule (preempt-self)
[241.854383] Starting subtest: preempt-self
[241.855583] Starting dynamic subtest: rcs0
[241.883564] Dynamic subtest rcs0: SUCCESS (0.028s)
[241.914341] Starting dynamic subtest: bcs0
[241.918581] Dynamic subtest bcs0: SUCCESS (0.032s)
[241.949593] Starting dynamic subtest: vcs0
[241.955793] Dynamic subtest vcs0: SUCCESS (0.034s)
[241.982759] Starting dynamic subtest: vecs0
[241.992121] Dynamic subtest vecs0: SUCCESS (0.032s)
[241.996949] Subtest preempt-self: SUCCESS (0.140s)
[242.426686] [037/133] (811s left) gem_spin_batch (resubmit-new)
[242.540033] Starting subtest: resubmit-new
[242.543661] Starting dynamic subtest: rcs0
[242.551087] Dynamic subtest rcs0: SUCCESS (0.009s)
[242.577552] Starting dynamic subtest: bcs0
[242.578855] Dynamic subtest bcs0: SUCCESS (0.009s)
[242.604345] Starting dynamic subtest: vcs0
[242.605508] Dynamic subtest vcs0: SUCCESS (0.006s)
[242.626797] Starting dynamic subtest: vecs0
[242.628139] Dynamic subtest vecs0: SUCCESS (0.007s)
[242.629392] Subtest resubmit-new: SUCCESS (0.045s)
[242.893434] [038/133] (811s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff)
[243.073887] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff
[243.075801] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[243.240600] [039/133] (811s left) kms_pm_rpm (pc8-residency)
[245.147918] Starting subtest: pc8-residency
[245.151207] Subtest pc8-residency: SKIP (0.000s)
[245.522646] [040/133] (809s left) kms_cursor_crc (cursor-random-512x512)
[245.706824] Starting subtest: cursor-random-512x512
[245.711929] Subtest cursor-random-512x512: SKIP (0.003s)
[245.904588] [041/133] (808s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic)
[246.069714] Starting subtest: 2x-flip-vs-cursor-atomic
[246.837893] Subtest 2x-flip-vs-cursor-atomic: SUCCESS (0.767s)
[247.164761] [042/133] (807s left) kms_psr (psr-cursor-plane-onoff)
[247.329407] Subtest psr-cursor-plane-onoff: SKIP (0.000s)
[247.427936] [043/133] (807s left) i915_pm_rpm (system-suspend)
[249.306211] Starting subtest: system-suspend