[90.190375] Initializing watchdogs
[90.190554]   /dev/watchdog0
[90.230121] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3184 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 605]
[90.244236] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[90.250821] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[90.256209] [001/133] (960s left) gen9_exec_parse (unaligned-jump)
[90.395638] Starting subtest: unaligned-jump
[90.704684] Subtest unaligned-jump: SUCCESS (0.309s)
[90.973914] [002/133] (959s left) kms_pipe_stress (stress-xrgb8888-yftiled)
[91.162055] Starting subtest: stress-xrgb8888-yftiled
[105.583999] Subtest stress-xrgb8888-yftiled: SUCCESS (14.426s)
[106.098317] [003/133] (944s left) kms_psr (psr-cursor-plane-move)
[106.275375] Subtest psr-cursor-plane-move: SKIP (0.000s)
[106.359717] [004/133] (944s left) gem_lmem_swapping (heavy-verify-random)
[106.460888] Subtest heavy-verify-random: SKIP (0.000s)
[106.553452] [005/133] (944s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[106.731823] Starting subtest: fbc-rgb565-draw-mmap-wc
[109.478512] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (2.745s)
[109.735225] [006/133] (941s left) syncobj_wait (wait-for-submit-snapshot)
[109.829664] Starting subtest: wait-for-submit-snapshot
[109.917351] Subtest wait-for-submit-snapshot: SUCCESS (0.087s)
[110.036609] [007/133] (941s left) kms_atomic_transition (modeset-transition-nonblocking-fencing)
[110.203615] Starting subtest: modeset-transition-nonblocking-fencing
[110.205389] Starting dynamic subtest: 1x-outputs
[113.733180] Dynamic subtest 1x-outputs: SUCCESS (3.529s)
[113.749037] Starting dynamic subtest: 2x-outputs
[121.111768] Dynamic subtest 2x-outputs: SUCCESS (7.377s)
[121.112907] Subtest modeset-transition-nonblocking-fencing: SUCCESS (10.907s)
[121.384780] [008/133] (929s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[121.563932] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[121.565966] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[121.702172] [009/133] (929s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw)
[121.883019] Starting subtest: fbcpsr-2p-pri-indfb-multidraw
[121.885396] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s)
[122.017368] [010/133] (929s left) gem_softpin (noreloc)
[122.125407] Starting subtest: noreloc
[127.566076] Subtest noreloc: SUCCESS (5.437s)
[127.703784] [011/133] (923s left) kms_chamelium_audio (hdmi-audio)
[128.243476] Subtest hdmi-audio: SKIP (0.000s)
[128.469630] [012/133] (923s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move)
[128.653422] Starting subtest: psr-1p-primscrn-spr-indfb-move
[128.655396] Subtest psr-1p-primscrn-spr-indfb-move: SKIP (0.000s)
[128.799489] [013/133] (922s left) kms_big_fb (y-tiled-8bpp-rotate-180)
[128.995715] Starting subtest: y-tiled-8bpp-rotate-180
[132.069712] Subtest y-tiled-8bpp-rotate-180: SUCCESS (3.072s)
[132.361169] [014/133] (919s left) kms_pwrite_crc
[133.724771] [015/133] (918s left) syncobj_wait (invalid-multi-wait-unsubmitted)
[133.820483] Starting subtest: invalid-multi-wait-unsubmitted
[133.821452] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[133.941312] [016/133] (917s left) gem_exec_params (cliprects-invalid)
[134.040912] Starting subtest: cliprects-invalid
[134.042075] Subtest cliprects-invalid: SUCCESS (0.000s)
[134.191388] [017/133] (917s left) sw_sync (timeline_closed)
[134.282959] Starting subtest: timeline_closed
[134.283972] Subtest timeline_closed: SUCCESS (0.000s)
[134.392578] [018/133] (917s left) gem_ctx_sseu (engines)
[134.494053] Subtest engines: SKIP (0.000s)
[134.583981] [019/133] (917s left) kms_chamelium_color (gamma)
[134.752230] Subtest gamma: SKIP (0.000s)
[134.832786] [020/133] (917s left) gem_exec_schedule (thriceslice)
[134.950889] Starting subtest: thriceslice
[134.951997] Starting dynamic subtest: rcs0
[134.963768] Dynamic subtest rcs0: SUCCESS (0.012s)
[134.983640] Starting dynamic subtest: bcs0
[134.984805] Dynamic subtest bcs0: SUCCESS (0.013s)
[135.003515] Starting dynamic subtest: vcs0
[135.004460] Dynamic subtest vcs0: SUCCESS (0.008s)
[135.019483] Starting dynamic subtest: vecs0
[135.020351] Dynamic subtest vecs0: SUCCESS (0.010s)
[135.021263] Subtest thriceslice: SUCCESS (0.046s)
[135.377517] [021/133] (916s left) kms_addfb_basic (size-max)
[135.551432] Starting subtest: size-max
[135.552487] Subtest size-max: SUCCESS (0.000s)
[135.691706] [022/133] (916s left) perf (global-sseu-config-invalid)
[135.898132] Starting subtest: global-sseu-config-invalid
[135.899423] Starting dynamic subtest: 0-rcs0
[135.925830] Dynamic subtest 0-rcs0: SUCCESS (0.027s)
[135.926836] Subtest global-sseu-config-invalid: SUCCESS (0.028s)
[136.008998] [023/133] (916s left) gem_exec_create (madvise)
[136.125514] Starting subtest: madvise
[136.126794] Starting dynamic subtest: smem
[156.277285] Dynamic subtest smem: SUCCESS (20.152s)
[156.278359] Subtest madvise: SUCCESS (20.153s)
[157.741213] [024/133] (894s left) kms_cursor_legacy (cursorb-vs-flipb-atomic)
[157.907330] Starting subtest: cursorB-vs-flipB-atomic
[169.153337] Subtest cursorB-vs-flipB-atomic: SUCCESS (11.249s)
[169.429388] [025/133] (883s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[169.607545] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[169.609335] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[169.746457] [026/133] (882s left) gem_exec_params (cliprects_ptr-dirt)
[169.848027] Starting subtest: cliprects_ptr-dirt
[169.849159] Subtest cliprects_ptr-dirt: SUCCESS (0.001s)
[169.979334] [027/133] (882s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-plflip-blt)
[170.162806] Starting subtest: psr-2p-primscrn-shrfb-plflip-blt
[170.164906] Subtest psr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[170.294948] [028/133] (882s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area-big-fb)
[170.463608] Subtest psr2-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s)
[170.554338] [029/133] (882s left) kms_rotation_crc (primary-yf-tiled-reflect-x-270)
[170.718090] Starting subtest: primary-yf-tiled-reflect-x-270
[170.719814] Subtest primary-yf-tiled-reflect-x-270: SKIP (0.003s)
[170.844607] [030/133] (882s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[171.021669] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[171.023654] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[171.161780] [031/133] (881s left) gen7_exec_parse (bitmasks)
[171.261463] Subtest bitmasks: SKIP (0.000s)
[171.355346] [032/133] (881s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[171.528139] Starting subtest: addfb25-x-tiled-mismatch-legacy
[171.528990] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.001s)
[171.661225] [033/133] (881s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[171.756890] Starting subtest: etime-multi-wait-all-submitted-signaled
[171.866902] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.109s)
[172.000063] [034/133] (881s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-pwrite)
[172.180547] Starting subtest: psr-1p-primscrn-pri-indfb-draw-pwrite
[172.182485] Subtest psr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[172.329662] [035/133] (881s left) gem_exec_reloc (basic-write-cpu-active)
[172.436441] Starting subtest: basic-write-cpu-active
[172.572785] Subtest basic-write-cpu-active: SUCCESS (0.136s)
[172.764023] [036/133] (880s left) gem_pxp (dmabuf-shared-protected-dst-is-context-refcounted)
[175.394349] Starting subtest: dmabuf-shared-protected-dst-is-context-refcounted
[175.396341] Subtest dmabuf-shared-protected-dst-is-context-refcounted: SKIP (0.000s)
[175.546451] [037/133] (877s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[175.717034] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[175.718975] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[175.831396] [038/133] (877s left) syncobj_wait (reset-during-wait-for-submit)
[175.930464] Starting subtest: reset-during-wait-for-submit
[176.036347] Subtest reset-during-wait-for-submit: SUCCESS (0.106s)
[176.177246] [039/133] (877s left) kms_plane_scaling (planes-upscale-20x20)
[176.345779] Starting subtest: planes-upscale-20x20
[176.346809] Starting dynamic subtest: pipe-A
[176.635904] Dynamic subtest pipe-A: SUCCESS (0.293s)
[176.652426] Starting dynamic subtest: pipe-B
[176.977288] Dynamic subtest pipe-B: SUCCESS (0.340s)
[176.994948] Starting dynamic subtest: pipe-C
[177.028629] Dynamic subtest pipe-C: SUCCESS (0.050s)
[177.029553] Subtest planes-upscale-20x20: SUCCESS (0.686s)
[177.458257] [040/133] (876s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[177.564266] Starting subtest: no-spare-fences-interruptible
[179.728748] Subtest no-spare-fences-interruptible: SUCCESS (2.165s)
[179.994686] [041/133] (873s left) kms_tiled_display (basic-test-pattern-with-chamelium)
[180.240761] Starting subtest: basic-test-pattern-with-chamelium
[180.242755] Subtest basic-test-pattern-with-chamelium: SKIP (0.001s)
[180.362118] [042/133] (873s left) kms_pm_dc (dc3co-vpb-simulation)
[181.492195] Starting subtest: dc3co-vpb-simulation
[181.494056] Subtest dc3co-vpb-simulation: SKIP (0.000s)
[181.610657] [043/133] (872s left) kms_pipe_crc_basic (bad-source)
[181.728138] Starting subtest: bad-source
[181.729092] Subtest bad-source: SUCCESS (0.001s)
[181.844769] [044/133] (872s left) gem_exec_params (rel-constants-invalid-ring)
[181.947881] Starting subtest: rel-constants-invalid-ring
[181.949126] Subtest rel-constants-invalid-ring: SUCCESS (0.001s)
[182.095374] [045/133] (872s left) gem_exec_balancer (hang)
[182.327911] Starting subtest: hang
[186.358511] Subtest hang: SUCCESS (4.031s)
[186.499297] [046/133] (867s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[187.212736] Starting subtest: syncobj-timeline-multiple-ext-nodes
[187.215449] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.003s)
[187.525154] [FACT gem_exec_fence (syncobj-timeline-multiple-ext-nodes)] new: kernel.kmod_is_loaded.vgem: true
[187.528955] [047/133] (866s left) kms_plane_multiple (2x-tiling-4)
[187.648567] Starting subtest: 2x-tiling-4
[187.650544] Subtest 2x-tiling-4: SKIP (0.000s)
[187.770697] [048/133] (866s left) gem_gtt_cpu_tlb
[188.024266] [049/133] (866s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc)
[188.146497] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc
[188.147465] Starting dynamic subtest: pipe-A-HDMI-A-1
[188.188634] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.010s)
[188.205322] Starting dynamic subtest: pipe-A-HDMI-A-2
[188.246426] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.011s)
[188.263762] Starting dynamic subtest: pipe-B-HDMI-A-1
[188.301278] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.011s)
[188.318253] Starting dynamic subtest: pipe-B-HDMI-A-2
[188.352552] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.011s)
[188.368978] Starting dynamic subtest: pipe-C-HDMI-A-1
[188.405037] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.011s)
[188.421608] Starting dynamic subtest: pipe-C-HDMI-A-2
[188.457774] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.011s)
[188.459468] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc: SKIP (0.083s)
[189.114652] [050/133] (865s left) kms_getfb (getfb2-handle-not-fb)
[189.237490] Starting subtest: getfb2-handle-not-fb
[189.238566] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[189.379300] [051/133] (865s left) kms_feature_discovery (psr1)
[189.501293] Starting subtest: psr1
[189.503300] Subtest psr1: SKIP (0.000s)
[189.629406] [052/133] (865s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf)
[189.752480] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[189.855919] [053/133] (864s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move)
[189.992996] Starting subtest: fbc-2p-primscrn-cur-indfb-move
[192.944554] Subtest fbc-2p-primscrn-cur-indfb-move: SUCCESS (2.950s)
[193.181856] [054/133] (861s left) perf (short-reads)
[193.378895] Starting subtest: short-reads
[193.429732] Subtest short-reads: SUCCESS (0.049s)
[193.534783] [055/133] (861s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping)
[193.657309] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping
[193.659214] Subtest pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping: SKIP (0.000s)
[193.796518] [056/133] (861s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[193.926979] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (0.000s)
[194.036183] [057/133] (861s left) kms_cursor_crc (cursor-onscreen-256x85)
[194.171930] Starting subtest: cursor-onscreen-256x85
[194.208838] Starting dynamic subtest: pipe-A-HDMI-A-1
[196.913904] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.697s)
[196.980099] Starting dynamic subtest: pipe-C-HDMI-A-1
[199.349302] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.383s)
[199.350243] Subtest cursor-onscreen-256x85: SUCCESS (5.175s)
[199.648500] [058/133] (855s left) kms_psr (fbc-psr-cursor-plane-onoff)
[199.776518] Subtest fbc-psr-cursor-plane-onoff: SKIP (0.000s)
[199.871701] [059/133] (855s left) sysfs_heartbeat_interval (mixed)
[199.972459] Starting subtest: mixed
[199.975124] Starting dynamic subtest: vecs0
[205.187137] Dynamic subtest vecs0: SUCCESS (5.212s)
[205.205827] Starting dynamic subtest: vcs0
[210.386060] Dynamic subtest vcs0: SUCCESS (5.196s)
[210.404983] Starting dynamic subtest: bcs0
[215.620590] Dynamic subtest bcs0: SUCCESS (5.232s)
[215.639913] Starting dynamic subtest: rcs0
[220.882363] Dynamic subtest rcs0: SUCCESS (5.257s)
[220.884844] Subtest mixed: SUCCESS (20.908s)
[221.051071] [060/133] (834s left) kms_color (ctm-0-75)
[221.175308] Starting subtest: ctm-0-75
[221.176221] Starting dynamic subtest: pipe-A-HDMI-A-1
[223.927026] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.748s)
[223.947556] Starting dynamic subtest: pipe-A-HDMI-A-2
[226.394213] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.470s)
[226.412200] Starting dynamic subtest: pipe-B-HDMI-A-1
[228.795136] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.391s)
[228.812594] Starting dynamic subtest: pipe-B-HDMI-A-2
[231.189298] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (2.398s)
[231.206388] Starting dynamic subtest: pipe-C-HDMI-A-1
[233.602335] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.413s)
[233.619421] Starting dynamic subtest: pipe-C-HDMI-A-2
[236.022377] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.414s)
[236.023318] Subtest ctm-0-75: SUCCESS (14.845s)
[236.312216] [061/133] (819s left) gem_pxp (reject-modify-context-protection-off-3)
[238.958297] Starting subtest: reject-modify-context-protection-off-3
[238.960194] Subtest reject-modify-context-protection-off-3: SKIP (0.000s)
[239.093868] [062/133] (816s left) kms_frontbuffer_tracking (psr-rgb101010-draw-blt)
[239.229908] Starting subtest: psr-rgb101010-draw-blt
[239.231773] Subtest psr-rgb101010-draw-blt: SKIP (0.000s)
[239.378883] [063/133] (816s left) kms_cursor_legacy (forked-bo)
[239.501865] Starting subtest: forked-bo
[239.502747] Starting dynamic subtest: pipe-A
[244.939284] Dynamic subtest pipe-A: SUCCESS (5.435s)
[244.975416] Starting dynamic subtest: pipe-B
[250.417797] Dynamic subtest pipe-B: SUCCESS (5.478s)
[250.438200] Starting dynamic subtest: pipe-C
[255.896603] Dynamic subtest pipe-C: SUCCESS (5.477s)
[255.942058] Starting dynamic subtest: all-pipes
[261.344953] Dynamic subtest all-pipes: SUCCESS (5.446s)
[261.346099] Subtest forked-bo: SUCCESS (21.846s)
[261.497384] [064/133] (794s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[261.630986] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[261.633185] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[261.779432] [065/133] (794s left) fbdev (unaligned-read)
[261.879827] Starting subtest: unaligned-read
[261.905729] Subtest unaligned-read: SUCCESS (0.026s)
[262.028775] [066/133] (793s left) gem_ctx_isolation (nonpriv-switch)
[262.144870] Starting subtest: nonpriv-switch
[262.146364] Starting dynamic subtest: rcs0
[264.196382] Dynamic subtest rcs0: SUCCESS (2.046s)
[264.215240] Starting dynamic subtest: bcs0
[266.706982] Dynamic subtest bcs0: SUCCESS (2.513s)
[266.725952] Starting dynamic subtest: vcs0
[268.711300] Dynamic subtest vcs0: SUCCESS (2.002s)
[268.730873] Starting dynamic subtest: vecs0
[270.676972] Dynamic subtest vecs0: SUCCESS (1.963s)
[270.678240] Subtest nonpriv-switch: SUCCESS (8.533s)
[270.931779] [067/133] (785s left) kms_psr (psr-sprite-mmap-gtt)
[271.051985] Subtest psr-sprite-mmap-gtt: SKIP (0.000s)
[271.153907] [068/133] (785s left) gem_render_copy (yf-tiled-to-vebox-linear)
[271.261186] Starting subtest: yf-tiled-to-vebox-linear
[271.263249] Subtest yf-tiled-to-vebox-linear: SKIP (0.000s)
[271.512976] [069/133] (784s left) kms_content_protection (atomic)
[271.662172] Starting subtest: atomic
[271.698094] Subtest atomic: SKIP (0.028s)
[271.845238] [070/133] (784s left) syncobj_eventfd (timeline-wait-before-signal)
[271.940867] Starting subtest: timeline-wait-before-signal
[271.972614] Subtest timeline-wait-before-signal: SUCCESS (0.032s)
[272.112770] [071/133] (784s left) kms_flip (flip-vs-suspend)
[272.235922] Starting subtest: flip-vs-suspend
[272.239258] Starting dynamic subtest: A-HDMI-A1