[59.550475] Initializing watchdogs
[59.550522]   /dev/watchdog0
[59.564725] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[59.569857] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.572372] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.575953] [001/132] (960s left) gem_close_race (basic-threads)
[59.678041] Starting subtest: basic-threads
[61.130838] Subtest basic-threads: SUCCESS (1.452s)
[61.308267] [002/132] (958s left) syncobj_timeline (multi-wait-all-signaled)
[61.374618] Starting subtest: multi-wait-all-signaled
[61.377091] Subtest multi-wait-all-signaled: SUCCESS (0.001s)
[61.468691] [003/132] (958s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[61.580849] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip
[62.594113] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.012s)
[62.725952] [004/132] (957s left) kms_getfb (getfb-handle-not-fb)
[62.824974] Starting subtest: getfb-handle-not-fb
[62.827164] Subtest getfb-handle-not-fb: SUCCESS (0.000s)
[62.926332] [005/132] (957s left) kms_chamelium_hpd (vga-hpd-for-each-pipe)
[63.306309] Subtest vga-hpd-for-each-pipe: SKIP (0.000s)
[64.073442] [006/132] (956s left) i915_drm_fdinfo (all-busy-idle-check-all)
[64.114555] Starting subtest: all-busy-idle-check-all
[64.121380] Subtest all-busy-idle-check-all: SKIP (0.004s)
[64.181729] [007/132] (956s left) kms_force_connector_basic (prune-stale-modes)
[64.269848] Starting subtest: prune-stale-modes
[64.713453] Subtest prune-stale-modes: SUCCESS (0.442s)
[64.850550] [008/132] (955s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-render)
[64.952520] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-render
[64.956945] Subtest fbc-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[65.056976] [009/132] (955s left) kms_ccs (bad-pixel-format-y-tiled-ccs)
[65.136108] Starting subtest: bad-pixel-format-y-tiled-ccs
[65.138086] Starting dynamic subtest: pipe-A-eDP-1
[65.156835] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[65.163382] Starting dynamic subtest: pipe-B-eDP-1
[65.180928] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[65.186863] Starting dynamic subtest: pipe-C-eDP-1
[65.204019] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[65.210149] Starting dynamic subtest: pipe-D-eDP-1
[65.227934] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[65.231549] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.003s)
[67.456844] [010/132] (953s left) gem_exec_balancer (parallel-contexts)
[67.808277] Starting subtest: parallel-contexts
[70.516542] Subtest parallel-contexts: SUCCESS (2.709s)
[70.620901] [011/132] (949s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[70.715331] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[70.719957] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[70.799970] [012/132] (949s left) kms_plane_multiple (2x-tiling-4)
[70.881076] Starting subtest: 2x-tiling-4
[70.885165] Subtest 2x-tiling-4: SKIP (0.000s)
[70.948865] [013/132] (949s left) syncobj_wait (invalid-single-wait-all-unsubmitted)
[70.996790] Starting subtest: invalid-single-wait-all-unsubmitted
[70.999068] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s)
[71.082334] [014/132] (949s left) kms_psr (fbc-pr-sprite-plane-onoff)
[71.168489] Starting subtest: fbc-pr-sprite-plane-onoff
[71.172933] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[71.241422] [015/132] (949s left) gem_exec_reloc (basic-gtt-read-noreloc)
[71.301061] Subtest basic-gtt-read-noreloc: SKIP (0.000s)
[71.371355] [016/132] (949s left) gem_ctx_param (root-set)
[71.422665] Starting subtest: root-set
[71.425084] Subtest root-set: SUCCESS (0.001s)
[71.516220] [017/132] (949s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[71.567143] Starting subtest: multi-wait-all-for-submit-unsubmitted
[71.674183] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.105s)
[71.745034] [018/132] (949s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-signaled)
[71.805146] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[71.807308] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[71.886265] [019/132] (948s left) i915_pm_rpm (gem-execbuf-stress-pc8)
[74.015061] Starting subtest: gem-execbuf-stress-pc8
[74.051893] Subtest gem-execbuf-stress-pc8: SKIP (0.038s)
[74.389810] [020/132] (946s left) gem_exec_fence (syncobj-export)
[74.861197] Starting subtest: syncobj-export
[74.865924] Subtest syncobj-export: SUCCESS (0.005s)
[75.997281] [FACT gem_exec_fence (syncobj-export)] new: kernel.kmod_is_loaded.vgem: true
[76.000371] [021/132] (944s left) drm_mm (drm_mm)
[76.036504] Starting subtest: drm_mm
[76.041103] Starting dynamic subtest: drm_test_mm_init
[76.128514] Dynamic subtest drm_test_mm_init: SUCCESS (0.086s)
[76.137501] Starting dynamic subtest: drm_test_mm_debug
[76.224337] Dynamic subtest drm_test_mm_debug: SUCCESS (0.095s)
[76.232421] Starting dynamic subtest: drm_test_mm_align32
[76.318179] Dynamic subtest drm_test_mm_align32: SUCCESS (0.094s)
[76.325030] Starting dynamic subtest: drm_test_mm_align64
[76.437284] Dynamic subtest drm_test_mm_align64: SUCCESS (0.118s)
[76.445295] Starting dynamic subtest: drm_test_mm_lowest
[76.533511] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.096s)
[76.542636] Starting dynamic subtest: drm_test_mm_highest
[76.647357] Dynamic subtest drm_test_mm_highest: SUCCESS (0.112s)
[76.649772] Subtest drm_mm: SUCCESS (0.610s)
[76.808983] [022/132] (944s left) kms_psr2_sf (pr-plane-move-sf-dmg-area)
[76.904405] Starting subtest: pr-plane-move-sf-dmg-area
[76.908859] Subtest pr-plane-move-sf-dmg-area: SKIP (0.000s)
[76.968675] [023/132] (943s left) kms_psr (pr-sprite-render)
[77.065062] Starting subtest: pr-sprite-render
[77.069485] Subtest pr-sprite-render: SKIP (0.000s)
[77.136168] [024/132] (943s left) kms_plane_scaling (plane-downscale-factor-0-5-with-pixel-format)
[77.228472] Starting subtest: plane-downscale-factor-0-5-with-pixel-format
[77.230921] Starting dynamic subtest: pipe-A
[77.251713] Dynamic subtest pipe-A: SKIP (0.020s)
[77.259189] Starting dynamic subtest: pipe-B
[77.284126] Dynamic subtest pipe-B: SKIP (0.034s)
[77.291620] Starting dynamic subtest: pipe-C
[77.318994] Dynamic subtest pipe-C: SKIP (0.033s)
[77.326331] Starting dynamic subtest: pipe-D
[77.348357] Dynamic subtest pipe-D: SKIP (0.029s)
[77.352062] Subtest plane-downscale-factor-0-5-with-pixel-format: SKIP (0.117s)
[77.437543] [025/132] (943s left) kms_mmap_write_crc (main)
[77.529201] Starting subtest: main
[77.531550] Starting dynamic subtest: pipe-A-eDP-1
[80.985175] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.449s)
[80.987451] Subtest main: SUCCESS (3.450s)
[81.820841] [026/132] (939s left) kms_ccs (crc-primary-suspend-4-tiled-lnl-ccs)
[81.922377] Starting subtest: crc-primary-suspend-4-tiled-lnl-ccs
[81.927205] Subtest crc-primary-suspend-4-tiled-lnl-ccs: SKIP (0.000s)
[83.024129] [027/132] (938s left) gem_render_copy (yf-tiled-to-vebox-x-tiled)
[83.089158] Starting subtest: yf-tiled-to-vebox-x-tiled
[83.093446] Subtest yf-tiled-to-vebox-x-tiled: SKIP (0.000s)
[83.268860] [028/132] (937s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0)
[83.390239] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0
[83.394637] Subtest y-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[83.498362] [029/132] (937s left) kms_async_flips (async-flip-hang)
[83.602965] Starting subtest: async-flip-hang
[83.979548] Starting dynamic subtest: pipe-A-eDP-1
[110.387542] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.400s)
[110.771396] Starting dynamic subtest: pipe-B-eDP-1
[126.382835] Dynamic subtest pipe-B-eDP-1: SUCCESS (15.613s)
[126.788015] Starting dynamic subtest: pipe-C-eDP-1
[142.380951] Dynamic subtest pipe-C-eDP-1: SUCCESS (15.598s)
[142.756519] Starting dynamic subtest: pipe-D-eDP-1
[158.382046] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.632s)
[158.384700] Subtest async-flip-hang: SUCCESS (74.772s)
[159.625799] [030/132] (861s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping)
[159.724651] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping
[159.749974] Starting dynamic subtest: pipe-A-plane-0
[160.038869] Dynamic subtest pipe-A-plane-0: SUCCESS (0.289s)
[160.052795] Starting dynamic subtest: pipe-A-plane-3
[160.283303] Dynamic subtest pipe-A-plane-3: SUCCESS (0.243s)
[161.374476] Starting dynamic subtest: pipe-B-plane-0
[161.668758] Dynamic subtest pipe-B-plane-0: SUCCESS (0.300s)
[161.676680] Starting dynamic subtest: pipe-B-plane-3
[161.902177] Dynamic subtest pipe-B-plane-3: SUCCESS (0.233s)
[162.218094] Subtest pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping: SUCCESS (2.496s)
[163.026233] [031/132] (858s left) kms_plane_cursor (overlay)
[163.125095] Starting subtest: overlay
[163.129641] Starting dynamic subtest: pipe-A-eDP-1-size-64
[165.603668] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.479s)
[165.662537] Starting dynamic subtest: pipe-A-eDP-1-size-128
[168.159558] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.505s)
[168.218807] Starting dynamic subtest: pipe-A-eDP-1-size-256
[170.639078] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.427s)
[170.995297] Starting dynamic subtest: pipe-B-eDP-1-size-64
[174.196779] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.215s)
[174.258878] Starting dynamic subtest: pipe-B-eDP-1-size-128
[176.821211] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.571s)
[176.878763] Starting dynamic subtest: pipe-B-eDP-1-size-256
[179.331838] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.459s)
[179.685676] Starting dynamic subtest: pipe-C-eDP-1-size-64
[182.445894] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.767s)
[182.481298] Starting dynamic subtest: pipe-C-eDP-1-size-128
[184.566164] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.091s)
[184.603246] Starting dynamic subtest: pipe-C-eDP-1-size-256
[186.689349] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.091s)
[187.019335] Starting dynamic subtest: pipe-D-eDP-1-size-64
[189.848088] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.837s)
[189.886097] Starting dynamic subtest: pipe-D-eDP-1-size-128
[192.013481] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.136s)
[192.050602] Starting dynamic subtest: pipe-D-eDP-1-size-256
[194.191358] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.147s)
[194.510657] Subtest overlay: SUCCESS (31.385s)
[195.321365] [032/132] (825s left) vgem_slow (nohang)
[195.387673] Starting subtest: nohang
[205.428588] Subtest nohang: SUCCESS (10.043s)
[205.493818] [033/132] (815s left) kms_big_fb (x-tiled-16bpp-rotate-0)
[205.603198] Starting subtest: x-tiled-16bpp-rotate-0
[206.949393] Subtest x-tiled-16bpp-rotate-0: SUCCESS (1.345s)
[207.067921] [034/132] (814s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[207.165092] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[207.168765] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[207.285101] [035/132] (814s left) gem_ctx_persistence (saturated-hostile-nopreempt)
[207.343111] Starting subtest: saturated-hostile-nopreempt
[207.345116] Starting dynamic subtest: rcs0
[207.412246] Dynamic subtest rcs0: SKIP (0.067s)
[207.421572] Starting dynamic subtest: bcs0
[207.430945] Dynamic subtest bcs0: SKIP (0.017s)
[207.438280] Starting dynamic subtest: vcs0
[207.448941] Dynamic subtest vcs0: SKIP (0.017s)
[207.456952] Starting dynamic subtest: vcs1
[207.467168] Dynamic subtest vcs1: SKIP (0.017s)
[207.474070] Starting dynamic subtest: vecs0
[207.479836] Dynamic subtest vecs0: SKIP (0.012s)
[207.486680] Starting dynamic subtest: ccs0
[207.495943] Dynamic subtest ccs0: SKIP (0.015s)
[207.499765] Subtest saturated-hostile-nopreempt: SKIP (0.151s)
[207.565708] [036/132] (813s left) kms_psr (fbc-psr-sprite-plane-move)
[207.645457] Starting subtest: fbc-psr-sprite-plane-move
[207.647493] Starting dynamic subtest: eDP-1
[207.650864] Dynamic subtest eDP-1: SKIP (0.000s)
[207.654313] Subtest fbc-psr-sprite-plane-move: SKIP (0.001s)
[207.715825] [037/132] (813s left) kms_cursor_crc (cursor-onscreen-64x64)
[207.886895] Starting subtest: cursor-onscreen-64x64
[207.891426] Starting dynamic subtest: pipe-A-eDP-1
[209.980000] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.087s)
[210.008099] Starting dynamic subtest: pipe-D-eDP-1
[212.778230] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.776s)
[212.780430] Subtest cursor-onscreen-64x64: SUCCESS (4.890s)
[213.607904] [038/132] (807s left) gem_basic (bad-close)
[213.678284] Starting subtest: bad-close
[213.682768] Subtest bad-close: SUCCESS (0.000s)
[213.778519] [039/132] (807s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[213.879607] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt
[213.884080] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[213.985643] [040/132] (807s left) kms_plane_scaling (planes-downscale-factor-0-5)
[214.082971] Starting subtest: planes-downscale-factor-0-5
[214.085326] Starting dynamic subtest: pipe-A
[214.103080] Dynamic subtest pipe-A: SKIP (0.017s)
[214.111337] Starting dynamic subtest: pipe-B
[214.134651] Dynamic subtest pipe-B: SKIP (0.030s)
[214.141943] Starting dynamic subtest: pipe-C
[214.164915] Dynamic subtest pipe-C: SKIP (0.031s)
[214.172075] Starting dynamic subtest: pipe-D
[214.195251] Dynamic subtest pipe-D: SKIP (0.030s)
[214.199631] Subtest planes-downscale-factor-0-5: SKIP (0.110s)
[214.280093] [041/132] (807s left) kms_big_fb (y-tiled-32bpp-rotate-270)
[214.380213] Starting subtest: y-tiled-32bpp-rotate-270
[214.384601] Subtest y-tiled-32bpp-rotate-270: SKIP (0.000s)
[214.475147] [042/132] (807s left) gem_render_copy_redux (normal)
[214.529344] Starting subtest: normal
[214.793214] Subtest normal: SUCCESS (0.264s)
[214.886499] [043/132] (806s left) kms_rotation_crc (primary-yf-tiled-reflect-x-270)
[214.972577] Starting subtest: primary-yf-tiled-reflect-x-270
[214.976377] Subtest primary-yf-tiled-reflect-x-270: SKIP (0.001s)
[215.052928] [044/132] (806s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[215.154463] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[215.165964] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.010s)
[215.241857] [045/132] (806s left) kms_content_protection (lic-type-0)
[215.385401] Starting subtest: lic-type-0
[215.389547] Subtest lic-type-0: SKIP (0.000s)
[215.501799] [046/132] (806s left) syncobj_timeline (single-wait-all-for-submit-available-submitted)
[215.558659] Starting subtest: single-wait-all-for-submit-available-submitted
[215.560641] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s)
[215.657154] [047/132] (806s left) kms_addfb_basic (bad-pitch-128)
[215.710294] Starting subtest: bad-pitch-128
[215.712023] Subtest bad-pitch-128: SUCCESS (0.000s)
[215.850343] [048/132] (806s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-pwrite)
[215.957933] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-pwrite
[223.163990] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (7.211s)
[223.322639] [049/132] (798s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-cpu)
[223.421648] Starting subtest: fbcpsr-rgb565-draw-mmap-cpu
[230.146148] Subtest fbcpsr-rgb565-draw-mmap-cpu: SUCCESS (6.727s)
[230.260327] [050/132] (791s left) perf_pmu (init-wait)
[230.302314] Starting subtest: init-wait
[230.304457] Starting dynamic subtest: rcs0
[230.306719] Dynamic subtest rcs0: SUCCESS (0.002s)
[230.315991] Starting dynamic subtest: bcs0
[230.317801] Dynamic subtest bcs0: SUCCESS (0.000s)
[230.325102] Starting dynamic subtest: vcs0
[230.326948] Dynamic subtest vcs0: SUCCESS (0.001s)
[230.335265] Starting dynamic subtest: vcs1
[230.337423] Dynamic subtest vcs1: SUCCESS (0.001s)
[230.344539] Starting dynamic subtest: vecs0
[230.346698] Dynamic subtest vecs0: SUCCESS (0.001s)
[230.353670] Starting dynamic subtest: ccs0
[230.355813] Dynamic subtest ccs0: SUCCESS (0.000s)
[230.357956] Subtest init-wait: SUCCESS (0.008s)
[230.412573] [051/132] (791s left) kms_color (ctm-0-50)
[230.507801] Starting subtest: ctm-0-50
[230.510090] Starting dynamic subtest: pipe-A-eDP-1
[234.079214] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.572s)
[234.087496] Starting dynamic subtest: pipe-B-eDP-1
[238.265399] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.185s)
[238.273594] Starting dynamic subtest: pipe-C-eDP-1
[242.320308] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.054s)
[242.327774] Starting dynamic subtest: pipe-D-eDP-1
[246.342265] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.019s)
[246.344166] Subtest ctm-0-50: SUCCESS (15.833s)
[247.212079] [052/132] (774s left) kms_dp_link_training (non-uhbr-mst)
[247.307183] Starting subtest: non-uhbr-mst
[247.315537] Subtest non-uhbr-mst: SKIP (0.000s)
[247.390422] [053/132] (774s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area)
[247.486283] Starting subtest: psr2-plane-move-sf-dmg-area
[247.488569] Starting dynamic subtest: pipe-A-eDP-1
[251.969085] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.488s)
[251.980735] Starting dynamic subtest: pipe-B-eDP-1
[257.176416] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.206s)
[257.178699] Subtest psr2-plane-move-sf-dmg-area: SUCCESS (9.698s)
[258.007536] [054/132] (764s left) kms_properties (colorop-properties-legacy)
[258.101578] Starting subtest: colorop-properties-legacy
[258.103872] Starting dynamic subtest: pipe-A-eDP-1
[258.456512] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.355s)
[258.465718] Starting dynamic subtest: pipe-B-eDP-1
[259.553198] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.096s)
[259.561264] Starting dynamic subtest: pipe-C-eDP-1
[260.634047] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.079s)
[260.643088] Starting dynamic subtest: pipe-D-eDP-1
[261.742166] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.106s)
[261.744494] Subtest colorop-properties-legacy: SUCCESS (3.642s)
[262.620455] [055/132] (759s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-move)
[262.737150] Starting subtest: fbc-1p-primscrn-spr-indfb-move
[266.993653] Subtest fbc-1p-primscrn-spr-indfb-move: SUCCESS (4.258s)
[268.125708] [056/132] (754s left) vgem_basic (bad-handle)
[268.169417] Starting subtest: bad-handle
[268.171762] Subtest bad-handle: SUCCESS (0.000s)
[268.225782] [057/132] (754s left) gem_eio (in-flight-immediate)
[268.453934] Starting subtest: in-flight-immediate
[276.728520] Subtest in-flight-immediate: SUCCESS (8.273s)
[276.857663] [058/132] (745s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[276.978610] Starting subtest: 2x-cursor-vs-flip-atomic
[276.983142] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.001s)
[277.122680] [059/132] (745s left) kms_cdclk (mode-transition-all-outputs)
[277.207263] Starting subtest: mode-transition-all-outputs
[277.494053] Subtest mode-transition-all-outputs: SKIP (0.286s)
[278.307482] [060/132] (744s left) api_intel_bb (misplaced-blitter)
[278.354244] Starting subtest: misplaced-blitter
[278.359333] Subtest misplaced-blitter: SUCCESS (0.007s)
[278.479897] [061/132] (743s left) kms_cursor_edge_walk (64x64-right-edge)
[278.579081] Starting subtest: 64x64-right-edge
[278.582203] Starting dynamic subtest: pipe-A-eDP-1
[282.043211] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.465s)
[282.052046] Starting dynamic subtest: pipe-D-eDP-1
[285.226077] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.182s)
[285.228455] Subtest 64x64-right-edge: SUCCESS (6.649s)
[286.025785] [062/132] (736s left) gem_exec_whisper (basic-forked-all)
[286.116565] Starting subtest: basic-forked-all
[299.482606] Subtest basic-forked-all: SUCCESS (13.366s)
[299.670347] [063/132] (722s left) syncobj_timeline (device-submit-unordered)
[299.725111] Starting subtest: device-submit-unordered
[299.727403] Subtest device-submit-unordered: SUCCESS (0.001s)
[299.829414] [064/132] (722s left) kms_cursor_legacy (2x-long-nonblocking-modeset-vs-cursor-atomic)
[299.944737] Starting subtest: 2x-long-nonblocking-modeset-vs-cursor-atomic
[299.949356] Subtest 2x-long-nonblocking-modeset-vs-cursor-atomic: SKIP (0.001s)
[300.088815] [065/132] (722s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite)
[300.185301] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite
[300.189064] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[300.283069] [066/132] (722s left) kms_psr (psr-sprite-mmap-gtt)
[300.375724] Starting subtest: psr-sprite-mmap-gtt
[300.378260] Starting dynamic subtest: eDP-1
[301.803614] Dynamic subtest eDP-1: SKIP (1.425s)
[301.808533] Subtest psr-sprite-mmap-gtt: SKIP (1.427s)
[301.992872] [067/132] (720s left) gem_pxp (verify-pxp-stale-buf-execution)
[302.109177] Starting subtest: verify-pxp-stale-buf-execution
[303.175525] Subtest verify-pxp-stale-buf-execution: SUCCESS (1.065s)
[303.288400] [068/132] (719s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[303.416431] Starting subtest: cursor-vs-flip-atomic
[332.739900] Subtest cursor-vs-flip-atomic: SUCCESS (29.320s)
[333.605397] [069/132] (689s left) kms_chamelium_frames (hdmi-frame-dump)
[333.992421] Subtest hdmi-frame-dump: SKIP (0.000s)
[334.779496] [070/132] (688s left) prime_busy (after-wait)
[334.839798] Starting subtest: after-wait
[334.844557] Starting dynamic subtest: rcs0
[334.869057] Dynamic subtest rcs0: SUCCESS (0.026s)
[334.878473] Starting dynamic subtest: bcs0
[334.920117] Dynamic subtest bcs0: SUCCESS (0.051s)
[334.929232] Starting dynamic subtest: vcs0
[334.961713] Dynamic subtest vcs0: SUCCESS (0.041s)
[334.971895] Starting dynamic subtest: vcs1
[335.001860] Dynamic subtest vcs1: SUCCESS (0.039s)
[335.010661] Starting dynamic subtest: vecs0
[335.041421] Dynamic subtest vecs0: SUCCESS (0.039s)
[335.049169] Starting dynamic subtest: ccs0
[335.080840] Dynamic subtest ccs0: SUCCESS (0.039s)
[335.190666] Subtest after-wait: SUCCESS (0.349s)
[335.259927] [071/132] (687s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-wc)
[335.356513] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-wc
[335.360619] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[335.463945] [072/132] (687s left) gem_basic (create-close)
[335.514646] Starting subtest: create-close
[335.518902] Subtest create-close: SUCCESS (0.000s)
[335.601485] [073/132] (687s left) i915_module_load (reload-no-display)
[335.638700] Starting subtest: reload-no-display
[341.856042] Subtest reload-no-display: SUCCESS (6.216s)
[341.885625] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[341.886333] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[341.889516] [074/132] (681s left) kms_vblank (query-idle-hang)
[343.429552] Starting subtest: query-idle-hang
[343.431542] Starting dynamic subtest: pipe-A-eDP-1
[369.761696] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.328s)
[369.774840] Starting dynamic subtest: pipe-D-eDP-1
[394.655158] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.890s)
[394.657581] Subtest query-idle-hang: SUCCESS (51.223s)
[395.561694] [FACT kms_vblank (query-idle-hang)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[395.562917] [FACT kms_vblank (query-idle-hang)] new: kernel.kmod_is_loaded.i915: true
[395.567323] [075/132] (627s left) gem_partial_pwrite_pread (reads)
[395.637375] Subtest reads: SKIP (0.000s)
[395.726984] [076/132] (627s left) i915_power (sanity)
[395.777909] Starting subtest: sanity
[395.782163] Subtest sanity: SKIP (0.000s)
[395.876431] [077/132] (627s left) kms_flip (2x-flip-vs-suspend)
[395.975923] Starting subtest: 2x-flip-vs-suspend
[395.980206] Subtest 2x-flip-vs-suspend: SKIP (0.010s)
[396.093177] [078/132] (627s left) api_intel_allocator (reserve-simple)
[396.164754] Starting subtest: reserve-simple
[396.167189] Subtest reserve-simple: SUCCESS (0.004s)
[396.274545] [079/132] (626s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[396.402279] Starting subtest: basic-flip-after-cursor-atomic
[397.329227] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.930s)
[398.175117] [080/132] (625s left) gem_mmap_gtt (cpuset-basic-small-copy-odd)
[398.245613] Subtest cpuset-basic-small-copy-odd: SKIP (0.000s)
[398.297935] [081/132] (624s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[398.396951] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[398.399540] Starting dynamic subtest: pipe-A-default-mode
[401.152325] Dynamic subtest pipe-A-default-mode: SUCCESS (2.753s)
[401.154679] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.755s)
[401.989965] [082/132] (621s left) kms_pm_rpm (cursor)
[404.107680] Starting subtest: cursor
[404.113094] Subtest cursor: SKIP (0.000s)
[404.476117] [083/132] (618s left) kms_invalid_mode (zero-hdisplay)
[404.564508] Starting subtest: zero-hdisplay
[404.566908] Starting dynamic subtest: pipe-A-eDP-1
[404.851418] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.290s)
[404.858638] Starting dynamic subtest: pipe-B-eDP-1
[404.860500] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[404.867102] Starting dynamic subtest: pipe-C-eDP-1
[404.869020] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[404.876106] Starting dynamic subtest: pipe-D-eDP-1
[404.878237] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[404.880385] Subtest zero-hdisplay: SUCCESS (0.296s)
[405.701121] [084/132] (617s left) kms_feature_discovery (psr1)
[405.805973] Starting subtest: psr1
[405.808270] Subtest psr1: SUCCESS (0.000s)
[405.878445] [085/132] (617s left) kms_cursor_legacy (flip-vs-cursor-atomic)
[405.993396] Starting subtest: flip-vs-cursor-atomic
[413.065989] Subtest flip-vs-cursor-atomic: SUCCESS (7.070s)
[413.935457] [086/132] (609s left) gem_userptr_blits (sync-unmap)
[413.998625] Starting subtest: sync-unmap
[414.011733] Subtest sync-unmap: SUCCESS (0.015s)
[414.150459] [087/132] (609s left) kms_vblank (invalid)
[414.251151] Starting subtest: invalid
[414.253052] Starting dynamic subtest: pipe-A-eDP-1
[414.661273] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.409s)
[414.663706] Subtest invalid: SUCCESS (0.410s)
[415.479297] [088/132] (608s left) kms_ccs (missing-ccs-buffer-yf-tiled-ccs)
[415.577295] Starting subtest: missing-ccs-buffer-yf-tiled-ccs
[415.579592] Starting dynamic subtest: pipe-A-eDP-1
[415.603516] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[415.613624] Starting dynamic subtest: pipe-B-eDP-1
[415.635778] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[415.644217] Starting dynamic subtest: pipe-C-eDP-1
[415.665863] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[415.673578] Starting dynamic subtest: pipe-D-eDP-1
[415.695737] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[415.699865] Subtest missing-ccs-buffer-yf-tiled-ccs: SKIP (0.004s)
[417.817148] [089/132] (605s left) kms_big_fb (linear-16bpp-rotate-180)
[417.911927] Starting subtest: linear-16bpp-rotate-180
[419.178419] Subtest linear-16bpp-rotate-180: SUCCESS (1.266s)
[419.311186] [090/132] (604s left) dumb_buffer (map-uaf)
[419.361063] Starting subtest: map-uaf
[419.369262] Subtest map-uaf: SUCCESS (0.008s)
[419.452125] [091/132] (604s left) gem_softpin (evict-active-interruptible)
[419.507095] Starting subtest: evict-active-interruptible
[419.511192] Subtest evict-active-interruptible: SUCCESS (0.007s)
[419.621364] [092/132] (604s left) kms_ccs (bad-rotation-90-y-tiled-ccs)
[419.706336] Starting subtest: bad-rotation-90-y-tiled-ccs
[419.708214] Starting dynamic subtest: pipe-A-eDP-1
[419.726337] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[419.734280] Starting dynamic subtest: pipe-B-eDP-1
[419.751355] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[419.759107] Starting dynamic subtest: pipe-C-eDP-1
[419.776217] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[419.782837] Starting dynamic subtest: pipe-D-eDP-1
[419.800564] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[419.803855] Subtest bad-rotation-90-y-tiled-ccs: SKIP (0.004s)
[421.982887] [093/132] (601s left) gem_pxp (display-protected-crc)
[422.111556] Starting subtest: display-protected-crc
[424.177953] Subtest display-protected-crc: SUCCESS (2.069s)
[424.296229] [094/132] (599s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled)
[424.359169] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[424.361509] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[424.456084] [095/132] (599s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[424.574220] Starting subtest: plane-all-modeset-transition-internal-panels
[424.576206] Starting dynamic subtest: pipe-A-eDP-1
[425.922907] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.348s)
[426.207266] Starting dynamic subtest: pipe-B-eDP-1
[427.251830] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.052s)
[427.524882] Subtest plane-all-modeset-transition-internal-panels: SUCCESS (2.952s)
[428.368544] [096/132] (595s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[428.461053] Starting subtest: 4-tiled-16bpp-rotate-0
[429.694770] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.234s)
[429.809363] [097/132] (594s left) gem_exec_schedule (preempt)
[429.886097] Starting subtest: preempt
[429.888082] Starting dynamic subtest: rcs0
[429.908587] Dynamic subtest rcs0: SUCCESS (0.027s)
[429.916797] Starting dynamic subtest: bcs0
[429.929269] Dynamic subtest bcs0: SUCCESS (0.020s)
[429.938029] Starting dynamic subtest: vcs0
[429.950323] Dynamic subtest vcs0: SUCCESS (0.020s)
[429.957341] Starting dynamic subtest: vcs1
[429.974123] Dynamic subtest vcs1: SUCCESS (0.023s)
[429.981143] Starting dynamic subtest: vecs0
[429.991310] Dynamic subtest vecs0: SUCCESS (0.016s)
[429.999762] Starting dynamic subtest: ccs0
[430.012934] Dynamic subtest ccs0: SUCCESS (0.021s)
[430.014895] Subtest preempt: SUCCESS (0.132s)
[431.972806] [098/132] (591s left) gen9_exec_parse (bb-chained)
[432.039466] Subtest bb-chained: SKIP (0.000s)
[432.119509] [099/132] (591s left) kms_atomic_transition (plane-all-transition)
[432.216199] Starting subtest: plane-all-transition
[432.218455] Starting dynamic subtest: pipe-A-eDP-1
[434.713111] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.498s)
[435.019936] Starting dynamic subtest: pipe-B-eDP-1
[438.218941] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.207s)
[438.521804] Subtest plane-all-transition: SUCCESS (6.305s)
[439.336986] [100/132] (584s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt)
[439.423645] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt
[439.427820] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[439.516503] [101/132] (584s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-pwrite)
[439.611698] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-pwrite
[448.257909] Subtest psr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.649s)
[448.381527] [102/132] (575s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[448.482705] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[448.486918] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[448.580890] [103/132] (575s left) kms_cursor_crc (cursor-random-128x42)
[448.811161] Starting subtest: cursor-random-128x42
[448.855592] Subtest cursor-random-128x42: SKIP (0.043s)
[449.047668] [104/132] (575s left) gem_exec_balancer (bonded-false-hang)
[449.293520] Starting subtest: bonded-false-hang
[449.298700] Subtest bonded-false-hang: SKIP (0.000s)
[449.404750] [105/132] (574s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[449.500238] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[450.135382] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.637s)
[450.294150] [106/132] (573s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-cpu)
[450.390970] Starting subtest: fbc-rgb101010-draw-mmap-cpu
[455.007968] Subtest fbc-rgb101010-draw-mmap-cpu: SUCCESS (4.620s)
[456.123100] [107/132] (568s left) sw_sync (sync_merge_invalid)
[456.158202] Starting subtest: sync_merge_invalid
[456.175249] Subtest sync_merge_invalid: SUCCESS (0.018s)
[456.249978] [108/132] (568s left) gem_exec_schedule (preempt-user)
[456.327966] Starting subtest: preempt-user
[456.330133] Starting dynamic subtest: rcs0
[456.346911] Dynamic subtest rcs0: SUCCESS (0.026s)
[456.357146] Starting dynamic subtest: bcs0
[456.366269] Dynamic subtest bcs0: SUCCESS (0.019s)
[456.374451] Starting dynamic subtest: vcs0
[456.387916] Dynamic subtest vcs0: SUCCESS (0.021s)
[456.395861] Starting dynamic subtest: vcs1
[456.409050] Dynamic subtest vcs1: SUCCESS (0.020s)
[456.416847] Starting dynamic subtest: vecs0
[456.430619] Dynamic subtest vecs0: SUCCESS (0.021s)
[456.438650] Starting dynamic subtest: ccs0
[456.453191] Dynamic subtest ccs0: SUCCESS (0.022s)
[456.455353] Subtest preempt-user: SUCCESS (0.133s)
[457.947620] [109/132] (566s left) gem_exec_reloc (basic-concurrent0)
[458.001598] Subtest basic-concurrent0: SKIP (0.000s)
[458.075856] [110/132] (566s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[458.161719] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[458.166812] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[458.253255] [111/132] (566s left) gem_exec_flush (basic-wb-set-default)
[458.315198] Starting subtest: basic-wb-set-default
[463.769072] Subtest basic-wb-set-default: SUCCESS (5.455s)
[463.953927] [112/132] (560s left) gem_workarounds (basic-read-fd)
[464.017119] Starting subtest: basic-read-fd
[464.033359] Subtest basic-read-fd: SUCCESS (0.016s)
[464.159248] [113/132] (560s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-pgflip-blt)
[464.261493] Starting subtest: psr-2p-scndscrn-indfb-pgflip-blt
[464.265838] Subtest psr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[464.359884] [114/132] (560s left) gem_softpin (noreloc-interruptible)
[464.422611] Starting subtest: noreloc-interruptible
[469.851919] Subtest noreloc-interruptible: SUCCESS (5.427s)
[469.984051] [115/132] (554s left) gem_ctx_shared (q-smoketest-all)
[470.035616] Starting subtest: Q-smoketest-all
[502.431360] Subtest Q-smoketest-all: SUCCESS (32.343s)
[504.016413] [116/132] (520s left) gem_lmem_swapping (basic)
[504.060935] Subtest basic: SKIP (0.000s)
[504.105215] [117/132] (520s left) kms_psr (psr2-primary-mmap-cpu)
[504.204870] Starting subtest: psr2-primary-mmap-cpu
[504.207194] Starting dynamic subtest: eDP-1
[505.902285] Dynamic subtest eDP-1: SUCCESS (1.696s)
[505.904178] Subtest psr2-primary-mmap-cpu: SUCCESS (1.697s)
[506.783984] [118/132] (517s left) gem_ctx_persistence (engines-persistence)
[506.847619] Starting subtest: engines-persistence
[506.849837] Starting dynamic subtest: rcs0
[507.674955] Dynamic subtest rcs0: SUCCESS (0.827s)
[507.687575] Starting dynamic subtest: bcs0
[508.434637] Dynamic subtest bcs0: SUCCESS (0.756s)
[508.446195] Starting dynamic subtest: vcs0
[509.201723] Dynamic subtest vcs0: SUCCESS (0.764s)
[509.213402] Starting dynamic subtest: vcs1
[509.968769] Dynamic subtest vcs1: SUCCESS (0.765s)
[509.980124] Starting dynamic subtest: vecs0
[510.741959] Dynamic subtest vecs0: SUCCESS (0.772s)
[510.753919] Starting dynamic subtest: ccs0
[511.505879] Dynamic subtest ccs0: SUCCESS (0.760s)
[511.508997] Subtest engines-persistence: SUCCESS (4.658s)
[511.587385] [119/132] (513s left) perf_pmu (rc6)
[511.627859] Starting subtest: rc6
[511.630144] Starting dynamic subtest: gt0
[518.006404] Dynamic subtest gt0: SUCCESS (6.376s)
[518.018662] Starting dynamic subtest: runtime-pm-gt0
[525.721501] Dynamic subtest runtime-pm-gt0: SUCCESS (7.713s)
[525.732463] Starting dynamic subtest: runtime-pm-long-gt0
[538.216434] Dynamic subtest runtime-pm-long-gt0: SUCCESS (12.491s)
[538.228169] Starting dynamic subtest: other-idle-gt0
[544.559808] Dynamic subtest other-idle-gt0: SUCCESS (6.341s)
[544.570099] Starting dynamic subtest: gt1
[550.901867] Dynamic subtest gt1: SUCCESS (6.339s)
[550.913352] Starting dynamic subtest: runtime-pm-gt1
[558.350787] Dynamic subtest runtime-pm-gt1: SUCCESS (7.446s)
[558.362209] Starting dynamic subtest: runtime-pm-long-gt1
[570.831515] Dynamic subtest runtime-pm-long-gt1: SUCCESS (12.477s)
[570.842420] Starting dynamic subtest: other-idle-gt1
[577.181082] Dynamic subtest other-idle-gt1: SUCCESS (6.346s)
[577.183987] Subtest rc6: SUCCESS (65.549s)
[578.339366] [120/132] (446s left) perf_pmu (busy-accuracy-2)
[578.377383] Starting subtest: busy-accuracy-2
[578.379804] Starting dynamic subtest: rcs0
[581.423974] Dynamic subtest rcs0: SUCCESS (3.044s)
[581.432337] Starting dynamic subtest: bcs0
[584.479471] Dynamic subtest bcs0: SUCCESS (3.052s)
[584.490420] Starting dynamic subtest: vcs0
[587.527075] Dynamic subtest vcs0: SUCCESS (3.045s)
[587.537647] Starting dynamic subtest: vcs1
[590.574508] Dynamic subtest vcs1: SUCCESS (3.045s)
[590.585212] Starting dynamic subtest: vecs0
[593.620401] Dynamic subtest vecs0: SUCCESS (3.043s)
[593.631056] Starting dynamic subtest: ccs0
[596.679695] Dynamic subtest ccs0: SUCCESS (3.056s)
[596.682300] Subtest busy-accuracy-2: SUCCESS (18.300s)
[596.771578] [121/132] (428s left) gem_watchdog (default-physical)
[596.850969] Starting subtest: default-physical
[598.621335] Subtest default-physical: SUCCESS (1.778s)
[598.725519] [122/132] (426s left) kms_flip (blocking-absolute-wf_vblank)
[598.828243] Starting subtest: blocking-absolute-wf_vblank
[598.830572] Starting dynamic subtest: A-eDP1
[607.598059] Dynamic subtest A-eDP1: SUCCESS (8.768s)
[607.606278] Starting dynamic subtest: B-eDP1
[616.334929] Dynamic subtest B-eDP1: SUCCESS (8.733s)
[616.349047] Starting dynamic subtest: C-eDP1
[625.049969] Dynamic subtest C-eDP1: SUCCESS (8.712s)
[625.069348] Starting dynamic subtest: D-eDP1
[633.789290] Dynamic subtest D-eDP1: SUCCESS (8.736s)
[633.795191] Subtest blocking-absolute-wf_vblank: SUCCESS (34.966s)
[634.986048] [123/132] (389s left) gem_render_copy (y-tiled-ccs-to-y-tiled)
[635.050421] Starting subtest: y-tiled-ccs-to-y-tiled
[635.054645] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s)
[635.207128] [124/132] (389s left) gem_spin_batch (spin-each)
[635.272414] Starting subtest: spin-each
[638.543367] Subtest spin-each: SUCCESS (3.264s)
[638.915980] [125/132] (386s left) gem_ctx_engines (independent)
[638.978078] Starting subtest: independent
[638.980528] Starting dynamic subtest: rcs0
[639.197225] Dynamic subtest rcs0: SUCCESS (0.217s)
[639.208587] Starting dynamic subtest: bcs0
[639.419453] Dynamic subtest bcs0: SUCCESS (0.221s)
[639.430773] Starting dynamic subtest: vcs0
[639.592490] Dynamic subtest vcs0: SUCCESS (0.171s)
[639.602624] Starting dynamic subtest: vcs1
[639.812767] Dynamic subtest vcs1: SUCCESS (0.220s)
[639.820900] Starting dynamic subtest: vecs0
[640.041334] Dynamic subtest vecs0: SUCCESS (0.227s)
[640.049885] Starting dynamic subtest: ccs0
[640.286213] Dynamic subtest ccs0: SUCCESS (0.243s)
[640.294771] Starting dynamic subtest: all-engines
[641.359529] Dynamic subtest all-engines: SUCCESS (1.072s)
[641.362225] Subtest independent: SUCCESS (2.380s)
[642.942473] [126/132] (382s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted)
[643.008688] Starting subtest: etime-multi-wait-for-submit-unsubmitted
[643.113511] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.105s)
[643.167662] [127/132] (381s left) gem_mmap_offset (open-flood)
[643.226662] Starting subtest: open-flood
[664.716699] Subtest open-flood: SUCCESS (21.490s)
[664.796497] [128/132] (360s left) gem_eio (wait-wedge-10ms)
[665.014595] Starting subtest: wait-wedge-10ms
[666.987045] Subtest wait-wedge-10ms: SUCCESS (1.971s)
[667.085296] [129/132] (358s left) kms_flip (plain-flip-interruptible)
[667.184205] Starting subtest: plain-flip-interruptible
[667.186454] Starting dynamic subtest: A-eDP1
[668.908731] Dynamic subtest A-eDP1: SUCCESS (1.723s)
[668.920104] Starting dynamic subtest: B-eDP1
[670.529714] Dynamic subtest B-eDP1: SUCCESS (1.619s)
[670.540911] Starting dynamic subtest: C-eDP1
[672.151230] Dynamic subtest C-eDP1: SUCCESS (1.620s)
[672.162659] Starting dynamic subtest: D-eDP1
[673.776268] Dynamic subtest D-eDP1: SUCCESS (1.624s)
[673.781219] Subtest plain-flip-interruptible: SUCCESS (6.597s)
[674.930188] [130/132] (350s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[675.042337] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[681.649084] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.608s)
[681.740396] [131/132] (343s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180)
[681.832675] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180
[681.837018] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[681.906520] [132/132] (343s left) gem_userptr_blits (create-destroy-sync)
[681.969036] Starting subtest: create-destroy-sync
[686.983908] Subtest create-destroy-sync: SUCCESS (5.014s)
[687.074507] Closing watchdogs
results: parsing output: 0/ for test: gem_close_race
results: parsing output: 1/ for test: syncobj_timeline
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: kms_getfb
results: parsing output: 4/ for test: kms_chamelium_hpd
results: parsing output: 5/ for test: i915_drm_fdinfo
results: parsing output: 6/ for test: kms_force_connector_basic
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_ccs
results: parsing output: 9/ for test: gem_exec_balancer
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_plane_multiple
results: parsing output: 12/ for test: syncobj_wait
results: parsing output: 13/ for test: kms_psr
results: parsing output: 14/ for test: gem_exec_reloc
results: parsing output: 15/ for test: gem_ctx_param
results: parsing output: 16/ for test: syncobj_wait
results: parsing output: 17/ for test: syncobj_wait
results: parsing output: 18/ for test: i915_pm_rpm
results: parsing output: 19/ for test: gem_exec_fence
results: parsing output: 20/ for test: drm_mm
results: parsing output: 21/ for test: kms_psr2_sf
results: parsing output: 22/ for test: kms_psr
results: parsing output: 23/ for test: kms_plane_scaling
results: parsing output: 24/ for test: kms_mmap_write_crc
results: parsing output: 25/ for test: kms_ccs
results: parsing output: 26/ for test: gem_render_copy
results: parsing output: 27/ for test: kms_big_fb
results: parsing output: 28/ for test: kms_async_flips
results: parsing output: 29/ for test: kms_plane
results: parsing output: 30/ for test: kms_plane_cursor
results: parsing output: 31/ for test: vgem_slow
results: parsing output: 32/ for test: kms_big_fb
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: gem_ctx_persistence
results: parsing output: 35/ for test: kms_psr
results: parsing output: 36/ for test: kms_cursor_crc
results: parsing output: 37/ for test: gem_basic
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: kms_plane_scaling
results: parsing output: 40/ for test: kms_big_fb
results: parsing output: 41/ for test: gem_render_copy_redux
results: parsing output: 42/ for test: kms_rotation_crc
results: parsing output: 43/ for test: kms_flip
results: parsing output: 44/ for test: kms_content_protection
results: parsing output: 45/ for test: syncobj_timeline
results: parsing output: 46/ for test: kms_addfb_basic
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: perf_pmu
results: parsing output: 50/ for test: kms_color
results: parsing output: 51/ for test: kms_dp_link_training
results: parsing output: 52/ for test: kms_psr2_sf
results: parsing output: 53/ for test: kms_properties
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: vgem_basic
results: parsing output: 56/ for test: gem_eio
results: parsing output: 57/ for test: kms_cursor_legacy
results: parsing output: 58/ for test: kms_cdclk
results: parsing output: 59/ for test: api_intel_bb
results: parsing output: 60/ for test: kms_cursor_edge_walk
results: parsing output: 61/ for test: gem_exec_whisper
results: parsing output: 62/ for test: syncobj_timeline
results: parsing output: 63/ for test: kms_cursor_legacy
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: gem_pxp
results: parsing output: 67/ for test: kms_cursor_legacy
results: parsing output: 68/ for test: kms_chamelium_frames
results: parsing output: 69/ for test: prime_busy
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_basic
results: parsing output: 72/ for test: i915_module_load
results: parsing output: 73/ for test: kms_vblank
results: parsing output: 74/ for test: gem_partial_pwrite_pread
results: parsing output: 75/ for test: i915_power
results: parsing output: 76/ for test: kms_flip
results: parsing output: 77/ for test: api_intel_allocator
results: parsing output: 78/ for test: kms_cursor_legacy
results: parsing output: 79/ for test: gem_mmap_gtt
results: parsing output: 80/ for test: kms_flip_scaled_crc
results: parsing output: 81/ for test: kms_pm_rpm
results: parsing output: 82/ for test: kms_invalid_mode
results: parsing output: 83/ for test: kms_feature_discovery
results: parsing output: 84/ for test: kms_cursor_legacy
results: parsing output: 85/ for test: gem_userptr_blits
results: parsing output: 86/ for test: kms_vblank
results: parsing output: 87/ for test: kms_ccs
results: parsing output: 88/ for test: kms_big_fb
results: parsing output: 89/ for test: dumb_buffer
results: parsing output: 90/ for test: gem_softpin
results: parsing output: 91/ for test: kms_ccs
results: parsing output: 92/ for test: gem_pxp
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: kms_atomic_transition
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: gem_exec_schedule
results: parsing output: 97/ for test: gen9_exec_parse
results: parsing output: 98/ for test: kms_atomic_transition
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_cursor_crc
results: parsing output: 103/ for test: gem_exec_balancer
results: parsing output: 104/ for test: kms_big_fb
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: sw_sync
results: parsing output: 107/ for test: gem_exec_schedule
results: parsing output: 108/ for test: gem_exec_reloc
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: gem_exec_flush
results: parsing output: 111/ for test: gem_workarounds
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: gem_softpin
results: parsing output: 114/ for test: gem_ctx_shared
results: parsing output: 115/ for test: gem_lmem_swapping
results: parsing output: 116/ for test: kms_psr
results: parsing output: 117/ for test: gem_ctx_persistence
results: parsing output: 118/ for test: perf_pmu
results: parsing output: 119/ for test: perf_pmu
results: parsing output: 120/ for test: gem_watchdog
results: parsing output: 121/ for test: kms_flip
results: parsing output: 122/ for test: gem_render_copy
results: parsing output: 123/ for test: gem_spin_batch
results: parsing output: 124/ for test: gem_ctx_engines
results: parsing output: 125/ for test: syncobj_timeline
results: parsing output: 126/ for test: gem_mmap_offset
results: parsing output: 127/ for test: gem_eio
results: parsing output: 128/ for test: kms_flip
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: kms_big_fb
results: parsing output: 131/ for test: gem_userptr_blits
Done.