[58.401800] Initializing watchdogs
[58.401846]   /dev/watchdog0
[58.418972] [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]
[58.423449] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.425631] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.429066] [001/155] (960s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb101010-draw-render)
[58.561163] Starting subtest: fbcpsrhdr-rgb101010-draw-render
[58.565296] Subtest fbcpsrhdr-rgb101010-draw-render: SKIP (0.000s)
[58.657400] [002/155] (960s left) kms_flip (flip-vs-blocking-wf-vblank)
[58.747050] Starting subtest: flip-vs-blocking-wf-vblank
[58.749267] Starting dynamic subtest: A-eDP1
[79.609593] Dynamic subtest A-eDP1: SUCCESS (20.983s)
[79.621338] Starting dynamic subtest: B-eDP1
[88.523676] Dynamic subtest B-eDP1: SUCCESS (8.918s)
[88.531743] Starting dynamic subtest: C-eDP1
[97.442047] Dynamic subtest C-eDP1: SUCCESS (8.916s)
[97.451915] Starting dynamic subtest: D-eDP1
[106.367086] Dynamic subtest D-eDP1: SUCCESS (8.928s)
[106.371896] Subtest flip-vs-blocking-wf-vblank: SUCCESS (47.755s)
[107.593632] [003/155] (911s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[107.701223] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[107.705528] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[107.800275] [004/155] (911s left) perf_pmu (most-busy-check-all)
[107.846639] Starting subtest: most-busy-check-all
[107.848892] Starting dynamic subtest: rcs0
[109.350221] Dynamic subtest rcs0: SUCCESS (1.504s)
[109.362796] Starting dynamic subtest: bcs0
[111.335677] Dynamic subtest bcs0: SUCCESS (1.984s)
[111.348948] Starting dynamic subtest: vcs0
[113.318401] Dynamic subtest vcs0: SUCCESS (1.982s)
[113.329826] Starting dynamic subtest: vcs1
[115.365865] Dynamic subtest vcs1: SUCCESS (2.047s)
[115.376998] Starting dynamic subtest: vecs0
[117.351050] Dynamic subtest vecs0: SUCCESS (1.984s)
[117.362319] Starting dynamic subtest: ccs0
[119.335976] Dynamic subtest ccs0: SUCCESS (1.984s)
[119.338894] Subtest most-busy-check-all: SUCCESS (11.491s)
[119.460449] [005/155] (899s left) kms_ccs (bad-pixel-format-yf-tiled-ccs)
[119.553945] Starting subtest: bad-pixel-format-yf-tiled-ccs
[119.556258] Starting dynamic subtest: pipe-A-eDP-1
[119.579014] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[119.588155] Starting dynamic subtest: pipe-B-eDP-1
[119.608971] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[119.617094] Starting dynamic subtest: pipe-C-eDP-1
[119.637231] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[119.645317] Starting dynamic subtest: pipe-D-eDP-1
[119.667562] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[119.672231] Subtest bad-pixel-format-yf-tiled-ccs: SKIP (0.003s)
[121.868844] [006/155] (897s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[121.969835] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc
[121.974064] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[122.071702] [007/155] (897s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-cur-indfb-draw-render)
[122.167706] Starting subtest: fbchdr-2p-primscrn-cur-indfb-draw-render
[122.172272] Subtest fbchdr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[122.275544] [008/155] (896s left) i915_pm_rps (engine-order)
[122.343755] Starting subtest: engine-order
[128.836135] Subtest engine-order: SUCCESS (6.493s)
[128.963126] [009/155] (890s left) gem_exec_reloc (basic-wc-read-active)
[129.012836] Subtest basic-wc-read-active: SKIP (0.000s)
[129.080547] [010/155] (890s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[129.193792] Starting subtest: psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[129.198298] Subtest psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[129.280663] [011/155] (890s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-pwrite)
[129.378806] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-pwrite
[136.269430] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (6.897s)
[136.381943] [012/155] (882s left) api_intel_bb (intel-bb-blit-none)
[136.437735] Starting subtest: intel-bb-blit-none
[140.492970] Subtest intel-bb-blit-none: SUCCESS (4.055s)
[140.605421] [013/155] (878s left) gem_gpgpu_fill (offset-16x16)
[140.655889] Starting subtest: offset-16x16
[140.665375] Subtest offset-16x16: SUCCESS (0.010s)
[140.794169] [014/155] (878s left) gem_userptr_blits (unsync-unmap)
[140.854123] Subtest unsync-unmap: SKIP (0.000s)
[140.968334] [015/155] (878s left) api_intel_allocator (reopen)
[141.015891] Starting subtest: reopen
[141.021847] Subtest reopen: SUCCESS (0.008s)
[141.129798] [016/155] (878s left) kms_vblank (wait-busy-hang)
[141.238300] Starting subtest: wait-busy-hang
[141.240791] Starting dynamic subtest: pipe-A-eDP-1
[168.120622] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.876s)
[168.134880] Starting dynamic subtest: pipe-D-eDP-1
[183.144176] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.020s)
[183.146465] Subtest wait-busy-hang: SUCCESS (41.899s)
[183.996697] [017/155] (835s left) gem_mmap_gtt (hang-busy)
[184.049122] Subtest hang-busy: SKIP (0.000s)
[184.102597] [018/155] (835s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[184.192593] Starting subtest: hdr-2p-scndscrn-cur-indfb-draw-mmap-wc
[184.196688] Subtest hdr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[184.296874] [019/155] (835s left) gem_ctx_persistence (legacy-engines-mixed-process)
[184.353572] Starting subtest: legacy-engines-mixed-process
[184.355735] Starting dynamic subtest: render
[186.359811] Dynamic subtest render: SUCCESS (2.006s)
[186.371458] Starting dynamic subtest: bsd1
[188.348775] Dynamic subtest bsd1: SUCCESS (1.987s)
[188.360106] Starting dynamic subtest: bsd2
[190.320962] Dynamic subtest bsd2: SUCCESS (1.970s)
[190.331666] Starting dynamic subtest: blt
[192.288793] Dynamic subtest blt: SUCCESS (1.966s)
[192.298549] Starting dynamic subtest: vebox
[194.348801] Dynamic subtest vebox: SUCCESS (2.059s)
[194.351366] Subtest legacy-engines-mixed-process: SUCCESS (9.995s)
[194.425696] [020/155] (825s left) kms_frontbuffer_tracking (fbchdr-rgb565-draw-pwrite)
[194.528640] Starting subtest: fbchdr-rgb565-draw-pwrite
[194.532858] Subtest fbchdr-rgb565-draw-pwrite: SKIP (0.000s)
[194.637987] [021/155] (825s left) gem_vm_create (create-ext)
[194.701665] Starting subtest: create-ext
[194.704035] Subtest create-ext: SUCCESS (0.004s)
[194.811820] [022/155] (824s left) kms_big_fb (y-tiled-addfb)
[194.916025] Starting subtest: y-tiled-addfb
[194.920096] Subtest y-tiled-addfb: SKIP (0.000s)
[195.010030] [023/155] (824s left) gem_userptr_blits (sync-unmap-after-close)
[195.076669] Starting subtest: sync-unmap-after-close
[195.086992] Subtest sync-unmap-after-close: SUCCESS (0.012s)
[195.213995] [024/155] (824s left) kms_psr (psr2-sprite-mmap-cpu)
[195.304983] Starting subtest: psr2-sprite-mmap-cpu
[195.307421] Starting dynamic subtest: eDP-1
[196.987320] Dynamic subtest eDP-1: SUCCESS (1.682s)
[196.989620] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.682s)
[197.861643] [025/155] (822s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-onoff)
[197.964356] Starting subtest: psr-1p-primscrn-spr-indfb-onoff
[205.118368] Subtest psr-1p-primscrn-spr-indfb-onoff: SUCCESS (7.159s)
[205.255348] [026/155] (814s left) kms_plane_scaling (plane-scaler-unity-scaling-with-modifiers)
[205.354850] Starting subtest: plane-scaler-unity-scaling-with-modifiers
[205.356749] Starting dynamic subtest: pipe-A
[205.692186] Dynamic subtest pipe-A: SUCCESS (0.339s)
[205.702784] Starting dynamic subtest: pipe-B
[207.106643] Dynamic subtest pipe-B: SUCCESS (1.414s)
[207.117055] Starting dynamic subtest: pipe-C
[208.545286] Dynamic subtest pipe-C: SUCCESS (1.438s)
[208.555745] Starting dynamic subtest: pipe-D
[209.965722] Dynamic subtest pipe-D: SUCCESS (1.420s)
[209.967968] Subtest plane-scaler-unity-scaling-with-modifiers: SUCCESS (4.613s)
[211.145126] [027/155] (808s left) dmabuf_sync_file (export-multiwait)
[211.220657] Starting subtest: export-multiwait
[211.222792] Subtest export-multiwait: SUCCESS (0.001s)
[211.277472] [FACT dmabuf_sync_file (export-multiwait)] new: kernel.kmod_is_loaded.vgem: true
[211.280500] [028/155] (808s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[211.376078] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[211.378453] Starting dynamic subtest: pipe-A-eDP-1
[211.398859] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[211.410598] Starting dynamic subtest: pipe-B-eDP-1
[211.429744] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[211.438546] Starting dynamic subtest: pipe-C-eDP-1
[211.457983] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[211.466867] Starting dynamic subtest: pipe-D-eDP-1
[211.487304] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[211.489268] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.005s)
[213.709039] [029/155] (806s left) kms_cursor_crc (cursor-onscreen-512x512)
[213.995514] Starting subtest: cursor-onscreen-512x512
[214.000051] Subtest cursor-onscreen-512x512: SKIP (0.001s)
[214.160017] [030/155] (805s left) vgem_basic (setversion)
[214.212183] Starting subtest: setversion
[214.216583] Subtest setversion: SUCCESS (0.000s)
[214.268975] [031/155] (805s left) gem_flink_basic (flink-lifetime)
[214.314918] Starting subtest: flink-lifetime
[214.317282] Subtest flink-lifetime: SUCCESS (0.002s)
[214.436956] [032/155] (805s left) gem_exec_params (sol-reset-not-gen7)
[214.492432] Starting subtest: sol-reset-not-gen7
[214.497663] Subtest sol-reset-not-gen7: SUCCESS (0.003s)
[214.608851] [033/155] (805s left) kms_busy (extended-pageflip-hang-newfb)
[214.713061] Starting subtest: extended-pageflip-hang-newfb
[214.715071] Starting dynamic subtest: pipe-A
[241.149656] Dynamic subtest pipe-A: SUCCESS (26.433s)
[241.160293] Starting dynamic subtest: pipe-D
[256.189032] Dynamic subtest pipe-D: SUCCESS (15.036s)
[256.191751] Subtest extended-pageflip-hang-newfb: SUCCESS (41.473s)
[257.011938] [034/155] (763s left) kms_psr (pr-primary-mmap-gtt)
[257.103624] Starting subtest: pr-primary-mmap-gtt
[257.108141] Subtest pr-primary-mmap-gtt: SKIP (0.000s)
[257.190729] [035/155] (763s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[257.297615] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[257.301677] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[257.406946] [036/155] (762s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-indfb-draw-pwrite)
[257.509185] Starting subtest: fbchdr-1p-primscrn-pri-indfb-draw-pwrite
[257.513329] Subtest fbchdr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[257.604468] [037/155] (762s left) syncobj_wait (invalid-multi-wait-all-unsubmitted)
[257.657845] Starting subtest: invalid-multi-wait-all-unsubmitted
[257.660183] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[257.749945] [038/155] (762s left) i915_drm_fdinfo (context-close-stress)
[257.790967] Starting subtest: context-close-stress
[268.537808] Subtest context-close-stress: SUCCESS (10.747s)
[268.617133] [039/155] (751s left) gem_exec_schedule (promotion)
[268.814481] Starting subtest: promotion
[268.816447] Starting dynamic subtest: rcs0
[268.986350] Dynamic subtest rcs0: SUCCESS (0.180s)
[268.999955] Starting dynamic subtest: vcs0
[269.104830] Dynamic subtest vcs0: SUCCESS (0.118s)
[269.118427] Starting dynamic subtest: vcs1
[269.223585] Dynamic subtest vcs1: SUCCESS (0.119s)
[269.235557] Starting dynamic subtest: vecs0
[269.338893] Dynamic subtest vecs0: SUCCESS (0.114s)
[269.353049] Starting dynamic subtest: ccs0
[269.485408] Dynamic subtest ccs0: SUCCESS (0.146s)
[269.488349] Subtest promotion: SUCCESS (0.681s)
[270.406075] [040/155] (750s left) prime_vgem (busy)
[270.472837] Starting subtest: busy
[270.475094] Starting dynamic subtest: rcs0
[270.528949] Dynamic subtest rcs0: SUCCESS (0.056s)
[270.540508] Starting dynamic subtest: bcs0
[270.590712] Dynamic subtest bcs0: SUCCESS (0.061s)
[270.602838] Starting dynamic subtest: vcs0
[270.643739] Dynamic subtest vcs0: SUCCESS (0.051s)
[270.653493] Starting dynamic subtest: vcs1
[270.687135] Dynamic subtest vcs1: SUCCESS (0.043s)
[270.697068] Starting dynamic subtest: vecs0
[270.732202] Dynamic subtest vecs0: SUCCESS (0.044s)
[270.742061] Starting dynamic subtest: ccs0
[270.784293] Dynamic subtest ccs0: SUCCESS (0.050s)
[270.786747] Subtest busy: SUCCESS (0.311s)
[270.937240] [041/155] (749s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc)
[271.025957] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc
[271.028304] Starting dynamic subtest: pipe-A-eDP-1
[271.051299] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[271.063065] Starting dynamic subtest: pipe-B-eDP-1
[271.084668] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[271.095082] Starting dynamic subtest: pipe-C-eDP-1
[271.116518] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[271.125802] Starting dynamic subtest: pipe-D-eDP-1
[271.148856] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[271.153061] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[273.291356] [042/155] (747s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[273.394104] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[274.084515] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.692s)
[274.246126] [043/155] (746s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[274.345664] Starting subtest: yf-tiled-8bpp-rotate-270
[274.349752] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[274.460461] [044/155] (746s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-indfb-plflip-blt)
[274.551559] Starting subtest: fbcpsrhdr-2p-primscrn-indfb-plflip-blt
[274.556086] Subtest fbcpsrhdr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[274.652345] [045/155] (746s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[274.750173] Starting subtest: hdr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[274.754376] Subtest hdr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[274.849054] [046/155] (745s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area)
[274.949167] Starting subtest: fbc-psr2-overlay-plane-update-sf-dmg-area
[274.951542] Starting dynamic subtest: pipe-A-eDP-1
[275.047314] Dynamic subtest pipe-A-eDP-1: SKIP (0.101s)
[275.059194] Starting dynamic subtest: pipe-B-eDP-1
[276.181811] Dynamic subtest pipe-B-eDP-1: SKIP (1.131s)
[276.186670] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (1.234s)
[277.391709] [047/155] (743s left) gem_mmap_gtt (cpuset-basic-small-copy)
[277.450657] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[277.505314] [048/155] (743s left) i915_query (query-regions-garbage-items)
[277.552069] Starting subtest: query-regions-garbage-items
[277.554225] Subtest query-regions-garbage-items: SUCCESS (0.000s)
[277.641455] [049/155] (743s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-pwrite)
[277.740428] Starting subtest: psr-1p-primscrn-cur-indfb-draw-pwrite
[284.728094] Subtest psr-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (6.992s)
[284.830572] [050/155] (736s left) gem_exec_whisper (basic-contexts)
[284.893787] Starting subtest: basic-contexts
[292.293505] Subtest basic-contexts: SUCCESS (7.397s)
[292.484418] [051/155] (728s left) kms_chamelium_frames (hdmi-aspect-ratio)
[292.868515] Subtest hdmi-aspect-ratio: SKIP (0.000s)
[293.692376] [052/155] (727s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[293.814548] Starting subtest: cursor-vs-flip-atomic
[323.508749] Subtest cursor-vs-flip-atomic: SUCCESS (29.690s)
[324.346158] [053/155] (696s left) kms_cursor_edge_walk (64x64-top-bottom)
[324.456709] Starting subtest: 64x64-top-bottom
[324.458997] Starting dynamic subtest: pipe-A-eDP-1
[327.918984] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.462s)
[327.931415] Starting dynamic subtest: pipe-D-eDP-1
[331.137781] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.216s)
[331.139863] Subtest 64x64-top-bottom: SUCCESS (6.680s)
[331.950836] [054/155] (689s left) gem_pxp (create-regular-context-1)
[332.077703] Starting subtest: create-regular-context-1
[332.080264] Subtest create-regular-context-1: SUCCESS (0.001s)
[332.193216] [055/155] (688s left) kms_flip (2x-flip-vs-suspend-interruptible)
[332.295088] Starting subtest: 2x-flip-vs-suspend-interruptible
[332.299555] Subtest 2x-flip-vs-suspend-interruptible: SKIP (0.002s)
[332.377250] [056/155] (688s left) kms_mmap_write_crc (main)
[332.471707] Starting subtest: main
[332.474061] Starting dynamic subtest: pipe-A-eDP-1
[336.093722] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.620s)
[336.096109] Subtest main: SUCCESS (3.621s)
[336.996524] [057/155] (684s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[337.095628] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu
[337.100143] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[337.179631] [058/155] (684s left) kms_chamelium_hpd (hdmi-hpd-for-each-pipe)
[337.563552] Subtest hdmi-hpd-for-each-pipe: SKIP (0.000s)
[338.393508] [059/155] (682s left) gem_exec_reloc (basic-gtt-read-active)
[338.447734] Subtest basic-gtt-read-active: SKIP (0.000s)
[338.523641] [060/155] (682s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[338.617759] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt
[338.621856] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[338.708702] [061/155] (682s left) gem_eio (unwedge-stress)
[338.939882] Starting subtest: unwedge-stress
[338.942093] Starting dynamic subtest: render
[343.679385] Dynamic subtest render: SUCCESS (4.737s)
[343.694470] Starting dynamic subtest: bsd1
[361.783246] Dynamic subtest bsd1: SUCCESS (18.102s)
[361.799875] Starting dynamic subtest: bsd2
[379.831805] Dynamic subtest bsd2: SUCCESS (18.047s)
[379.848836] Starting dynamic subtest: blt
[379.853263] Dynamic subtest blt: SKIP (0.000s)
[379.862557] Starting dynamic subtest: vebox
[397.837619] Dynamic subtest vebox: SUCCESS (18.002s)
[397.839581] Subtest unwedge-stress: SUCCESS (58.894s)
[399.390210] [062/155] (622s left) vgem_basic (second-client)
[399.437483] Starting subtest: second-client
[399.457965] Subtest second-client: SUCCESS (0.022s)
[399.520825] [063/155] (622s left) sw_sync (sync_merge_same)
[399.554368] Starting subtest: sync_merge_same
[399.556765] Subtest sync_merge_same: SUCCESS (0.000s)
[399.621180] [064/155] (621s left) kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-shrfb-draw-blt)
[399.721344] Starting subtest: fbchdr-1p-offscreen-pri-shrfb-draw-blt
[399.725527] Subtest fbchdr-1p-offscreen-pri-shrfb-draw-blt: SKIP (0.000s)
[399.813379] [065/155] (621s left) kms_async_flips (test-cursor-atomic)
[399.901698] Starting subtest: test-cursor-atomic
[400.285170] Starting dynamic subtest: pipe-A-eDP-1
[401.108539] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.824s)
[401.500095] Starting dynamic subtest: pipe-B-eDP-1
[402.252953] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.759s)
[402.630397] Starting dynamic subtest: pipe-C-eDP-1
[403.388933] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.766s)
[403.757699] Starting dynamic subtest: pipe-D-eDP-1
[404.515998] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.767s)
[404.518409] Subtest test-cursor-atomic: SUCCESS (4.617s)
[405.682348] [066/155] (615s left) template (a)
[405.730827] Starting subtest: A
[405.733128] Subtest A: SUCCESS (0.000s)
[405.834709] [067/155] (615s left) gem_exec_schedule (pi-ringfull)
[406.019869] Starting subtest: pi-ringfull
[406.022268] Starting dynamic subtest: rcs0
[406.044174] Dynamic subtest rcs0: SUCCESS (0.028s)
[406.063048] Starting dynamic subtest: bcs0
[406.072540] Dynamic subtest bcs0: SUCCESS (0.028s)
[406.087106] Starting dynamic subtest: vcs0
[406.099457] Dynamic subtest vcs0: SUCCESS (0.026s)
[406.114036] Starting dynamic subtest: vcs1
[406.127035] Dynamic subtest vcs1: SUCCESS (0.027s)
[406.141807] Starting dynamic subtest: vecs0
[406.153211] Dynamic subtest vecs0: SUCCESS (0.025s)
[406.167936] Starting dynamic subtest: ccs0
[406.180423] Dynamic subtest ccs0: SUCCESS (0.026s)
[406.182601] Subtest pi-ringfull: SUCCESS (0.165s)
[406.412754] [068/155] (615s left) gem_exec_balancer (parallel-bb-first)
[406.662331] Starting subtest: parallel-bb-first
[407.621848] Subtest parallel-bb-first: SUCCESS (0.960s)
[408.413613] [069/155] (613s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-blt)
[408.521811] Starting subtest: psr-2p-primscrn-pri-indfb-draw-blt
[408.526018] Subtest psr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[408.622291] [070/155] (613s left) gem_exec_reloc (basic-active)
[408.678078] Subtest basic-active: SKIP (0.000s)
[408.756321] [071/155] (613s left) gem_softpin (evict-single-offset)
[408.810913] Starting subtest: evict-single-offset
[435.303062] Subtest evict-single-offset: SUCCESS (26.488s)
[435.399426] [072/155] (586s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping)
[435.542432] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping
[435.546714] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[435.616277] [073/155] (586s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy)
[435.690707] Starting subtest: map-fixed-invalidate-overlap-busy
[435.694941] Subtest map-fixed-invalidate-overlap-busy: SKIP (0.000s)
[435.828367] [074/155] (586s left) kms_flip (flip-vs-expired-vblank-interruptible)
[435.927056] Starting subtest: flip-vs-expired-vblank-interruptible
[435.929401] Starting dynamic subtest: A-eDP1
[444.594843] Dynamic subtest A-eDP1: SUCCESS (8.667s)
[444.608568] Starting dynamic subtest: B-eDP1
[453.236166] Dynamic subtest B-eDP1: SUCCESS (8.638s)
[453.248763] Starting dynamic subtest: C-eDP1
[461.862871] Dynamic subtest C-eDP1: SUCCESS (8.626s)
[461.876596] Starting dynamic subtest: D-eDP1
[470.489066] Dynamic subtest D-eDP1: SUCCESS (8.623s)
[470.494335] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (34.566s)
[471.662405] [075/155] (550s left) kms_joiner (invalid-modeset-force-big-joiner)
[471.766764] Starting subtest: invalid-modeset-force-big-joiner
[471.771146] Subtest invalid-modeset-force-big-joiner: SKIP (0.000s)
[471.836834] [076/155] (550s left) kms_content_protection (uevent-hdcp14)
[471.981765] Starting subtest: uevent-hdcp14
[471.986572] Subtest uevent-hdcp14: SKIP (0.000s)
[472.109827] [077/155] (550s left) kms_psr (fbc-psr2-cursor-mmap-cpu)
[472.206133] Starting subtest: fbc-psr2-cursor-mmap-cpu
[472.207992] Starting dynamic subtest: eDP-1
[472.212099] Dynamic subtest eDP-1: SKIP (0.000s)
[472.216186] Subtest fbc-psr2-cursor-mmap-cpu: SKIP (0.001s)
[472.280077] [078/155] (549s left) gem_partial_pwrite_pread (reads-snoop)
[472.337611] Subtest reads-snoop: SKIP (0.000s)
[472.413320] [079/155] (549s left) kms_plane_scaling (2x-scaler-multi-pipe)
[472.501097] Starting subtest: 2x-scaler-multi-pipe
[472.505490] Subtest 2x-scaler-multi-pipe: SKIP (0.001s)
[472.605150] [080/155] (549s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-rte)
[472.700225] Starting subtest: fbcpsrhdr-2p-rte
[472.703825] Subtest fbcpsrhdr-2p-rte: SKIP (0.000s)
[472.820696] [081/155] (549s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[472.878523] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[472.985817] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.105s)
[473.063424] [082/155] (549s left) gem_ctx_shared (exec-shared-gtt)
[473.135057] Starting subtest: exec-shared-gtt
[473.137086] Starting dynamic subtest: rcs0
[473.139446] Dynamic subtest rcs0: SUCCESS (0.006s)
[473.150499] Starting dynamic subtest: bcs0
[473.152681] Dynamic subtest bcs0: SUCCESS (0.005s)
[473.163021] Starting dynamic subtest: vcs0
[473.165247] Dynamic subtest vcs0: SUCCESS (0.006s)
[473.176887] Starting dynamic subtest: vcs1
[473.178758] Dynamic subtest vcs1: SUCCESS (0.005s)
[473.189044] Starting dynamic subtest: vecs0
[473.190894] Dynamic subtest vecs0: SUCCESS (0.007s)
[473.201139] Starting dynamic subtest: ccs0
[473.203038] Dynamic subtest ccs0: SUCCESS (0.007s)
[473.204861] Subtest exec-shared-gtt: SUCCESS (0.041s)
[473.361486] [083/155] (549s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-mc-ccs)
[473.462998] Starting subtest: crc-primary-suspend-4-tiled-mtl-mc-ccs
[473.465390] Starting dynamic subtest: pipe-A-eDP-1
[507.939771] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.665s)
[507.953803] Starting dynamic subtest: pipe-B-eDP-1
[542.880156] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.478s)
[542.892178] Starting dynamic subtest: pipe-C-eDP-1
[577.866104] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.566s)
[577.879792] Starting dynamic subtest: pipe-D-eDP-1
[612.862111] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.426s)
[612.864545] Subtest crc-primary-suspend-4-tiled-mtl-mc-ccs: SUCCESS (18.140s)
[624.114402] [084/155] (408s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-pgflip-blt)
[624.247644] Starting subtest: fbc-2p-scndscrn-indfb-pgflip-blt
[624.252164] Subtest fbc-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[624.329039] [085/155] (408s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[624.438636] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[624.442933] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[624.537061] [086/155] (408s left) syncobj_timeline (wait-any-interrupted)
[624.584982] Starting subtest: wait-any-interrupted
[624.694973] Subtest wait-any-interrupted: SUCCESS (0.109s)
[624.787181] [087/155] (407s left) gem_ctx_exec (basic-nohangcheck)
[624.849356] Starting subtest: basic-nohangcheck
[625.075992] Subtest basic-nohangcheck: SUCCESS (0.237s)
[625.183120] [088/155] (407s left) drm_read (short-buffer-block)
[625.321585] Starting subtest: short-buffer-block
[625.323865] Subtest short-buffer-block: SUCCESS (0.000s)
[625.440638] [089/155] (407s left) gem_exec_params (invalid-bsd2-flag-on-render)
[625.500523] Starting subtest: invalid-bsd2-flag-on-render
[625.502924] Subtest invalid-bsd2-flag-on-render: SUCCESS (0.000s)
[625.599620] [090/155] (407s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled)
[625.643366] Starting subtest: multi-wait-for-submit-available-submitted-signaled
[625.645523] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.000s)
[625.763137] [091/155] (406s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-blt)
[625.860177] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-blt
[625.863821] Subtest psr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[625.975573] [092/155] (406s left) kms_cursor_legacy (forked-move)
[626.089667] Starting subtest: forked-move
[626.091531] Starting dynamic subtest: pipe-A
[631.423961] Dynamic subtest pipe-A: SUCCESS (5.461s)
[631.446935] Starting dynamic subtest: pipe-B
[636.829970] Dynamic subtest pipe-B: SUCCESS (5.466s)
[636.848881] Starting dynamic subtest: pipe-C
[642.272880] Dynamic subtest pipe-C: SUCCESS (5.473s)
[642.295440] Starting dynamic subtest: pipe-D
[647.734984] Dynamic subtest pipe-D: SUCCESS (5.476s)
[647.751555] Starting dynamic subtest: all-pipes
[653.236787] Dynamic subtest all-pipes: SUCCESS (5.510s)
[653.239285] Subtest forked-move: SUCCESS (27.398s)
[653.384197] [093/155] (379s left) perf (blocking)
[653.547409] Starting subtest: blocking
[653.549323] Starting dynamic subtest: 0-rcs0
[663.581140] Dynamic subtest 0-rcs0: SUCCESS (10.029s)
[663.594561] Starting dynamic subtest: 1-vecs0
[673.607055] Dynamic subtest 1-vecs0: SUCCESS (10.023s)
[673.609568] Subtest blocking: SUCCESS (20.054s)
[673.659009] [094/155] (359s left) kms_pipe_crc_basic (hang-read-crc)
[673.765929] Starting subtest: hang-read-crc
[673.768228] Starting dynamic subtest: pipe-A-eDP-1
[675.885866] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.119s)
[675.901667] Starting dynamic subtest: pipe-B-eDP-1
[678.754160] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.866s)
[678.766973] Starting dynamic subtest: pipe-C-eDP-1
[681.475074] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.721s)
[681.487750] Starting dynamic subtest: pipe-D-eDP-1
[684.134159] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.658s)
[684.136562] Subtest hang-read-crc: SUCCESS (10.371s)
[684.971411] [095/155] (347s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-pwrite)
[685.068268] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-pwrite
[690.496481] Subtest fbc-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (5.434s)
[691.664490] [096/155] (341s left) kms_tiled_display (basic-test-pattern)
[691.784866] Subtest basic-test-pattern: SKIP (0.000s)
[691.832328] [097/155] (341s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[691.933952] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[692.580598] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.648s)
[692.748882] [098/155] (340s left) gem_ctx_param (invalid-get-no-zeromap)
[692.798549] Starting subtest: invalid-get-no-zeromap
[692.800857] Subtest invalid-get-no-zeromap: SUCCESS (0.001s)
[692.935160] [099/155] (340s left) kms_prime (basic-modeset-hybrid)
[693.023285] Subtest basic-modeset-hybrid: SKIP (0.000s)
[693.120825] [100/155] (340s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-cc-modifier)
[693.205750] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-cc-modifier
[693.231532] Starting dynamic subtest: pipe-A-plane-0
[693.519605] Dynamic subtest pipe-A-plane-0: SUCCESS (0.289s)
[693.531133] Starting dynamic subtest: pipe-A-plane-3
[693.752895] Dynamic subtest pipe-A-plane-3: SUCCESS (0.232s)
[693.764529] Starting dynamic subtest: pipe-A-plane-5
[693.768367] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[694.831816] Starting dynamic subtest: pipe-B-plane-0
[695.121074] Dynamic subtest pipe-B-plane-0: SUCCESS (0.300s)
[695.133436] Starting dynamic subtest: pipe-B-plane-3
[695.354505] Dynamic subtest pipe-B-plane-3: SUCCESS (0.232s)
[695.366032] Starting dynamic subtest: pipe-B-plane-5
[695.370346] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[695.663603] Subtest pixel-format-4-tiled-mtl-rc-ccs-cc-modifier: SUCCESS (2.457s)
[696.524379] [101/155] (336s left) kms_frontbuffer_tracking (hdr-1p-primscrn-shrfb-msflip-blt)
[696.618070] Starting subtest: hdr-1p-primscrn-shrfb-msflip-blt
[696.622635] Subtest hdr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[696.717426] [102/155] (336s left) prime_mmap (test_invalid_sync_flags)
[696.763210] Starting subtest: test_invalid_sync_flags
[696.765555] Starting dynamic subtest: test_invalid_sync_flags-smem
[696.767789] Dynamic subtest test_invalid_sync_flags-smem: SUCCESS (0.000s)
[696.769951] Subtest test_invalid_sync_flags: SUCCESS (0.001s)
[696.872478] [103/155] (336s left) kms_psr (psr-primary-page-flip)
[696.966628] Starting subtest: psr-primary-page-flip
[696.968957] Starting dynamic subtest: eDP-1
[698.710653] Dynamic subtest eDP-1: SUCCESS (1.743s)
[698.712883] Subtest psr-primary-page-flip: SUCCESS (1.744s)
[699.571851] [104/155] (333s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-render)
[699.672389] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-render
[699.676378] Subtest fbc-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[699.777291] [105/155] (333s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy)
[699.903991] Starting subtest: 2x-long-flip-vs-cursor-legacy
[699.908527] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s)
[700.053853] [106/155] (333s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf)
[700.148458] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf
[700.150747] Starting dynamic subtest: pipe-A-eDP-1
[700.246983] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s)
[700.260025] Starting dynamic subtest: pipe-B-eDP-1
[701.440131] Dynamic subtest pipe-B-eDP-1: SKIP (1.191s)
[701.444898] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.293s)
[702.643578] [107/155] (330s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[702.742869] Starting subtest: fbchdr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[702.747124] Subtest fbchdr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[702.841102] [108/155] (330s left) kms_hdr (brightness-with-hdr)
[702.953879] Starting subtest: brightness-with-hdr
[702.956166] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010
[702.960287] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SKIP (0.000s)
[702.972901] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F
[702.977313] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SKIP (0.000s)
[702.981750] Subtest brightness-with-hdr: SKIP (0.003s)
[703.028205] [109/155] (330s left) kms_color (legacy-gamma-reset)
[703.129616] Starting subtest: legacy-gamma-reset
[703.131470] Starting dynamic subtest: pipe-A-eDP-1
[703.515243] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.388s)
[703.527052] Starting dynamic subtest: pipe-B-eDP-1
[703.529373] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.011s)
[703.540823] Starting dynamic subtest: pipe-C-eDP-1
[703.543087] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.011s)
[703.554191] Starting dynamic subtest: pipe-D-eDP-1
[703.556571] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.012s)
[703.558880] Subtest legacy-gamma-reset: SUCCESS (0.425s)
[704.377530] [110/155] (329s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180)
[704.474999] Starting subtest: linear-max-hw-stride-32bpp-rotate-180
[705.108025] Subtest linear-max-hw-stride-32bpp-rotate-180: FAIL (0.053s)
[705.152275] [111/155] (328s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-shrfb-msflip-blt)
[705.251144] Starting subtest: psrhdr-2p-scndscrn-shrfb-msflip-blt
[705.255340] Subtest psrhdr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[705.343227] [112/155] (328s left) kms_ccs (random-ccs-data-4-tiled-lnl-ccs)
[705.425346] Starting subtest: random-ccs-data-4-tiled-lnl-ccs
[705.429096] Subtest random-ccs-data-4-tiled-lnl-ccs: SKIP (0.000s)
[706.618778] [113/155] (327s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs)
[706.667145] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs
[706.671520] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[706.855121] [114/155] (326s left) kms_big_fb (linear-8bpp-rotate-0)
[706.952312] Starting subtest: linear-8bpp-rotate-0
[707.594495] Subtest linear-8bpp-rotate-0: FAIL (0.030s)
[707.637976] [115/155] (326s left) i915_module_load (reload)
[707.676456] Starting subtest: reload
[711.136103] Subtest reload: SUCCESS (3.462s)
[711.180683] [116/155] (322s left) kms_plane_scaling (planes-upscale-20x20-downscale-factor-0-5)
[712.609771] Starting subtest: planes-upscale-20x20-downscale-factor-0-5
[712.612128] Starting dynamic subtest: pipe-A
[712.632246] Dynamic subtest pipe-A: SKIP (0.019s)
[712.642531] Starting dynamic subtest: pipe-B
[712.669918] Dynamic subtest pipe-B: SKIP (0.036s)
[712.679914] Starting dynamic subtest: pipe-C
[712.707363] Dynamic subtest pipe-C: SKIP (0.037s)
[712.717510] Starting dynamic subtest: pipe-D
[712.744121] Dynamic subtest pipe-D: SKIP (0.037s)
[712.748319] Subtest planes-upscale-20x20-downscale-factor-0-5: SKIP (0.132s)
[712.832091] [117/155] (321s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-spr-indfb-draw-pwrite)
[712.926293] Starting subtest: fbchdr-2p-primscrn-spr-indfb-draw-pwrite
[712.930758] Subtest fbchdr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[713.011812] [118/155] (320s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-spr-indfb-draw-blt)
[713.109380] Starting subtest: psrhdr-1p-primscrn-spr-indfb-draw-blt
[713.113449] Subtest psrhdr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[713.208095] [119/155] (320s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-plflip-blt)
[713.304860] Starting subtest: psr-2p-scndscrn-indfb-plflip-blt
[713.309339] Subtest psr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[713.402050] [120/155] (320s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[713.493471] Starting subtest: fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-cpu
[713.497609] Subtest fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[713.593513] [121/155] (320s left) kms_psr (fbc-pr-primary-page-flip)
[713.686779] Starting subtest: fbc-pr-primary-page-flip
[713.690451] Subtest fbc-pr-primary-page-flip: SKIP (0.000s)
[713.773610] [122/155] (320s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move)
[713.870412] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move
[713.873731] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[713.969581] [123/155] (320s left) kms_frontbuffer_tracking (hdr-2p-primscrn-spr-indfb-draw-mmap-wc)
[714.061530] Starting subtest: hdr-2p-primscrn-spr-indfb-draw-mmap-wc
[714.065001] Subtest hdr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[714.169275] [124/155] (320s left) kms_frontbuffer_tracking (fbc-tiling-4)
[714.265917] Starting subtest: fbc-tiling-4
[718.508575] Subtest fbc-tiling-4: SUCCESS (4.248s)
[719.682017] [125/155] (314s left) kms_flip (plain-flip-interruptible)
[719.778186] Starting subtest: plain-flip-interruptible
[719.782919] Starting dynamic subtest: A-eDP1
[721.463941] Dynamic subtest A-eDP1: SUCCESS (1.683s)
[721.479969] Starting dynamic subtest: B-eDP1
[723.099004] Dynamic subtest B-eDP1: SUCCESS (1.631s)
[723.110441] Starting dynamic subtest: C-eDP1
[724.722294] Dynamic subtest C-eDP1: SUCCESS (1.621s)
[724.734773] Starting dynamic subtest: D-eDP1
[726.363468] Dynamic subtest D-eDP1: SUCCESS (1.640s)
[726.365834] Subtest plain-flip-interruptible: SUCCESS (6.585s)
[727.540628] [126/155] (306s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[727.643698] Starting subtest: psr-shrfb-scaledprimary
[733.446442] Subtest psr-shrfb-scaledprimary: SUCCESS (5.805s)
[733.571558] [127/155] (300s left) prime_vgem (basic-gtt)
[733.640423] Starting subtest: basic-gtt
[733.644946] Subtest basic-gtt: SKIP (0.000s)
[733.737447] [128/155] (300s left) gem_exec_balancer (sequential)
[733.804023] Starting subtest: sequential
[736.915195] Subtest sequential: SUCCESS (3.111s)
[737.208115] [129/155] (297s left) gem_pxp (verify-pxp-stale-buf-optout-execution)
[737.341614] Starting subtest: verify-pxp-stale-buf-optout-execution
[738.409639] Subtest verify-pxp-stale-buf-optout-execution: SUCCESS (1.070s)
[738.542065] [130/155] (295s left) kms_rotation_crc (cursor-rotation-180)
[738.649041] Starting subtest: cursor-rotation-180
[740.184145] Subtest cursor-rotation-180: SUCCESS (1.536s)
[741.364897] [131/155] (293s left) syncobj_timeline (invalid-transfer-illegal-handle)
[741.410403] Starting subtest: invalid-transfer-illegal-handle
[741.412778] Subtest invalid-transfer-illegal-handle: SUCCESS (0.000s)
[741.503110] [132/155] (293s left) kms_psr (fbc-psr-cursor-mmap-gtt)
[741.587482] Starting subtest: fbc-psr-cursor-mmap-gtt
[741.589787] Starting dynamic subtest: eDP-1
[741.593812] Dynamic subtest eDP-1: SKIP (0.000s)
[741.597829] Subtest fbc-psr-cursor-mmap-gtt: SKIP (0.001s)
[741.678051] [133/155] (292s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-indfb-draw-pwrite)
[741.782978] Starting subtest: psrhdr-1p-offscreen-pri-indfb-draw-pwrite
[741.787403] Subtest psrhdr-1p-offscreen-pri-indfb-draw-pwrite: SKIP (0.000s)
[741.891255] [134/155] (292s left) gen9_exec_parse (batch-invalid-length)
[741.961364] Subtest batch-invalid-length: SKIP (0.000s)
[742.035062] [135/155] (292s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[742.125639] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[742.127853] Starting dynamic subtest: pipe-A-default-mode
[744.906751] Dynamic subtest pipe-A-default-mode: SUCCESS (2.781s)
[744.909201] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.782s)
[745.788241] [136/155] (288s left) tools_test (sysfs_l3_parity)
[745.839653] Starting subtest: sysfs_l3_parity
[745.905329] Subtest sysfs_l3_parity: SKIP (0.079s)
[745.962613] [137/155] (288s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-pri-indfb-draw-blt)
[746.058423] Starting subtest: psrhdr-2p-primscrn-pri-indfb-draw-blt
[746.062841] Subtest psrhdr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[746.159329] [138/155] (288s left) tools_test (tools_test)
[746.211524] Starting subtest: tools_test
[746.264974] Subtest tools_test: SUCCESS (0.070s)
[746.328907] [139/155] (288s left) intel_hwmon (hwmon-write)
[746.378908] Subtest hwmon-write: SKIP (0.000s)
[746.438884] [140/155] (288s left) kms_dsc (dsc-with-output-formats-with-bpc)
[746.528981] Starting subtest: dsc-with-output-formats-with-bpc
[746.584681] Subtest dsc-with-output-formats-with-bpc: SKIP (0.001s)
[746.626805] [141/155] (288s left) kms_pm_rpm (dpms-non-lpsp)
[748.747884] Starting subtest: dpms-non-lpsp
[748.754225] Subtest dpms-non-lpsp: SKIP (0.001s)
[749.139352] [142/155] (285s left) kms_frontbuffer_tracking (hdr-rgb101010-draw-mmap-cpu)
[749.237496] Starting subtest: hdr-rgb101010-draw-mmap-cpu
[749.241426] Subtest hdr-rgb101010-draw-mmap-cpu: SKIP (0.000s)
[749.345458] [143/155] (285s left) syncobj_timeline (device-signal-unordered)
[749.403174] Starting subtest: device-signal-unordered
[749.405320] Subtest device-signal-unordered: SUCCESS (0.001s)
[749.504839] [144/155] (285s left) kms_flip (2x-flip-vs-modeset-vs-hang)
[749.594765] Starting subtest: 2x-flip-vs-modeset-vs-hang
[749.602865] Subtest 2x-flip-vs-modeset-vs-hang: SKIP (0.004s)
[749.677764] [145/155] (285s left) kms_vrr (negative-basic)
[749.775871] Starting subtest: negative-basic
[749.782527] Starting dynamic subtest: pipe-A-eDP-1
[755.201684] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.418s)
[755.492892] Subtest negative-basic: SUCCESS (5.717s)
[756.354657] [146/155] (278s left) gem_exec_fence (submit3)
[756.535502] Starting subtest: submit3
[756.540361] Subtest submit3: SKIP (0.000s)
[758.693360] [147/155] (276s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-cur-indfb-draw-pwrite)
[758.802468] Starting subtest: fbcpsrhdr-1p-primscrn-cur-indfb-draw-pwrite
[758.806812] Subtest fbcpsrhdr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[758.905360] [148/155] (276s left) syncobj_wait (reset-multiple-signaled)
[758.963439] Starting subtest: reset-multiple-signaled
[758.965881] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[759.078162] [149/155] (276s left) gem_userptr_blits (coherency-sync)
[759.140686] Starting subtest: coherency-sync
[759.349244] Subtest coherency-sync: SKIP (0.167s)
[759.439323] [150/155] (275s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-indfb-draw-blt)
[759.589201] Starting subtest: psrhdr-1p-primscrn-pri-indfb-draw-blt
[759.593219] Subtest psrhdr-1p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[759.691993] [151/155] (275s left) syncobj_wait (wait-delayed-signal)
[759.755034] Starting subtest: wait-delayed-signal
[759.859045] Subtest wait-delayed-signal: SUCCESS (0.102s)
[759.939097] [152/155] (275s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[760.035770] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[760.039966] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[760.121552] [153/155] (275s left) kms_cursor_crc (cursor-sliding-256x256)
[760.359586] Starting subtest: cursor-sliding-256x256
[760.367105] Starting dynamic subtest: pipe-A-eDP-1
[763.641775] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.275s)
[763.673767] Starting dynamic subtest: pipe-D-eDP-1
[767.546119] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.881s)
[767.548474] Subtest cursor-sliding-256x256: SUCCESS (7.185s)
[768.426840] [154/155] (267s left) gem_busy (parallel)
[768.620039] Starting subtest: parallel
[768.622033] Starting dynamic subtest: rcs0
[770.579789] Dynamic subtest rcs0: SUCCESS (1.960s)
[770.594389] Starting dynamic subtest: bcs0
[772.563577] Dynamic subtest bcs0: SUCCESS (1.981s)
[772.577450] Starting dynamic subtest: vcs0
[774.610675] Dynamic subtest vcs0: SUCCESS (2.044s)
[774.625766] Starting dynamic subtest: vcs1
[776.596250] Dynamic subtest vcs1: SUCCESS (1.982s)
[776.610172] Starting dynamic subtest: vecs0
[778.581826] Dynamic subtest vecs0: SUCCESS (1.983s)
[778.599918] Starting dynamic subtest: ccs0
[780.561578] Dynamic subtest ccs0: SUCCESS (1.978s)
[780.564311] Subtest parallel: SUCCESS (11.946s)
[780.794979] [155/155] (254s left) gem_workarounds (suspend-resume-fd)
[780.877203] Starting subtest: suspend-resume-fd
[797.661212] Subtest suspend-resume-fd: SUCCESS (2.368s)
[803.813748] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_flip
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: perf_pmu
results: parsing output: 4/ for test: kms_ccs
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: i915_pm_rps
results: parsing output: 8/ for test: gem_exec_reloc
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: api_intel_bb
results: parsing output: 12/ for test: gem_gpgpu_fill
results: parsing output: 13/ for test: gem_userptr_blits
results: parsing output: 14/ for test: api_intel_allocator
results: parsing output: 15/ for test: kms_vblank
results: parsing output: 16/ for test: gem_mmap_gtt
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: gem_ctx_persistence
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: gem_vm_create
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: gem_userptr_blits
results: parsing output: 23/ for test: kms_psr
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_plane_scaling
results: parsing output: 26/ for test: dmabuf_sync_file
results: parsing output: 27/ for test: kms_ccs
results: parsing output: 28/ for test: kms_cursor_crc
results: parsing output: 29/ for test: vgem_basic
results: parsing output: 30/ for test: gem_flink_basic
results: parsing output: 31/ for test: gem_exec_params
results: parsing output: 32/ for test: kms_busy
results: parsing output: 33/ for test: kms_psr
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: syncobj_wait
results: parsing output: 37/ for test: i915_drm_fdinfo
results: parsing output: 38/ for test: gem_exec_schedule
results: parsing output: 39/ for test: prime_vgem
results: parsing output: 40/ for test: kms_ccs
results: parsing output: 41/ for test: kms_big_fb
results: parsing output: 42/ for test: kms_big_fb
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_psr2_sf
results: parsing output: 46/ for test: gem_mmap_gtt
results: parsing output: 47/ for test: i915_query
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: gem_exec_whisper
results: parsing output: 50/ for test: kms_chamelium_frames
results: parsing output: 51/ for test: kms_cursor_legacy
results: parsing output: 52/ for test: kms_cursor_edge_walk
results: parsing output: 53/ for test: gem_pxp
results: parsing output: 54/ for test: kms_flip
results: parsing output: 55/ for test: kms_mmap_write_crc
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_chamelium_hpd
results: parsing output: 58/ for test: gem_exec_reloc
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: gem_eio
results: parsing output: 61/ for test: vgem_basic
results: parsing output: 62/ for test: sw_sync
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_async_flips
results: parsing output: 65/ for test: template
results: parsing output: 66/ for test: gem_exec_schedule
results: parsing output: 67/ for test: gem_exec_balancer
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: gem_exec_reloc
results: parsing output: 70/ for test: gem_softpin
results: parsing output: 71/ for test: kms_plane
results: parsing output: 72/ for test: gem_userptr_blits
results: parsing output: 73/ for test: kms_flip
results: parsing output: 74/ for test: kms_joiner
results: parsing output: 75/ for test: kms_content_protection
results: parsing output: 76/ for test: kms_psr
results: parsing output: 77/ for test: gem_partial_pwrite_pread
results: parsing output: 78/ for test: kms_plane_scaling
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: syncobj_timeline
results: parsing output: 81/ for test: gem_ctx_shared
results: parsing output: 82/ for test: kms_ccs
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: syncobj_timeline
results: parsing output: 86/ for test: gem_ctx_exec
results: parsing output: 87/ for test: drm_read
results: parsing output: 88/ for test: gem_exec_params
results: parsing output: 89/ for test: syncobj_timeline
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: kms_cursor_legacy
results: parsing output: 92/ for test: perf
results: parsing output: 93/ for test: kms_pipe_crc_basic
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_tiled_display
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: gem_ctx_param
results: parsing output: 98/ for test: kms_prime
results: parsing output: 99/ for test: kms_plane
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: prime_mmap
results: parsing output: 102/ for test: kms_psr
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: kms_cursor_legacy
results: parsing output: 105/ for test: kms_psr2_sf
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_hdr
results: parsing output: 108/ for test: kms_color
results: parsing output: 109/ for test: kms_big_fb
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_ccs
results: parsing output: 112/ for test: gem_render_copy
results: parsing output: 113/ for test: kms_big_fb
results: parsing output: 114/ for test: i915_module_load
results: parsing output: 115/ for test: kms_plane_scaling
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: kms_psr
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_flip
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: prime_vgem
results: parsing output: 127/ for test: gem_exec_balancer
results: parsing output: 128/ for test: gem_pxp
results: parsing output: 129/ for test: kms_rotation_crc
results: parsing output: 130/ for test: syncobj_timeline
results: parsing output: 131/ for test: kms_psr
results: parsing output: 132/ for test: kms_frontbuffer_tracking
results: parsing output: 133/ for test: gen9_exec_parse
results: parsing output: 134/ for test: kms_flip_scaled_crc
results: parsing output: 135/ for test: tools_test
results: parsing output: 136/ for test: kms_frontbuffer_tracking
results: parsing output: 137/ for test: tools_test
results: parsing output: 138/ for test: intel_hwmon
results: parsing output: 139/ for test: kms_dsc
results: parsing output: 140/ for test: kms_pm_rpm
results: parsing output: 141/ for test: kms_frontbuffer_tracking
results: parsing output: 142/ for test: syncobj_timeline
results: parsing output: 143/ for test: kms_flip
results: parsing output: 144/ for test: kms_vrr
results: parsing output: 145/ for test: gem_exec_fence
results: parsing output: 146/ for test: kms_frontbuffer_tracking
results: parsing output: 147/ for test: syncobj_wait
results: parsing output: 148/ for test: gem_userptr_blits
results: parsing output: 149/ for test: kms_frontbuffer_tracking
results: parsing output: 150/ for test: syncobj_wait
results: parsing output: 151/ for test: kms_frontbuffer_tracking
results: parsing output: 152/ for test: kms_cursor_crc
results: parsing output: 153/ for test: gem_busy
results: parsing output: 154/ for test: gem_workarounds
Done.