[62.481384] Initializing watchdogs
[62.481433]   /dev/watchdog0
[62.496052] [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]
[62.500364] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[62.502529] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[62.505894] [001/133] (960s left) kms_big_fb (yf-tiled-32bpp-rotate-180)
[62.651767] Starting subtest: yf-tiled-32bpp-rotate-180
[62.656376] Subtest yf-tiled-32bpp-rotate-180: SKIP (0.000s)
[62.740180] [002/133] (960s left) kms_psr (fbc-pr-suspend)
[62.833978] Starting subtest: fbc-pr-suspend
[62.838196] Subtest fbc-pr-suspend: SKIP (0.000s)
[62.918220] [003/133] (960s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[63.031503] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[63.035669] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[63.127633] [004/133] (959s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-msflip-blt)
[63.235204] Starting subtest: fbc-2p-scndscrn-shrfb-msflip-blt
[63.239658] Subtest fbc-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[63.331206] [005/133] (959s left) kms_hdr (bpc-switch-dpms)
[63.430977] Starting subtest: bpc-switch-dpms
[64.506753] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010
[69.050957] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SUCCESS (4.544s)
[70.095519] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F
[74.612736] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SUCCESS (4.512s)
[74.615257] Subtest bpc-switch-dpms: SUCCESS (11.167s)
[74.720937] [006/133] (948s left) gem_ctx_param (set-priority-invalid-size)
[74.784426] Starting subtest: set-priority-invalid-size
[74.786897] Subtest set-priority-invalid-size: SUCCESS (0.000s)
[74.893111] [007/133] (948s left) gem_exec_fence (syncobj-export)
[75.345549] Starting subtest: syncobj-export
[75.350697] Subtest syncobj-export: SUCCESS (0.006s)
[77.378416] [FACT gem_exec_fence (syncobj-export)] new: kernel.kmod_is_loaded.vgem: true
[77.381753] [008/133] (945s left) kms_dp_link_training (uhbr-mst)
[77.480786] Starting subtest: uhbr-mst
[77.489926] Subtest uhbr-mst: SKIP (0.000s)
[77.563241] [009/133] (945s left) kms_sequence (get-forked)
[77.660107] Starting subtest: get-forked
[77.662526] Starting dynamic subtest: pipe-A-eDP-1
[79.545446] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.871s)
[79.555197] Starting dynamic subtest: pipe-B-eDP-1
[82.059929] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.503s)
[82.068100] Starting dynamic subtest: pipe-C-eDP-1
[84.577728] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.506s)
[84.587056] Starting dynamic subtest: pipe-D-eDP-1
[87.108071] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.524s)
[87.110264] Subtest get-forked: SUCCESS (9.408s)
[87.946219] [010/133] (935s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs)
[88.048310] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs
[88.050717] Starting dynamic subtest: pipe-A-eDP-1
[88.075288] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[88.085063] Starting dynamic subtest: pipe-B-eDP-1
[88.106972] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[88.114707] Starting dynamic subtest: pipe-C-eDP-1
[88.136901] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[88.146074] Starting dynamic subtest: pipe-D-eDP-1
[88.168078] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[88.172192] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs: SKIP (0.003s)
[90.227791] [011/133] (933s left) kms_fence_pin_leak
[90.400793] [012/133] (933s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled)
[90.461210] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled
[90.465464] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[90.655560] [013/133] (932s left) kms_cursor_crc (cursor-offscreen-256x256)
[90.899071] Starting subtest: cursor-offscreen-256x256
[90.903845] Starting dynamic subtest: pipe-A-eDP-1
[92.826442] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.921s)
[92.855928] Starting dynamic subtest: pipe-D-eDP-1
[95.439302] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.590s)
[95.441687] Subtest cursor-offscreen-256x256: SUCCESS (4.535s)
[96.287660] [014/133] (927s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[96.388584] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[96.393077] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[96.489536] [015/133] (927s left) kms_psr (pr-cursor-blt)
[96.586216] Starting subtest: pr-cursor-blt
[96.590172] Subtest pr-cursor-blt: SKIP (0.000s)
[96.659761] [016/133] (926s left) gem_exec_schedule (manyslice)
[96.732576] Starting subtest: manyslice
[96.734542] Starting dynamic subtest: rcs0
[101.867356] Dynamic subtest rcs0: SUCCESS (5.140s)
[101.879347] Starting dynamic subtest: bcs0
[108.501277] Dynamic subtest bcs0: SUCCESS (6.632s)
[108.510909] Starting dynamic subtest: vcs0
[114.091394] Dynamic subtest vcs0: SUCCESS (5.588s)
[114.101994] Starting dynamic subtest: vcs1
[120.175444] Dynamic subtest vcs1: SUCCESS (6.081s)
[120.183592] Starting dynamic subtest: vecs0
[126.260029] Dynamic subtest vecs0: SUCCESS (6.084s)
[126.272018] Starting dynamic subtest: ccs0
[132.428440] Dynamic subtest ccs0: SUCCESS (6.167s)
[132.430523] Subtest manyslice: SUCCESS (35.698s)
[132.735101] [017/133] (890s left) gem_userptr_blits (sync-unmap)
[132.801494] Starting subtest: sync-unmap
[132.820430] Subtest sync-unmap: SUCCESS (0.017s)
[132.953392] [018/133] (890s left) kms_chamelium_hpd (dp-hpd-storm)
[133.347722] Subtest dp-hpd-storm: SKIP (0.000s)
[134.121117] [019/133] (889s left) kms_cursor_crc (cursor-rapid-movement-32x32)
[134.261544] Starting subtest: cursor-rapid-movement-32x32
[134.310184] Subtest cursor-rapid-movement-32x32: SKIP (0.043s)
[134.577597] [020/133] (889s left) gem_mmap_wc (read)
[134.633240] Subtest read: SKIP (0.000s)
[134.687801] [021/133] (889s left) gem_create (create-clear)
[134.744074] Starting subtest: create-clear
[134.746241] Starting dynamic subtest: smem0
[167.544447] Dynamic subtest smem0: SUCCESS (32.798s)
[167.546762] Subtest create-clear: SUCCESS (32.798s)
[167.730719] [022/133] (856s left) api_intel_bb (delta-check)
[167.788662] Starting subtest: delta-check
[167.794685] Subtest delta-check: SUCCESS (0.008s)
[167.916839] [023/133] (855s left) kms_invalid_mode (uint-max-clock)
[168.005334] Starting subtest: uint-max-clock
[168.007604] Starting dynamic subtest: pipe-A-eDP-1
[168.297696] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.295s)
[168.307225] Starting dynamic subtest: pipe-B-eDP-1
[168.309373] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[168.316596] Starting dynamic subtest: pipe-C-eDP-1
[168.318822] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[168.326329] Starting dynamic subtest: pipe-D-eDP-1
[168.328642] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[168.330898] Subtest uint-max-clock: SUCCESS (0.300s)
[169.184590] [024/133] (854s left) syncobj_eventfd (invalid-illegal-handle)
[169.241766] Starting subtest: invalid-illegal-handle
[169.243686] Subtest invalid-illegal-handle: SUCCESS (0.000s)
[169.331644] [025/133] (854s left) gem_lmem_swapping (verify)
[169.381476] Subtest verify: SKIP (0.000s)
[169.419859] [026/133] (854s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render)
[169.519844] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render
[169.523865] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[169.613028] [027/133] (854s left) gem_exec_reloc (basic-wc-read-noreloc)
[169.668964] Subtest basic-wc-read-noreloc: SKIP (0.000s)
[169.725253] [028/133] (854s left) kms_vblank (query-forked-hang)
[169.835059] Starting subtest: query-forked-hang
[169.836960] Starting dynamic subtest: pipe-A-eDP-1
[196.121482] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.286s)
[196.135106] Starting dynamic subtest: pipe-D-eDP-1
[221.068691] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.943s)
[221.070589] Subtest query-forked-hang: SUCCESS (51.233s)
[221.949892] [029/133] (802s left) kms_frontbuffer_tracking (psr-rgb565-draw-blt)
[222.044314] Starting subtest: psr-rgb565-draw-blt
[229.135821] Subtest psr-rgb565-draw-blt: SUCCESS (7.095s)
[229.270881] [030/133] (794s left) syncobj_timeline (wait-all-for-submit-snapshot)
[229.331087] Starting subtest: wait-all-for-submit-snapshot
[229.413995] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s)
[229.500110] [031/133] (794s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc)
[229.591993] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc
[229.594268] Starting dynamic subtest: pipe-A-eDP-1
[229.616817] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[229.627379] Starting dynamic subtest: pipe-B-eDP-1
[229.649438] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[229.657266] Starting dynamic subtest: pipe-C-eDP-1
[229.678574] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[229.685972] Starting dynamic subtest: pipe-D-eDP-1
[229.707809] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[229.711855] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc: SKIP (0.003s)
[231.839822] [032/133] (792s left) gem_workarounds (suspend-resume)
[231.898708] Starting subtest: suspend-resume
[247.800550] Subtest suspend-resume: SUCCESS (2.037s)
[247.939497] [033/133] (776s left) gem_pxp (reject-modify-context-protection-off-1)
[248.079335] Starting subtest: reject-modify-context-protection-off-1
[248.081659] Subtest reject-modify-context-protection-off-1: SUCCESS (0.002s)
[248.185032] [034/133] (776s left) prime_vgem (shrink)
[248.248425] Starting subtest: shrink
[248.276923] Subtest shrink: SUCCESS (0.029s)
[248.391768] [035/133] (776s left) gem_mmap_offset (partial-remap)
[248.453076] Starting subtest: partial-remap
[248.455105] Starting dynamic subtest: smem0
[248.464456] Dynamic subtest smem0: SUCCESS (0.004s)
[248.466836] Subtest partial-remap: SUCCESS (0.004s)
[248.566813] [036/133] (775s left) gen7_exec_parse (oacontrol-tracking)
[248.631636] Subtest oacontrol-tracking: SKIP (0.000s)
[248.713228] [037/133] (775s left) kms_cursor_edge_walk (64x64-top-bottom)
[248.817166] Starting subtest: 64x64-top-bottom
[248.819163] Starting dynamic subtest: pipe-A-eDP-1
[252.293550] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.440s)
[252.303479] Starting dynamic subtest: pipe-D-eDP-1
[255.432003] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.116s)
[255.434334] Subtest 64x64-top-bottom: SUCCESS (6.560s)
[256.244028] [038/133] (768s left) perf_pmu (most-busy-check-all)
[256.286053] Starting subtest: most-busy-check-all
[256.287984] Starting dynamic subtest: rcs0
[258.167287] Dynamic subtest rcs0: SUCCESS (1.872s)
[258.179564] Starting dynamic subtest: bcs0
[260.148539] Dynamic subtest bcs0: SUCCESS (1.973s)
[260.161506] Starting dynamic subtest: vcs0
[262.197171] Dynamic subtest vcs0: SUCCESS (2.041s)
[262.210410] Starting dynamic subtest: vcs1
[264.181435] Dynamic subtest vcs1: SUCCESS (1.977s)
[264.192128] Starting dynamic subtest: vecs0
[266.166878] Dynamic subtest vecs0: SUCCESS (1.978s)
[266.178260] Starting dynamic subtest: ccs0
[268.151887] Dynamic subtest ccs0: SUCCESS (1.981s)
[268.154802] Subtest most-busy-check-all: SUCCESS (11.834s)
[268.274107] [039/133] (756s left) gem_basic (create-close)
[268.330150] Starting subtest: create-close
[268.334630] Subtest create-close: SUCCESS (0.000s)
[268.419716] [040/133] (756s left) gem_exec_create (legacy)
[268.485616] Starting subtest: legacy
[268.488027] Starting dynamic subtest: smem
[272.180731] Dynamic subtest smem: SUCCESS (3.688s)
[272.183430] Subtest legacy: SUCCESS (3.690s)
[272.368343] [041/133] (752s left) gem_exec_schedule (fairslice-all)
[272.442652] Starting subtest: fairslice-all
[274.519438] Subtest fairslice-all: SUCCESS (2.079s)
[276.225880] [042/133] (748s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[276.328067] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[276.332152] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[276.451497] [043/133] (748s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[276.543211] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[276.545533] Starting dynamic subtest: pipe-A-default-mode
[279.320513] Dynamic subtest pipe-A-default-mode: SUCCESS (2.776s)
[279.322916] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.777s)
[280.173427] [044/133] (744s left) kms_plane_multiple (tiling-4)
[280.264631] Starting subtest: tiling-4
[280.266458] Starting dynamic subtest: pipe-A-eDP-1
[283.930834] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.665s)
[283.940202] Starting dynamic subtest: pipe-B-eDP-1
[288.464705] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.534s)
[288.475033] Starting dynamic subtest: pipe-C-eDP-1
[292.790636] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.324s)
[292.803477] Starting dynamic subtest: pipe-D-eDP-1
[297.125713] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.333s)
[297.127976] Subtest tiling-4: SUCCESS (16.861s)
[297.936811] [045/133] (726s left) syncobj_timeline (invalid-transfer-non-existent-point)
[297.998676] Starting subtest: invalid-transfer-non-existent-point
[298.000915] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[298.109159] [046/133] (726s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[298.209048] Starting subtest: y-tiled-32bpp-rotate-180
[298.213090] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[298.308868] [047/133] (726s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt)
[298.403040] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt
[305.232153] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (6.831s)
[305.372070] [048/133] (719s left) kms_draw_crc (draw-method-mmap-cpu)
[305.467353] Starting subtest: draw-method-mmap-cpu
[305.469424] Starting dynamic subtest: xrgb8888-untiled
[305.698658] Dynamic subtest xrgb8888-untiled: SUCCESS (0.233s)
[305.708980] Starting dynamic subtest: rgb565-untiled
[305.923240] Dynamic subtest rgb565-untiled: SUCCESS (0.221s)
[305.933636] Starting dynamic subtest: xrgb2101010-untiled
[306.142802] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.222s)
[306.152993] Starting dynamic subtest: xbgr16161616f-untiled
[306.365003] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.221s)
[306.374350] Starting dynamic subtest: xrgb8888-xtiled
[306.498325] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.133s)
[306.507408] Starting dynamic subtest: rgb565-xtiled
[306.620797] Dynamic subtest rgb565-xtiled: SUCCESS (0.121s)
[306.631915] Starting dynamic subtest: xrgb2101010-xtiled
[306.742873] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.121s)
[306.754367] Starting dynamic subtest: xbgr16161616f-xtiled
[306.865129] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.120s)
[306.874245] Starting dynamic subtest: xrgb8888-4tiled
[307.020884] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.155s)
[307.032548] Starting dynamic subtest: rgb565-4tiled
[307.154219] Dynamic subtest rgb565-4tiled: SUCCESS (0.131s)
[307.163584] Starting dynamic subtest: xrgb2101010-4tiled
[307.299530] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.144s)
[307.308936] Starting dynamic subtest: xbgr16161616f-4tiled
[307.443185] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.143s)
[307.445136] Subtest draw-method-mmap-cpu: SUCCESS (1.978s)
[307.536221] [049/133] (717s left) i915_suspend (debugfs-reader)
[307.594106] Starting subtest: debugfs-reader
[325.786103] Subtest debugfs-reader: SUCCESS (3.251s)
[325.988351] [050/133] (699s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-render)
[326.097780] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-render
[333.038501] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-render: SUCCESS (6.910s)
[333.177729] [051/133] (692s left) sysfs_heartbeat_interval (precise)
[333.242745] Starting subtest: precise
[333.245096] Starting dynamic subtest: vecs0
[341.134940] Dynamic subtest vecs0: SUCCESS (7.843s)
[341.147010] Starting dynamic subtest: ccs0
[344.111619] Dynamic subtest ccs0: SUCCESS (2.968s)
[344.126183] Starting dynamic subtest: vcs0
[351.120476] Dynamic subtest vcs0: SUCCESS (6.995s)
[351.133143] Starting dynamic subtest: bcs0
[352.225959] Dynamic subtest bcs0: SUCCESS (1.101s)
[352.238607] Starting dynamic subtest: rcs0
[353.341794] Dynamic subtest rcs0: SUCCESS (1.112s)
[353.351582] Starting dynamic subtest: vcs1
[361.109423] Dynamic subtest vcs1: SUCCESS (7.760s)
[361.111899] Subtest precise: SUCCESS (27.792s)
[361.205382] [052/133] (664s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[361.323768] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[361.327927] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[361.416905] [053/133] (663s left) kms_psr (psr2-primary-mmap-gtt)
[361.517548] Starting subtest: psr2-primary-mmap-gtt
[361.519799] Starting dynamic subtest: eDP-1
[363.005544] Dynamic subtest eDP-1: SKIP (1.484s)
[363.010550] Subtest psr2-primary-mmap-gtt: SKIP (1.486s)
[363.163229] [054/133] (662s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt)
[363.258303] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt
[366.977281] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (3.723s)
[368.129065] [055/133] (657s left) syncobj_wait (invalid-multi-wait-unsubmitted)
[368.184457] Starting subtest: invalid-multi-wait-unsubmitted
[368.186584] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[368.297997] [056/133] (657s left) intel_hwmon (hwmon-write)
[368.366520] Subtest hwmon-write: SKIP (0.000s)
[368.427350] [057/133] (657s left) kms_content_protection (uevent)
[368.580599] Starting subtest: uevent
[368.585020] Subtest uevent: SKIP (0.000s)
[368.889261] [058/133] (656s left) i915_query (query-topology-known-pci-ids)
[368.946431] Starting subtest: query-topology-known-pci-ids
[368.950803] Subtest query-topology-known-pci-ids: SKIP (0.000s)
[369.052811] [059/133] (656s left) kms_rotation_crc (sprite-rotation-180)
[369.143294] Starting subtest: sprite-rotation-180
[375.864396] Subtest sprite-rotation-180: SUCCESS (6.723s)
[377.103334] [060/133] (648s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[377.197515] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-wc
[377.201550] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[377.290449] [061/133] (648s left) gem_spin_batch (legacy-resubmit-new)
[377.351140] Starting subtest: legacy-resubmit-new
[377.353483] Starting dynamic subtest: default
[377.359719] Dynamic subtest default: SUCCESS (0.008s)
[377.371131] Starting dynamic subtest: render
[377.373506] Dynamic subtest render: SUCCESS (0.003s)
[377.383008] Starting dynamic subtest: bsd
[377.385247] Dynamic subtest bsd: SUCCESS (0.004s)
[377.394598] Starting dynamic subtest: bsd1
[377.396536] Dynamic subtest bsd1: SUCCESS (0.003s)
[377.405889] Starting dynamic subtest: bsd2
[377.407760] Dynamic subtest bsd2: SUCCESS (0.004s)
[377.416682] Starting dynamic subtest: blt
[377.418545] Dynamic subtest blt: SUCCESS (0.004s)
[377.427585] Starting dynamic subtest: vebox
[377.429448] Dynamic subtest vebox: SUCCESS (0.004s)
[377.431256] Subtest legacy-resubmit-new: SUCCESS (0.036s)
[379.135393] [062/133] (646s left) kms_color_pipeline (plane-lut1d-post-ctm3x4)
[379.223272] Starting subtest: plane-lut1d-post-ctm3x4
[379.402731] Starting dynamic subtest: pipe-A-plane-0
[379.558499] Dynamic subtest pipe-A-plane-0: SUCCESS (0.155s)
[379.568946] Starting dynamic subtest: pipe-A-plane-1
[379.703809] Dynamic subtest pipe-A-plane-1: SUCCESS (0.144s)
[379.714115] Starting dynamic subtest: pipe-A-plane-2
[379.892243] Dynamic subtest pipe-A-plane-2: SUCCESS (0.188s)
[381.090209] Starting dynamic subtest: pipe-B-plane-0
[381.251850] Dynamic subtest pipe-B-plane-0: SUCCESS (0.166s)
[381.263277] Starting dynamic subtest: pipe-B-plane-1
[381.383039] Dynamic subtest pipe-B-plane-1: SUCCESS (0.132s)
[381.396555] Starting dynamic subtest: pipe-B-plane-2
[381.538402] Dynamic subtest pipe-B-plane-2: SUCCESS (0.154s)
[382.726696] Starting dynamic subtest: pipe-C-plane-0
[382.851614] Dynamic subtest pipe-C-plane-0: SUCCESS (0.133s)
[382.861374] Starting dynamic subtest: pipe-C-plane-1
[382.984895] Dynamic subtest pipe-C-plane-1: SUCCESS (0.132s)
[382.994426] Starting dynamic subtest: pipe-C-plane-2
[383.140639] Dynamic subtest pipe-C-plane-2: SUCCESS (0.155s)
[384.366949] Starting dynamic subtest: pipe-D-plane-0
[384.503038] Dynamic subtest pipe-D-plane-0: SUCCESS (0.144s)
[384.514463] Starting dynamic subtest: pipe-D-plane-1
[384.647231] Dynamic subtest pipe-D-plane-1: SUCCESS (0.144s)
[384.657137] Starting dynamic subtest: pipe-D-plane-2
[384.792010] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s)
[385.076622] Subtest plane-lut1d-post-ctm3x4: SUCCESS (5.854s)
[385.938730] [063/133] (639s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt)
[386.054453] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt
[386.058887] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[386.149966] [064/133] (639s left) gem_exec_balancer (busy)
[386.210232] Starting subtest: busy
[388.110816] Subtest busy: SUCCESS (1.901s)
[388.426879] [065/133] (637s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted)
[388.491514] Starting subtest: invalid-multi-wait-all-unsubmitted
[388.493804] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[388.609306] [066/133] (637s left) kms_flip (2x-flip-vs-rmfb)
[388.706324] Starting subtest: 2x-flip-vs-rmfb
[388.715640] Subtest 2x-flip-vs-rmfb: SKIP (0.011s)
[388.820668] [067/133] (637s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[388.924981] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[392.940896] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (4.018s)
[394.149355] [068/133] (631s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[394.246515] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[394.248744] Starting dynamic subtest: pipe-A-eDP-1
[394.268423] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[394.279727] Starting dynamic subtest: pipe-B-eDP-1
[394.297593] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[394.306695] Starting dynamic subtest: pipe-C-eDP-1
[394.325363] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[394.334139] Starting dynamic subtest: pipe-D-eDP-1
[394.353097] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[394.355027] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.006s)
[396.504397] [069/133] (629s left) perf (global-sseu-config-invalid)
[396.632278] Starting subtest: global-sseu-config-invalid
[396.636785] Subtest global-sseu-config-invalid: SKIP (0.000s)
[396.681261] [070/133] (629s left) gem_mmap (basic)
[396.740575] Subtest basic: SKIP (0.000s)
[396.805902] [071/133] (629s left) gem_barrier_race (remote-request)
[396.863721] Starting subtest: remote-request
[396.866008] Starting dynamic subtest: rcs0
[402.030843] Dynamic subtest rcs0: SUCCESS (5.168s)
[402.034218] Subtest remote-request: SUCCESS (5.169s)
[402.184402] [072/133] (623s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[402.287054] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[402.296570] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.011s)
[402.379106] [073/133] (623s left) gem_userptr_blits (stress-purge)
[402.447463] Starting subtest: stress-purge
[407.843671] Subtest stress-purge: SUCCESS (5.394s)
[407.964797] [074/133] (618s left) kms_rmfb (close-fd)
[408.096910] Starting subtest: close-fd
[408.098914] Starting dynamic subtest: pipe-A-eDP-1
[408.206031] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.108s)
[408.216164] Starting dynamic subtest: pipe-B-eDP-1
[409.383777] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.175s)
[409.394963] Starting dynamic subtest: pipe-C-eDP-1
[410.514007] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.130s)
[410.524130] Starting dynamic subtest: pipe-D-eDP-1
[411.642016] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.127s)
[411.644251] Subtest close-fd: SUCCESS (3.547s)
[412.867330] [075/133] (613s left) core_setmaster (master-drop-set-user)
[412.962624] Starting subtest: master-drop-set-user
[412.975910] Subtest master-drop-set-user: SUCCESS (0.016s)
[413.018866] [076/133] (613s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[413.135606] Starting subtest: cursorA-vs-flipB-legacy
[413.141252] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s)
[413.284573] [077/133] (613s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier)
[413.373687] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier
[413.377867] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier: SKIP (0.000s)
[413.445860] [078/133] (612s left) kms_pm_rpm (fences-dpms)
[415.296688] Starting subtest: fences-dpms
[415.302724] Subtest fences-dpms: SKIP (0.000s)
[415.687692] [079/133] (610s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[415.785072] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[419.401236] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (3.619s)
[420.579361] [080/133] (605s left) gem_sync (basic-many-each)
[420.650867] Starting subtest: basic-many-each
[422.942343] Subtest basic-many-each: SUCCESS (2.300s)
[423.126326] [081/133] (603s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[423.253678] Starting subtest: 2x-cursor-vs-flip-legacy
[423.258271] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s)
[423.400135] [082/133] (603s left) kms_addfb_basic (bad-pitch-32)
[423.449535] Starting subtest: bad-pitch-32
[423.451433] Subtest bad-pitch-32: SUCCESS (0.000s)
[423.591539] [083/133] (602s left) perf (create-destroy-userspace-config)
[423.696953] Starting subtest: create-destroy-userspace-config
[423.715634] Subtest create-destroy-userspace-config: SUCCESS (0.017s)
[423.762549] [084/133] (602s left) kms_frontbuffer_tracking (fbc-1p-rte)
[423.854789] Starting subtest: fbc-1p-rte
[429.352223] Subtest fbc-1p-rte: SUCCESS (5.501s)
[430.508652] [085/133] (596s left) kms_properties (colorop-properties-legacy)
[430.599072] Starting subtest: colorop-properties-legacy
[430.601432] Starting dynamic subtest: pipe-A-eDP-1
[430.933236] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.335s)
[430.944984] Starting dynamic subtest: pipe-B-eDP-1
[432.045897] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.111s)
[432.058486] Starting dynamic subtest: pipe-C-eDP-1
[433.085157] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.038s)
[433.095487] Starting dynamic subtest: pipe-D-eDP-1
[434.128379] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.043s)
[434.130613] Subtest colorop-properties-legacy: SUCCESS (3.533s)
[434.926634] [086/133] (591s left) kms_big_fb (4-tiled-16bpp-rotate-90)
[435.030560] Starting subtest: 4-tiled-16bpp-rotate-90
[435.050333] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.019s)
[435.155613] [087/133] (591s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move)
[435.264501] Starting subtest: fbc-2p-primscrn-cur-indfb-move
[435.268683] Subtest fbc-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[435.363083] [088/133] (591s left) syncobj_wait (multi-wait-all-submitted)
[435.413593] Starting subtest: multi-wait-all-submitted
[435.519437] Subtest multi-wait-all-submitted: SUCCESS (0.105s)
[435.596253] [089/133] (591s left) syncobj_wait (invalid-multi-wait-all-unsubmitted)
[435.645171] Starting subtest: invalid-multi-wait-all-unsubmitted
[435.647627] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[435.750210] [090/133] (591s left) kms_chamelium_frames (hdmi-cmp-planar-formats)
[436.143228] Subtest hdmi-cmp-planar-formats: SKIP (0.000s)
[436.928326] [091/133] (589s left) perf (missing-sample-flags)
[437.006233] Starting subtest: missing-sample-flags
[437.008744] Subtest missing-sample-flags: SUCCESS (0.000s)
[437.057398] [092/133] (589s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[437.146331] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[437.150260] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[437.244960] [093/133] (589s left) gem_exec_async (forked-writes)
[437.313472] Starting subtest: forked-writes
[437.315752] Starting dynamic subtest: rcs0
[437.345201] Dynamic subtest rcs0: SUCCESS (0.027s)
[437.357347] Starting dynamic subtest: bcs0
[437.365498] Dynamic subtest bcs0: SUCCESS (0.024s)
[437.376776] Starting dynamic subtest: vcs0
[437.387973] Dynamic subtest vcs0: SUCCESS (0.022s)
[437.404638] Starting dynamic subtest: vcs1
[437.413422] Dynamic subtest vcs1: SUCCESS (0.025s)
[437.425316] Starting dynamic subtest: vecs0
[437.437169] Dynamic subtest vecs0: SUCCESS (0.023s)
[437.447480] Starting dynamic subtest: ccs0
[437.459514] Dynamic subtest ccs0: SUCCESS (0.022s)
[437.461730] Subtest forked-writes: SUCCESS (0.147s)
[437.690065] [094/133] (589s left) testdisplay
[437.997867] [095/133] (589s left) gem_lmem_swapping (heavy-multi)
[438.040470] Subtest heavy-multi: SKIP (0.000s)
[438.082844] [096/133] (589s left) gem_ctx_freq (sysfs)
[438.143597] Starting subtest: sysfs
[438.145506] Starting dynamic subtest: gt0
[443.661768] Dynamic subtest gt0: SUCCESS (5.521s)
[443.674536] Starting dynamic subtest: gt1
[485.138517] Dynamic subtest gt1: SUCCESS (41.472s)
[485.141174] Subtest sysfs: SUCCESS (46.996s)
[485.268674] [097/133] (541s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt)
[485.372069] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt
[485.376244] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[485.470742] [098/133] (541s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[485.567658] Starting subtest: psr2-overlay-plane-move-continuous-exceed-fully-sf
[485.570021] Starting dynamic subtest: pipe-A-eDP-1
[502.031581] Dynamic subtest pipe-A-eDP-1: SUCCESS (16.466s)
[502.045933] Starting dynamic subtest: pipe-B-eDP-1
[519.211601] Dynamic subtest pipe-B-eDP-1: SUCCESS (17.172s)
[519.213830] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SUCCESS (33.641s)
[520.016399] [099/133] (507s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25)
[520.120402] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25
[520.122668] Starting dynamic subtest: pipe-A
[520.183290] Dynamic subtest pipe-A: SUCCESS (0.065s)
[520.194883] Starting dynamic subtest: pipe-B
[521.335311] Dynamic subtest pipe-B: SUCCESS (1.150s)
[521.349916] Starting dynamic subtest: pipe-C
[522.439510] Dynamic subtest pipe-C: SUCCESS (1.102s)
[522.449648] Starting dynamic subtest: pipe-D
[523.564510] Dynamic subtest pipe-D: SUCCESS (1.124s)
[523.566815] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (3.446s)
[524.738935] [100/133] (502s left) gem_mmap_offset (ptrace)
[524.800822] Starting subtest: ptrace
[524.803237] Starting dynamic subtest: smem0-wb
[524.818552] Dynamic subtest smem0-wb: SUCCESS (0.017s)
[524.830658] Starting dynamic subtest: smem0-wc
[524.837633] Dynamic subtest smem0-wc: SUCCESS (0.018s)
[524.848293] Starting dynamic subtest: smem0-uc
[524.858053] Dynamic subtest smem0-uc: SUCCESS (0.020s)
[524.860441] Subtest ptrace: SUCCESS (0.061s)
[524.980783] [101/133] (502s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[525.079354] Starting subtest: plane-downscale-factor-0-75-with-rotation
[525.081615] Starting dynamic subtest: pipe-A
[525.307792] Dynamic subtest pipe-A: SUCCESS (0.230s)
[525.322497] Starting dynamic subtest: pipe-B
[526.613130] Dynamic subtest pipe-B: SUCCESS (1.304s)
[526.623424] Starting dynamic subtest: pipe-C
[527.961486] Dynamic subtest pipe-C: SUCCESS (1.347s)
[527.972058] Starting dynamic subtest: pipe-D
[529.290642] Dynamic subtest pipe-D: SUCCESS (1.327s)
[529.292830] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.213s)
[530.461628] [102/133] (496s left) i915_drm_fdinfo (most-busy-idle-check-all)
[530.505743] Starting subtest: most-busy-idle-check-all
[530.507949] Starting dynamic subtest: rcs0
[530.512562] Dynamic subtest rcs0: SKIP (0.004s)
[530.523672] Starting dynamic subtest: bcs0
[530.527752] Dynamic subtest bcs0: SKIP (0.000s)
[530.537759] Starting dynamic subtest: vcs0
[530.542170] Dynamic subtest vcs0: SKIP (0.000s)
[530.551593] Starting dynamic subtest: vcs1
[530.555712] Dynamic subtest vcs1: SKIP (0.000s)
[530.565366] Starting dynamic subtest: vecs0
[530.569415] Dynamic subtest vecs0: SKIP (0.000s)
[530.579082] Starting dynamic subtest: ccs0
[530.583119] Dynamic subtest ccs0: SKIP (0.000s)
[530.587237] Subtest most-busy-idle-check-all: SKIP (0.010s)
[530.625848] [103/133] (496s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[530.751632] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt
[530.755702] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[530.859333] [104/133] (496s left) kms_pipe_b_c_ivb (pipe-b-dpms-off-modeset-pipe-c)
[530.916461] Subtest pipe-B-dpms-off-modeset-pipe-C: SKIP (0.000s)
[530.979232] [105/133] (496s left) kms_chamelium_color (ctm-blue-to-red)
[531.076631] Subtest ctm-blue-to-red: SKIP (0.000s)
[531.124794] [106/133] (496s left) perf (gen8-unprivileged-single-ctx-counters)
[531.226992] Starting subtest: gen8-unprivileged-single-ctx-counters
[531.231636] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s)
[531.273842] [107/133] (496s left) i915_module_load (reload-no-display)
[531.306868] Starting subtest: reload-no-display
[538.571332] Subtest reload-no-display: SUCCESS (7.264s)
[538.602110] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[538.602878] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[538.606053] [108/133] (489s left) gem_ctx_persistence (file)
[540.167330] Starting subtest: file
[540.309931] Subtest file: SUCCESS (0.143s)
[540.417688] [FACT gem_ctx_persistence (file)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[540.419012] [FACT gem_ctx_persistence (file)] new: kernel.kmod_is_loaded.i915: true
[540.423010] [109/133] (487s left) api_intel_allocator (standalone)
[540.480787] Starting subtest: standalone
[540.497264] Subtest standalone: SUCCESS (0.018s)
[540.626844] [110/133] (487s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs-cc)
[540.728424] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs-cc
[540.730750] Starting dynamic subtest: pipe-A-eDP-1
[540.739700] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[540.749818] Starting dynamic subtest: pipe-B-eDP-1
[540.758725] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[540.769496] Starting dynamic subtest: pipe-C-eDP-1
[540.778144] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[540.787142] Starting dynamic subtest: pipe-D-eDP-1
[540.795879] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[540.800226] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s)
[542.988668] [111/133] (484s left) syncobj_wait (single-wait-signaled)
[543.043259] Starting subtest: single-wait-signaled
[543.045513] Subtest single-wait-signaled: SUCCESS (0.000s)
[543.139897] [112/133] (484s left) kms_feature_discovery (psr2)
[543.238391] Starting subtest: psr2
[543.240623] Subtest psr2: SUCCESS (0.000s)
[543.340107] [113/133] (484s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[543.449528] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip
[543.453923] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[543.549795] [114/133] (484s left) gem_userptr_blits (coherency-unsync)
[543.610810] Subtest coherency-unsync: SKIP (0.000s)
[543.744478] [115/133] (484s left) kms_atomic (plane-invalid-params)
[543.836681] Starting subtest: plane-invalid-params
[543.838927] Starting dynamic subtest: pipe-A-eDP-1
[544.235257] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.395s)
[544.237357] Subtest plane-invalid-params: SUCCESS (0.397s)
[545.113402] [116/133] (482s left) kms_psr (fbc-psr-primary-mmap-cpu)
[545.214507] Starting subtest: fbc-psr-primary-mmap-cpu
[545.216794] Starting dynamic subtest: eDP-1
[545.221161] Dynamic subtest eDP-1: SKIP (0.000s)
[545.225505] Subtest fbc-psr-primary-mmap-cpu: SKIP (0.001s)
[545.291429] [117/133] (482s left) gem_exec_schedule (preempt-user)
[545.362778] Starting subtest: preempt-user
[545.364686] Starting dynamic subtest: rcs0
[545.378656] Dynamic subtest rcs0: SUCCESS (0.023s)
[545.389575] Starting dynamic subtest: bcs0
[545.404013] Dynamic subtest bcs0: SUCCESS (0.025s)
[545.413943] Starting dynamic subtest: vcs0
[545.428128] Dynamic subtest vcs0: SUCCESS (0.023s)
[545.438174] Starting dynamic subtest: vcs1
[545.450344] Dynamic subtest vcs1: SUCCESS (0.022s)
[545.459824] Starting dynamic subtest: vecs0
[545.469767] Dynamic subtest vecs0: SUCCESS (0.018s)
[545.479624] Starting dynamic subtest: ccs0
[545.491591] Dynamic subtest ccs0: SUCCESS (0.021s)
[545.493811] Subtest preempt-user: SUCCESS (0.137s)
[547.172339] [118/133] (480s left) gem_gtt_cpu_tlb
[547.309083] [119/133] (480s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[547.361784] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[547.364134] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.000s)
[547.475710] [120/133] (480s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[547.579829] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[555.229454] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.651s)
[555.354432] [121/133] (472s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-render)
[555.449796] Starting subtest: fbcpsr-rgb101010-draw-render
[562.218214] Subtest fbcpsr-rgb101010-draw-render: SUCCESS (6.773s)
[562.334869] [122/133] (465s left) kms_rotation_crc (primary-4-tiled-reflect-x-180)
[562.436834] Starting subtest: primary-4-tiled-reflect-x-180
[569.470359] Subtest primary-4-tiled-reflect-x-180: SUCCESS (7.037s)
[570.637988] [123/133] (457s left) kms_pm_rpm (basic-rte)
[570.677585] Starting subtest: basic-rte
[573.642994] Subtest basic-rte: SUCCESS (2.969s)
[575.165263] [124/133] (453s left) gem_mmap_wc (write-gtt-read-wc)
[575.223515] Subtest write-gtt-read-wc: SKIP (0.000s)
[575.280562] [125/133] (453s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[575.365710] Starting subtest: compare-crc-sanitycheck-xr24
[575.367843] Starting dynamic subtest: pipe-A-eDP-1
[576.010501] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.645s)
[576.021603] Starting dynamic subtest: pipe-B-eDP-1
[577.347114] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.333s)
[577.357843] Starting dynamic subtest: pipe-C-eDP-1
[578.610377] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.261s)
[578.624770] Starting dynamic subtest: pipe-D-eDP-1
[579.851816] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.241s)
[579.854205] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.487s)
[580.675764] [126/133] (447s left) gem_partial_pwrite_pread (reads-uncached)
[580.736416] Subtest reads-uncached: SKIP (0.000s)
[580.804181] [127/133] (447s left) gem_exec_params (secure-non-master)
[580.855854] Starting subtest: secure-non-master
[580.859898] Subtest secure-non-master: SKIP (0.000s)
[580.971629] [128/133] (447s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf)
[581.057966] Starting subtest: psr2-cursor-plane-move-continuous-exceed-sf
[581.060288] Starting dynamic subtest: pipe-A-eDP-1
[591.745091] Dynamic subtest pipe-A-eDP-1: SUCCESS (10.693s)
[591.756017] Starting dynamic subtest: pipe-B-eDP-1
[603.172905] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.425s)
[603.175233] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SUCCESS (22.121s)
[604.033880] [129/133] (424s left) kms_big_fb (linear-16bpp-rotate-180)
[604.154783] Starting subtest: linear-16bpp-rotate-180
[605.568708] Subtest linear-16bpp-rotate-180: SUCCESS (1.413s)
[605.691260] [130/133] (422s left) i915_pm_rps (fence-order)
[605.750565] Starting subtest: fence-order
[608.868993] Subtest fence-order: SUCCESS (3.115s)
[608.982937] [131/133] (419s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0-hflip)
[609.097806] Starting subtest: linear-max-hw-stride-32bpp-rotate-0-hflip
[609.102231] Subtest linear-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[609.195651] [132/133] (419s left) kms_lease (empty-lease)
[609.301594] Starting subtest: empty-lease
[609.303861] Starting dynamic subtest: pipe-A-eDP-1
[609.306228] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[609.319222] Starting dynamic subtest: pipe-B-eDP-1
[609.321241] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[609.331000] Starting dynamic subtest: pipe-C-eDP-1
[609.332919] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[609.342300] Starting dynamic subtest: pipe-D-eDP-1
[609.344167] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[609.346075] Subtest empty-lease: SUCCESS (0.009s)
[609.419501] [133/133] (419s left) gem_exec_whisper (basic-forked-all)
[609.489131] Starting subtest: basic-forked-all
[623.060243] Subtest basic-forked-all: SUCCESS (13.569s)
[623.247559] Closing watchdogs
results: parsing output: 0/ for test: kms_big_fb
results: parsing output: 1/ for test: kms_psr
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: kms_hdr
results: parsing output: 5/ for test: gem_ctx_param
results: parsing output: 6/ for test: gem_exec_fence
results: parsing output: 7/ for test: kms_dp_link_training
results: parsing output: 8/ for test: kms_sequence
results: parsing output: 9/ for test: kms_ccs
results: parsing output: 10/ for test: kms_fence_pin_leak
results: parsing output: 11/ for test: gem_render_copy
results: parsing output: 12/ for test: kms_cursor_crc
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: gem_exec_schedule
results: parsing output: 16/ for test: gem_userptr_blits
results: parsing output: 17/ for test: kms_chamelium_hpd
results: parsing output: 18/ for test: kms_cursor_crc
results: parsing output: 19/ for test: gem_mmap_wc
results: parsing output: 20/ for test: gem_create
results: parsing output: 21/ for test: api_intel_bb
results: parsing output: 22/ for test: kms_invalid_mode
results: parsing output: 23/ for test: syncobj_eventfd
results: parsing output: 24/ for test: gem_lmem_swapping
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: gem_exec_reloc
results: parsing output: 27/ for test: kms_vblank
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: syncobj_timeline
results: parsing output: 30/ for test: kms_ccs
results: parsing output: 31/ for test: gem_workarounds
results: parsing output: 32/ for test: gem_pxp
results: parsing output: 33/ for test: prime_vgem
results: parsing output: 34/ for test: gem_mmap_offset
results: parsing output: 35/ for test: gen7_exec_parse
results: parsing output: 36/ for test: kms_cursor_edge_walk
results: parsing output: 37/ for test: perf_pmu
results: parsing output: 38/ for test: gem_basic
results: parsing output: 39/ for test: gem_exec_create
results: parsing output: 40/ for test: gem_exec_schedule
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_flip_scaled_crc
results: parsing output: 43/ for test: kms_plane_multiple
results: parsing output: 44/ for test: syncobj_timeline
results: parsing output: 45/ for test: kms_big_fb
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_draw_crc
results: parsing output: 48/ for test: i915_suspend
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: sysfs_heartbeat_interval
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_psr
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: syncobj_wait
results: parsing output: 55/ for test: intel_hwmon
results: parsing output: 56/ for test: kms_content_protection
results: parsing output: 57/ for test: i915_query
results: parsing output: 58/ for test: kms_rotation_crc
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: gem_spin_batch
results: parsing output: 61/ for test: kms_color_pipeline
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: gem_exec_balancer
results: parsing output: 64/ for test: syncobj_timeline
results: parsing output: 65/ for test: kms_flip
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: kms_ccs
results: parsing output: 68/ for test: perf
results: parsing output: 69/ for test: gem_mmap
results: parsing output: 70/ for test: gem_barrier_race
results: parsing output: 71/ for test: kms_flip
results: parsing output: 72/ for test: gem_userptr_blits
results: parsing output: 73/ for test: kms_rmfb
results: parsing output: 74/ for test: core_setmaster
results: parsing output: 75/ for test: kms_cursor_legacy
results: parsing output: 76/ for test: kms_plane
results: parsing output: 77/ for test: kms_pm_rpm
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: gem_sync
results: parsing output: 80/ for test: kms_cursor_legacy
results: parsing output: 81/ for test: kms_addfb_basic
results: parsing output: 82/ for test: perf
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_properties
results: parsing output: 85/ for test: kms_big_fb
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: syncobj_wait
results: parsing output: 88/ for test: syncobj_wait
results: parsing output: 89/ for test: kms_chamelium_frames
results: parsing output: 90/ for test: perf
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: gem_exec_async
results: parsing output: 93/ for test: testdisplay
results: parsing output: 94/ for test: gem_lmem_swapping
results: parsing output: 95/ for test: gem_ctx_freq
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_psr2_sf
results: parsing output: 98/ for test: kms_plane_scaling
results: parsing output: 99/ for test: gem_mmap_offset
results: parsing output: 100/ for test: kms_plane_scaling
results: parsing output: 101/ for test: i915_drm_fdinfo
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_pipe_b_c_ivb
results: parsing output: 104/ for test: kms_chamelium_color
results: parsing output: 105/ for test: perf
results: parsing output: 106/ for test: i915_module_load
results: parsing output: 107/ for test: gem_ctx_persistence
results: parsing output: 108/ for test: api_intel_allocator
results: parsing output: 109/ for test: kms_ccs
results: parsing output: 110/ for test: syncobj_wait
results: parsing output: 111/ for test: kms_feature_discovery
results: parsing output: 112/ for test: kms_big_fb
results: parsing output: 113/ for test: gem_userptr_blits
results: parsing output: 114/ for test: kms_atomic
results: parsing output: 115/ for test: kms_psr
results: parsing output: 116/ for test: gem_exec_schedule
results: parsing output: 117/ for test: gem_gtt_cpu_tlb
results: parsing output: 118/ for test: syncobj_timeline
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_rotation_crc
results: parsing output: 122/ for test: kms_pm_rpm
results: parsing output: 123/ for test: gem_mmap_wc
results: parsing output: 124/ for test: kms_pipe_crc_basic
results: parsing output: 125/ for test: gem_partial_pwrite_pread
results: parsing output: 126/ for test: gem_exec_params
results: parsing output: 127/ for test: kms_psr2_sf
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: i915_pm_rps
results: parsing output: 130/ for test: kms_big_fb
results: parsing output: 131/ for test: kms_lease
results: parsing output: 132/ for test: gem_exec_whisper
Done.