[90.222977] Initializing watchdogs
[90.223409]   /dev/watchdog0
[90.262712] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600]
[90.277700] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[90.285681] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[90.291447] [001/132] (960s left) gen9_exec_parse (basic-rejected-ctx-param)
[90.441463] Starting subtest: basic-rejected-ctx-param
[90.533539] Subtest basic-rejected-ctx-param: SUCCESS (0.091s)
[90.838244] [002/132] (960s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[91.054094] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[91.059277] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[91.199439] [003/132] (959s left) syncobj_timeline (32bits-limit)
[91.324293] Starting subtest: 32bits-limit
[91.329906] Subtest 32bits-limit: SUCCESS (0.004s)
[91.498237] [004/132] (959s left) gem_exec_schedule (lateslice)
[91.639159] Starting subtest: lateslice
[91.643199] Starting dynamic subtest: rcs0
[91.671193] Dynamic subtest rcs0: SUCCESS (0.033s)
[91.694733] Starting dynamic subtest: bcs0
[91.706542] Dynamic subtest bcs0: SUCCESS (0.033s)
[91.726394] Starting dynamic subtest: vcs0
[91.736170] Dynamic subtest vcs0: SUCCESS (0.029s)
[91.765090] Starting dynamic subtest: vecs0
[91.767444] Dynamic subtest vecs0: SUCCESS (0.032s)
[91.769856] Subtest lateslice: SUCCESS (0.129s)
[92.169900] [005/132] (958s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area-big-fb)
[92.360151] Subtest psr2-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s)
[92.451786] [006/132] (958s left) kms_content_protection (legacy-hdcp14)
[92.671141] Starting subtest: legacy-hdcp14
[92.728109] Subtest legacy-hdcp14: SKIP (0.054s)
[92.868885] [007/132] (958s left) gem_gpgpu_fill (basic)
[92.985818] Starting subtest: basic
[92.992288] Starting dynamic subtest: smem
[93.004193] Dynamic subtest smem: SUCCESS (0.017s)
[93.005840] Subtest basic: SUCCESS (0.018s)
[93.169597] [008/132] (958s left) kms_big_fb (linear-16bpp-rotate-270)
[93.380532] Starting subtest: linear-16bpp-rotate-270
[93.801095] Subtest linear-16bpp-rotate-270: SKIP (0.418s)
[94.051768] [009/132] (957s left) gem_exec_reloc (basic-write-read-noreloc)
[94.198199] Starting subtest: basic-write-read-noreloc
[94.204351] Subtest basic-write-read-noreloc: SUCCESS (0.010s)
[94.462945] [010/132] (957s left) gem_mmap_gtt (basic-small-copy-odd)
[94.572230] Starting subtest: basic-small-copy-odd
[97.421464] Subtest basic-small-copy-odd: SUCCESS (2.852s)
[97.569922] [011/132] (954s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area)
[97.926492] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.000s)
[98.021249] [012/132] (953s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt)
[98.244453] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt
[98.250114] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[98.391983] [013/132] (953s left) kms_lease (multimaster-lease)
[98.596467] Starting subtest: multimaster-lease
[98.598711] Subtest multimaster-lease: SUCCESS (0.009s)
[98.764931] [014/132] (953s left) kms_joiner (invalid-modeset-big-joiner)
[98.986358] Starting subtest: invalid-modeset-big-joiner
[98.991176] Subtest invalid-modeset-big-joiner: SKIP (0.000s)
[99.120974] [015/132] (952s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-pwrite)
[99.353993] Starting subtest: psr-1p-offscreen-pri-indfb-draw-pwrite
[99.357969] Subtest psr-1p-offscreen-pri-indfb-draw-pwrite: SKIP (0.000s)
[99.506300] [016/132] (952s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[99.718225] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[99.722644] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[99.898886] [017/132] (952s left) kms_dsc (dsc-with-formats)
[100.091256] Subtest dsc-with-formats: SKIP (0.000s)
[100.226572] [018/132] (952s left) core_setmaster (master-drop-set-user)
[100.420078] Starting subtest: master-drop-set-user
[100.466408] Subtest master-drop-set-user: SUCCESS (0.049s)
[100.571526] [019/132] (951s left) kms_psr (pr-sprite-mmap-cpu)
[100.759045] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[100.883546] [020/132] (951s left) perf_pmu (init-wait)
[101.015260] Starting subtest: init-wait
[101.017172] Starting dynamic subtest: rcs0
[101.020185] Dynamic subtest rcs0: SUCCESS (0.003s)
[101.041944] Starting dynamic subtest: bcs0
[101.043507] Dynamic subtest bcs0: SUCCESS (0.002s)
[101.062130] Starting dynamic subtest: vcs0
[101.063804] Dynamic subtest vcs0: SUCCESS (0.001s)
[101.088938] Starting dynamic subtest: vecs0
[101.096147] Dynamic subtest vecs0: SUCCESS (0.002s)
[101.099195] Subtest init-wait: SUCCESS (0.010s)
[101.178431] [021/132] (951s left) gem_pxp (display-protected-crc)
[103.824196] Starting subtest: display-protected-crc
[103.827520] Subtest display-protected-crc: SKIP (0.000s)
[103.947306] [022/132] (948s left) gem_exec_reloc (basic-cpu-read-noreloc)
[104.068859] Starting subtest: basic-cpu-read-noreloc
[104.087371] Subtest basic-cpu-read-noreloc: SUCCESS (0.017s)
[104.323847] [023/132] (948s left) kms_vblank (wait-forked-hang)
[104.507095] Starting subtest: wait-forked-hang
[104.508663] Starting dynamic subtest: pipe-A-HDMI-A-1
[111.870122] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (7.361s)
[111.914514] Starting dynamic subtest: pipe-A-HDMI-A-2
[118.852083] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (6.975s)
[118.892065] Starting dynamic subtest: pipe-C-HDMI-A-1
[125.802225] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (6.942s)
[125.823608] Starting dynamic subtest: pipe-C-HDMI-A-2
[132.853280] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (7.040s)
[132.858523] Subtest wait-forked-hang: SUCCESS (28.347s)
[133.156897] [024/132] (919s left) prime_vgem (sync)
[133.376684] Starting subtest: sync
[133.378504] Starting dynamic subtest: rcs0
[133.399947] Dynamic subtest rcs0: SUCCESS (0.021s)
[133.419957] Starting dynamic subtest: vcs0
[133.422223] Dynamic subtest vcs0: SUCCESS (0.020s)
[133.442865] Starting dynamic subtest: vecs0
[133.445169] Dynamic subtest vecs0: SUCCESS (0.022s)
[133.446873] Subtest sync: SUCCESS (0.065s)
[133.581736] [FACT prime_vgem (sync)] new: kernel.kmod_is_loaded.vgem: true
[133.586767] [025/132] (919s left) syncobj_timeline (etime-single-wait-submitted)
[133.691185] Starting subtest: etime-single-wait-submitted
[133.800836] Subtest etime-single-wait-submitted: SUCCESS (0.109s)
[133.954325] [026/132] (919s left) kms_chamelium_color (ctm-green-to-red)
[134.135037] Subtest ctm-green-to-red: SKIP (0.000s)
[134.240741] [027/132] (918s left) prime_udl
[134.455032] [028/132] (918s left) gem_exec_schedule (preempt-self)
[134.590926] Starting subtest: preempt-self
[134.594506] Starting dynamic subtest: rcs0
[134.623110] Dynamic subtest rcs0: SUCCESS (0.029s)
[134.645174] Starting dynamic subtest: bcs0
[134.664669] Dynamic subtest bcs0: SUCCESS (0.037s)
[134.688153] Starting dynamic subtest: vcs0
[134.691644] Dynamic subtest vcs0: SUCCESS (0.031s)
[134.716302] Starting dynamic subtest: vecs0
[134.727299] Dynamic subtest vecs0: SUCCESS (0.033s)
[134.730112] Subtest preempt-self: SUCCESS (0.137s)
[135.135714] [029/132] (918s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-render)
[135.323241] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-render
[137.827958] Subtest fbc-1p-offscreen-pri-shrfb-draw-render: SUCCESS (2.504s)
[138.101848] [030/132] (915s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[138.296238] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[138.299599] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[138.450913] [031/132] (915s left) gem_mmap_offset (perf)
[138.553722] Starting subtest: perf
[138.557395] Starting dynamic subtest: smem0
[138.839223] Dynamic subtest smem0: SUCCESS (0.283s)
[138.840878] Subtest perf: SUCCESS (0.284s)
[139.000263] [032/132] (914s left) gem_exec_reloc (basic-gtt-noreloc)
[139.110065] Starting subtest: basic-gtt-noreloc
[139.120073] Subtest basic-gtt-noreloc: SUCCESS (0.011s)
[139.351940] [033/132] (914s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-onoff)
[139.547998] Starting subtest: psr-1p-primscrn-spr-indfb-onoff
[139.553950] Subtest psr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[139.729537] [034/132] (914s left) gem_mmap_gtt (cpuset-basic-small-copy)
[139.835224] Starting subtest: cpuset-basic-small-copy
[143.605496] Subtest cpuset-basic-small-copy: SUCCESS (3.772s)
[143.760689] [035/132] (910s left) syncobj_basic (illegal-fd-to-handle)
[143.999249] Starting subtest: illegal-fd-to-handle
[144.000962] Subtest illegal-fd-to-handle: SUCCESS (0.000s)
[144.166274] [036/132] (909s left) syncobj_timeline (wait-all-interrupted)
[144.296487] Starting subtest: wait-all-interrupted
[144.401411] Subtest wait-all-interrupted: SUCCESS (0.104s)
[144.552475] [037/132] (909s left) gem_softpin (noreloc-interruptible)
[144.676259] Starting subtest: noreloc-interruptible
[150.149065] Subtest noreloc-interruptible: SUCCESS (5.461s)
[150.318921] [038/132] (903s left) syncobj_timeline (invalid-signal-illegal-handle)
[150.424600] Starting subtest: invalid-signal-illegal-handle
[150.426302] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[150.596619] [039/132] (903s left) syncobj_timeline (multi-wait-available-submitted-signaled)
[150.705210] Starting subtest: multi-wait-available-submitted-signaled
[150.707863] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.002s)
[150.851251] [040/132] (903s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area)
[151.045328] Subtest pr-primary-plane-update-sf-dmg-area: SKIP (0.000s)
[151.158486] [041/132] (903s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render)
[151.360461] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render
[153.980356] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SUCCESS (2.620s)
[154.199149] [042/132] (900s left) api_intel_bb (lot-of-buffers)
[154.304845] Starting subtest: lot-of-buffers
[160.249659] Subtest lot-of-buffers: SUCCESS (5.947s)
[160.603937] [043/132] (894s left) kms_rotation_crc (exhaust-fences)
[160.793555] Starting subtest: exhaust-fences
[163.276425] Subtest exhaust-fences: SUCCESS (2.483s)
[163.531079] [044/132] (891s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[163.737098] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu
[163.741192] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[163.884149] [045/132] (891s left) kms_plane_scaling (plane-downscale-factor-0-75-with-pixel-format)
[164.068389] Starting subtest: plane-downscale-factor-0-75-with-pixel-format
[164.070466] Starting dynamic subtest: pipe-A
[165.190063] Dynamic subtest pipe-A: SUCCESS (1.122s)
[165.237510] Starting dynamic subtest: pipe-B
[166.312781] Dynamic subtest pipe-B: SUCCESS (1.123s)
[166.336599] Starting dynamic subtest: pipe-C
[166.808073] Dynamic subtest pipe-C: SUCCESS (0.493s)
[166.810515] Subtest plane-downscale-factor-0-75-with-pixel-format: SUCCESS (2.740s)
[167.318192] [046/132] (887s left) i915_suspend (basic-s3-without-i915)
[167.425230] Starting subtest: basic-s3-without-i915