[57.574770] Initializing watchdogs
[57.574884]   /dev/watchdog0
[57.589157] [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]
[57.593300] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.595422] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.598689] [001/131] (960s left) kms_big_fb (linear-32bpp-rotate-270)
[57.728774] Starting subtest: linear-32bpp-rotate-270
[57.762828] Subtest linear-32bpp-rotate-270: SKIP (0.033s)
[57.925068] [002/131] (960s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling)
[58.032788] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling
[58.035166] Starting dynamic subtest: pipe-A-default-mode
[59.146855] Dynamic subtest pipe-A-default-mode: SKIP (1.118s)
[59.151821] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (1.119s)
[59.327464] [003/131] (958s left) kms_cursor_edge_walk (256x256-top-bottom)
[59.429850] Starting subtest: 256x256-top-bottom
[59.431974] Starting dynamic subtest: pipe-A-eDP-1
[62.855497] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.441s)
[62.864912] Starting dynamic subtest: pipe-D-eDP-1
[65.977649] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.130s)
[65.980018] Subtest 256x256-top-bottom: SUCCESS (6.573s)
[66.796766] [004/131] (951s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[66.907548] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu
[66.911472] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[67.545247] [005/131] (950s left) kms_chamelium_edid (dp-edid-resolution-list)
[68.002253] Subtest dp-edid-resolution-list: SKIP (0.000s)
[68.783323] [006/131] (949s left) vgem_basic (bad-flag)
[68.847963] Starting subtest: bad-flag
[68.849901] Subtest bad-flag: SUCCESS (0.000s)
[68.922462] [FACT vgem_basic (bad-flag)] new: kernel.kmod_is_loaded.vgem: true
[68.925613] [007/131] (949s left) kms_cursor_crc (cursor-onscreen-256x256)
[69.169400] Starting subtest: cursor-onscreen-256x256
[69.174897] Starting dynamic subtest: pipe-A-eDP-1
[71.317653] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.147s)
[71.345221] Starting dynamic subtest: pipe-D-eDP-1
[74.058874] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.722s)
[74.060965] Subtest cursor-onscreen-256x256: SUCCESS (4.892s)
[74.890555] [008/131] (943s left) kms_big_fb (4-tiled-32bpp-rotate-0)
[74.997954] Starting subtest: 4-tiled-32bpp-rotate-0
[76.372317] Subtest 4-tiled-32bpp-rotate-0: SUCCESS (1.374s)
[76.548625] [009/131] (941s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[76.640515] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[76.642426] Starting dynamic subtest: pipe-A-eDP-1
[76.659717] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[76.668664] Starting dynamic subtest: pipe-B-eDP-1
[76.687504] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[76.694577] Starting dynamic subtest: pipe-C-eDP-1
[76.710402] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[76.717236] Starting dynamic subtest: pipe-D-eDP-1
[76.732890] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[76.734681] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.005s)
[78.950199] [010/131] (939s left) gem_ctx_persistence (heartbeat-close)
[79.028398] Starting subtest: heartbeat-close
[79.033278] Subtest heartbeat-close: SKIP (0.000s)
[79.169277] [011/131] (939s left) gem_exec_reloc (basic-write-read-noreloc)
[79.231386] Subtest basic-write-read-noreloc: SKIP (0.000s)
[79.314871] [012/131] (939s left) syncobj_timeline (wait-all-for-submit-delayed-submit)
[79.375720] Starting subtest: wait-all-for-submit-delayed-submit
[79.480815] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.103s)
[79.580847] [013/131] (938s left) kms_psr (fbc-pr-suspend)
[79.681059] Starting subtest: fbc-pr-suspend
[79.685726] Subtest fbc-pr-suspend: SKIP (0.000s)
[79.776159] [014/131] (938s left) kms_lease (lease-invalid-crtc)
[79.875802] Starting subtest: lease-invalid-crtc
[79.878245] Starting dynamic subtest: pipe-A-eDP-1
[79.880575] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[79.889621] Starting dynamic subtest: pipe-B-eDP-1
[79.891546] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[79.898907] Starting dynamic subtest: pipe-C-eDP-1
[79.901124] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[79.908095] Starting dynamic subtest: pipe-D-eDP-1
[79.910256] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[79.912460] Subtest lease-invalid-crtc: SUCCESS (0.002s)
[79.969347] [015/131] (938s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[80.068412] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[80.072945] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[80.193078] [016/131] (938s left) kms_pm_lpsp (screens-disabled)
[81.296324] Starting subtest: screens-disabled
[81.300590] Subtest screens-disabled: SKIP (0.000s)
[81.387199] [017/131] (937s left) gen9_exec_parse (unaligned-access)
[81.442618] Subtest unaligned-access: SKIP (0.000s)
[81.517846] [018/131] (937s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[81.639766] Starting subtest: cursorA-vs-flipB-atomic-transitions
[81.644261] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.001s)
[81.811823] [019/131] (936s left) gem_mmap_wc (bad-offset)
[81.874374] Subtest bad-offset: SKIP (0.000s)
[81.934881] [020/131] (936s left) gem_ctx_isolation (preservation-reset)
[82.100327] Starting subtest: preservation-reset
[82.102935] Starting dynamic subtest: rcs0
[82.371595] Dynamic subtest rcs0: SUCCESS (0.272s)
[82.379526] Starting dynamic subtest: bcs0
[82.701335] Dynamic subtest bcs0: SUCCESS (0.329s)
[82.709057] Starting dynamic subtest: vcs0
[83.023430] Dynamic subtest vcs0: SUCCESS (0.322s)
[83.034202] Starting dynamic subtest: vcs1
[84.180665] Dynamic subtest vcs1: SUCCESS (1.157s)
[84.188852] Starting dynamic subtest: vecs0
[86.198708] Dynamic subtest vecs0: SUCCESS (2.017s)
[86.209128] Starting dynamic subtest: ccs0
[88.235668] Dynamic subtest ccs0: SUCCESS (2.036s)
[88.238261] Subtest preservation-reset: SUCCESS (6.137s)
[88.419047] [021/131] (930s left) gem_bad_reloc (negative-reloc-bltcopy)
[88.499091] Subtest negative-reloc-bltcopy: SKIP (0.000s)
[88.581890] [022/131] (930s left) syncobj_wait (single-wait-for-submit-submitted)
[88.637526] Starting subtest: single-wait-for-submit-submitted
[88.737791] Subtest single-wait-for-submit-submitted: SUCCESS (0.102s)
[88.843477] [023/131] (930s left) gem_mmap_gtt (basic-small-copy)
[88.907123] Subtest basic-small-copy: SKIP (0.000s)
[88.975990] [024/131] (930s left) kms_big_fb (yf-tiled-16bpp-rotate-270)
[89.092491] Starting subtest: yf-tiled-16bpp-rotate-270
[89.095856] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.000s)
[89.231276] [025/131] (929s left) kms_feature_discovery (display-4x)
[89.320188] Starting subtest: display-4x
[89.323935] Subtest display-4x: SKIP (0.000s)
[89.418318] [026/131] (929s left) gem_exec_reloc (basic-gtt-read-active)
[89.487805] Subtest basic-gtt-read-active: SKIP (0.000s)
[89.568712] [027/131] (929s left) gen9_exec_parse (allowed-all)
[89.632023] Subtest allowed-all: SKIP (0.000s)
[89.698327] [028/131] (929s left) kms_flip (2x-flip-vs-wf_vblank-interruptible)
[89.798031] Starting subtest: 2x-flip-vs-wf_vblank-interruptible
[89.809810] Subtest 2x-flip-vs-wf_vblank-interruptible: SKIP (0.010s)
[89.950857] [029/131] (929s left) kms_invalid_mode (bad-htotal)
[90.051246] Starting subtest: bad-htotal
[90.053288] Starting dynamic subtest: pipe-A-eDP-1
[90.338852] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.287s)
[90.349385] Starting dynamic subtest: pipe-B-eDP-1
[90.351783] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[90.361614] Starting dynamic subtest: pipe-C-eDP-1
[90.364028] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[90.371259] Starting dynamic subtest: pipe-D-eDP-1
[90.373651] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[90.376234] Subtest bad-htotal: SUCCESS (0.291s)
[91.180195] [030/131] (928s left) syncobj_eventfd (invalid-illegal-handle)
[91.242075] Starting subtest: invalid-illegal-handle
[91.244435] Subtest invalid-illegal-handle: SUCCESS (0.000s)
[91.372765] [031/131] (927s left) gem_exec_schedule (thriceslice)
[91.455993] Starting subtest: thriceslice
[91.458404] Starting dynamic subtest: rcs0
[91.473272] Dynamic subtest rcs0: SUCCESS (0.030s)
[91.483478] Starting dynamic subtest: bcs0
[91.501818] Dynamic subtest bcs0: SUCCESS (0.028s)
[91.509743] Starting dynamic subtest: vcs0
[91.552023] Dynamic subtest vcs0: SUCCESS (0.049s)
[91.563311] Starting dynamic subtest: vcs1
[91.581434] Dynamic subtest vcs1: SUCCESS (0.029s)
[91.590572] Starting dynamic subtest: vecs0
[91.609584] Dynamic subtest vecs0: SUCCESS (0.028s)
[91.617669] Starting dynamic subtest: ccs0
[91.660879] Dynamic subtest ccs0: SUCCESS (0.050s)
[91.663743] Subtest thriceslice: SUCCESS (0.217s)
[91.988147] [032/131] (927s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-render)
[92.097322] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-render
[92.101648] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[92.212631] [033/131] (927s left) kms_psr (psr2-sprite-blt)
[92.306354] Starting subtest: psr2-sprite-blt
[92.308716] Starting dynamic subtest: eDP-1
[94.035672] Dynamic subtest eDP-1: SUCCESS (1.728s)
[94.038048] Subtest psr2-sprite-blt: SUCCESS (1.729s)
[94.929225] [034/131] (924s left) gem_ccs (block-multicopy-compressed)
[94.990544] Starting subtest: block-multicopy-compressed
[94.995175] Subtest block-multicopy-compressed: SKIP (0.000s)
[95.124896] [035/131] (924s left) kms_plane_scaling (plane-upscale-20x20-with-modifiers)
[95.216105] Starting subtest: plane-upscale-20x20-with-modifiers
[95.218442] Starting dynamic subtest: pipe-A
[95.551499] Dynamic subtest pipe-A: SUCCESS (0.337s)
[95.559803] Starting dynamic subtest: pipe-B
[97.017044] Dynamic subtest pipe-B: SUCCESS (1.464s)
[97.025217] Starting dynamic subtest: pipe-C
[98.424280] Dynamic subtest pipe-C: SUCCESS (1.405s)
[98.433201] Starting dynamic subtest: pipe-D
[99.853792] Dynamic subtest pipe-D: SUCCESS (1.429s)
[99.856203] Subtest plane-upscale-20x20-with-modifiers: SUCCESS (4.640s)
[101.043185] [036/131] (918s left) kms_big_fb (x-tiled-8bpp-rotate-270)
[101.141928] Starting subtest: x-tiled-8bpp-rotate-270
[101.162661] Subtest x-tiled-8bpp-rotate-270: SKIP (0.020s)
[101.308631] [037/131] (918s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[101.402385] Starting subtest: bo-too-small-due-to-tiling
[101.406734] Subtest bo-too-small-due-to-tiling: SKIP (0.000s)
[101.525813] [038/131] (918s left) gem_workarounds (basic-read-context)
[101.585991] Starting subtest: basic-read-context
[101.598649] Subtest basic-read-context: SUCCESS (0.015s)
[101.762706] [039/131] (917s left) kms_flip (2x-blocking-wf_vblank)
[101.863083] Starting subtest: 2x-blocking-wf_vblank
[101.877581] Subtest 2x-blocking-wf_vblank: SKIP (0.014s)
[101.979322] [040/131] (917s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-pgflip-blt)
[102.072091] Starting subtest: fbcpsr-2p-scndscrn-shrfb-pgflip-blt
[102.075627] Subtest fbcpsr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[102.191953] [041/131] (917s left) gem_mmap_gtt (basic-write-read)
[102.234869] Subtest basic-write-read: SKIP (0.000s)
[102.302024] [042/131] (917s left) prime_vgem (fence-wait)
[102.384432] Starting subtest: fence-wait
[102.386550] Starting dynamic subtest: rcs0
[103.458828] Dynamic subtest rcs0: SUCCESS (1.073s)
[103.469087] Starting dynamic subtest: bcs0
[104.534037] Dynamic subtest bcs0: SUCCESS (1.074s)
[104.544815] Starting dynamic subtest: vcs0
[105.581663] Dynamic subtest vcs0: SUCCESS (1.047s)
[105.590718] Starting dynamic subtest: vcs1
[106.617789] Dynamic subtest vcs1: SUCCESS (1.035s)
[106.628405] Starting dynamic subtest: vecs0
[107.662676] Dynamic subtest vecs0: SUCCESS (1.043s)
[107.673339] Starting dynamic subtest: ccs0
[108.703227] Dynamic subtest ccs0: SUCCESS (1.039s)
[108.706273] Subtest fence-wait: SUCCESS (6.318s)
[108.873161] [043/131] (910s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[108.982498] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[116.288853] Subtest psr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.310s)
[116.438843] [044/131] (903s left) kms_flip (2x-nonexisting-fb)
[116.542348] Starting subtest: 2x-nonexisting-fb
[116.555287] Subtest 2x-nonexisting-fb: SKIP (0.012s)
[116.658825] [045/131] (903s left) perf_pmu (busy-idle)
[116.701576] Starting subtest: busy-idle
[116.704035] Starting dynamic subtest: rcs0
[117.404477] Dynamic subtest rcs0: SUCCESS (0.704s)
[117.415925] Starting dynamic subtest: bcs0
[118.075906] Dynamic subtest bcs0: SUCCESS (0.669s)
[118.087090] Starting dynamic subtest: vcs0
[119.895407] Dynamic subtest vcs0: SUCCESS (1.816s)
[119.906327] Starting dynamic subtest: vcs1
[121.879542] Dynamic subtest vcs1: SUCCESS (1.982s)
[121.890430] Starting dynamic subtest: vecs0
[123.927076] Dynamic subtest vecs0: SUCCESS (2.046s)
[123.938671] Starting dynamic subtest: ccs0
[124.603192] Dynamic subtest ccs0: SUCCESS (0.675s)
[124.605665] Subtest busy-idle: SUCCESS (7.904s)
[124.731503] [046/131] (895s left) kms_rotation_crc (primary-rotation-90)
[124.829358] Starting subtest: primary-rotation-90
[124.833687] Subtest primary-rotation-90: SKIP (0.001s)
[124.946991] [047/131] (894s left) dmabuf_sync_file (export-wait-after-attach)
[125.000095] Starting subtest: export-wait-after-attach
[125.002244] Subtest export-wait-after-attach: SUCCESS (0.000s)
[125.080055] [048/131] (894s left) kms_dirtyfb (default-dirtyfb-ioctl)
[125.177870] Starting subtest: default-dirtyfb-ioctl
[125.180445] Starting dynamic subtest: A-eDP-1
[126.760396] Dynamic subtest A-eDP-1: SUCCESS (1.581s)
[126.762400] Subtest default-dirtyfb-ioctl: SUCCESS (1.582s)
[127.624455] [049/131] (892s left) kms_frontbuffer_tracking (psr-rgb101010-draw-blt)
[127.739087] Starting subtest: psr-rgb101010-draw-blt
[134.936301] Subtest psr-rgb101010-draw-blt: SUCCESS (7.200s)
[135.097340] [050/131] (884s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[135.206113] Starting subtest: addfb25-y-tiled-legacy
[135.208068] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[135.319077] [051/131] (884s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt)
[135.428580] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt
[139.900326] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (4.475s)
[141.051103] [052/131] (879s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs)
[141.143200] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs
[141.145351] Starting dynamic subtest: pipe-A-eDP-1
[158.101536] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.044s)
[158.111294] Starting dynamic subtest: pipe-B-eDP-1
[175.078161] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.390s)
[175.095972] Starting dynamic subtest: pipe-C-eDP-1
[192.063346] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.387s)
[192.072892] Starting dynamic subtest: pipe-D-eDP-1
[209.022497] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.335s)
[209.024787] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs: SUCCESS (12.160s)
[210.261760] [053/131] (809s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[210.371053] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[210.375118] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[210.497331] [054/131] (809s left) kms_psr (fbc-pr-cursor-render)
[210.601660] Starting subtest: fbc-pr-cursor-render
[210.605942] Subtest fbc-pr-cursor-render: SKIP (0.000s)
[210.701645] [055/131] (809s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-pwrite)
[210.797689] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-pwrite
[210.801842] Subtest fbc-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[210.915069] [056/131] (809s left) kms_busy (basic-hang)
[211.016787] Starting subtest: basic-hang
[211.018919] Starting dynamic subtest: flip-pipe-A
[211.596577] Dynamic subtest flip-pipe-A: SUCCESS (0.591s)
[211.607131] Starting dynamic subtest: modeset-pipe-A
[214.980515] Dynamic subtest modeset-pipe-A: SUCCESS (3.439s)
[214.989959] Starting dynamic subtest: flip-pipe-D
[216.182676] Dynamic subtest flip-pipe-D: SUCCESS (1.213s)
[216.192543] Starting dynamic subtest: modeset-pipe-D
[219.565833] Dynamic subtest modeset-pipe-D: SUCCESS (3.415s)
[219.568016] Subtest basic-hang: SUCCESS (8.664s)
[220.390669] [057/131] (799s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled)
[220.454181] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[220.456271] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[220.579409] [058/131] (799s left) gem_userptr_blits (input-checking)
[220.650803] Starting subtest: input-checking
[220.652759] Subtest input-checking: SUCCESS (0.000s)
[220.809902] [059/131] (799s left) kms_cursor_crc (cursor-rapid-movement-512x170)
[221.118495] Starting subtest: cursor-rapid-movement-512x170
[221.122677] Subtest cursor-rapid-movement-512x170: SKIP (0.001s)
[221.291078] [060/131] (799s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[221.380935] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip
[221.384482] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[221.511622] [061/131] (798s left) kms_cursor_legacy (flip-vs-cursor-varying-size)
[221.648056] Starting subtest: flip-vs-cursor-varying-size
[230.011893] Subtest flip-vs-cursor-varying-size: SUCCESS (8.391s)
[230.889942] [062/131] (789s left) gem_exec_basic (basic)
[230.956358] Starting subtest: basic
[230.958557] Starting dynamic subtest: rcs0-smem
[230.960641] Dynamic subtest rcs0-smem: SUCCESS (0.002s)
[230.970307] Starting dynamic subtest: bcs0-smem
[230.972408] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[230.981156] Starting dynamic subtest: vcs0-smem
[230.983204] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[230.991808] Starting dynamic subtest: vcs1-smem
[230.993898] Dynamic subtest vcs1-smem: SUCCESS (0.003s)
[231.002343] Starting dynamic subtest: vecs0-smem
[231.004425] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[231.013394] Starting dynamic subtest: ccs0-smem
[231.015524] Dynamic subtest ccs0-smem: SUCCESS (0.002s)
[231.017730] Subtest basic: SUCCESS (0.015s)
[232.866694] [063/131] (787s left) kms_psr (fbc-psr-cursor-plane-onoff)
[232.955561] Starting subtest: fbc-psr-cursor-plane-onoff
[232.957853] Starting dynamic subtest: eDP-1
[232.962120] Dynamic subtest eDP-1: SKIP (0.000s)
[232.966237] Subtest fbc-psr-cursor-plane-onoff: SKIP (0.001s)
[233.055099] [064/131] (787s left) gem_spin_batch (spin-all)
[233.127906] Starting subtest: spin-all
[233.141955] Subtest spin-all: SUCCESS (0.012s)
[234.854641] [065/131] (785s left) kms_cursor_legacy (2x-long-cursor-vs-flip-atomic)
[234.971150] Starting subtest: 2x-long-cursor-vs-flip-atomic
[234.975558] Subtest 2x-long-cursor-vs-flip-atomic: SKIP (0.001s)
[235.139178] [066/131] (785s left) kms_psr (psr2-cursor-mmap-cpu)
[235.226909] Starting subtest: psr2-cursor-mmap-cpu
[235.229157] Starting dynamic subtest: eDP-1
[236.927392] Dynamic subtest eDP-1: SUCCESS (1.703s)
[236.929660] Subtest psr2-cursor-mmap-cpu: SUCCESS (1.704s)
[237.748005] [067/131] (783s left) kms_plane_scaling (plane-downscale-factor-0-5-with-rotation)
[237.841699] Starting subtest: plane-downscale-factor-0-5-with-rotation
[237.843929] Starting dynamic subtest: pipe-A
[237.860998] Dynamic subtest pipe-A: SKIP (0.016s)
[237.870314] Starting dynamic subtest: pipe-B
[237.893153] Dynamic subtest pipe-B: SKIP (0.032s)
[237.902961] Starting dynamic subtest: pipe-C
[237.922314] Dynamic subtest pipe-C: SKIP (0.029s)
[237.931509] Starting dynamic subtest: pipe-D
[237.950893] Dynamic subtest pipe-D: SKIP (0.029s)
[237.954411] Subtest plane-downscale-factor-0-5-with-rotation: SKIP (0.108s)
[238.081252] [068/131] (782s left) kms_atomic (plane-invalid-params-fence)
[238.179844] Starting subtest: plane-invalid-params-fence
[238.182003] Starting dynamic subtest: pipe-A-eDP-1
[238.557225] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.377s)
[238.559145] Subtest plane-invalid-params-fence: SUCCESS (0.378s)
[239.390162] [069/131] (781s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-render)
[239.496732] Starting subtest: psr-1p-primscrn-cur-indfb-draw-render
[246.220221] Subtest psr-1p-primscrn-cur-indfb-draw-render: SUCCESS (6.721s)
[246.383545] [070/131] (774s left) prime_vgem (coherency-gtt)
[246.479335] Starting subtest: coherency-gtt
[246.483686] Subtest coherency-gtt: SKIP (0.000s)
[246.619829] [071/131] (774s left) gem_exec_balancer (parallel)
[246.873637] Starting subtest: parallel
[247.748938] Subtest parallel: SUCCESS (0.875s)
[248.870364] [072/131] (772s left) gem_render_copy (linear-to-vebox-y-tiled)
[248.942541] Starting subtest: linear-to-vebox-y-tiled
[248.947370] Subtest linear-to-vebox-y-tiled: SKIP (0.000s)
[249.166049] [073/131] (771s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic)
[249.306348] Starting subtest: 2x-flip-vs-cursor-atomic
[249.310875] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.001s)
[249.474294] [074/131] (771s left) gem_exec_reloc (basic-write-wc-active)
[249.547110] Subtest basic-write-wc-active: SKIP (0.000s)
[249.631842] [075/131] (771s left) i915_pm_rps (reset)
[249.684693] Starting subtest: reset
[258.141974] Subtest reset: SUCCESS (8.453s)
[258.304985] [076/131] (762s left) api_intel_bb (object-reloc-keep-cache)
[258.363640] Starting subtest: object-reloc-keep-cache
[258.370793] Subtest object-reloc-keep-cache: SKIP (0.005s)
[258.534222] [077/131] (762s left) gem_tiled_pread_pwrite
[258.668548] [078/131] (762s left) kms_plane_alpha_blend (alpha-7efc)
[258.775788] Starting subtest: alpha-7efc
[259.055421] Starting dynamic subtest: pipe-A-eDP-1
[259.639770] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.583s)
[259.669327] Starting dynamic subtest: pipe-D-eDP-1
[261.010316] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.351s)
[261.012455] Subtest alpha-7efc: SUCCESS (2.236s)
[261.889949] [079/131] (759s left) kms_prop_blob (blob-multiple)
[261.951181] Starting subtest: blob-multiple
[261.953456] Subtest blob-multiple: SUCCESS (0.002s)
[262.087782] [080/131] (759s left) gem_exec_reloc (basic-cpu-active)
[262.145582] Subtest basic-cpu-active: SKIP (0.000s)
[262.206348] [081/131] (759s left) gem_shrink (reclaim)
[262.268425] Starting subtest: reclaim
[264.617193] Subtest reclaim: SUCCESS (2.347s)
[264.785334] [082/131] (756s left) gem_gtt_cpu_tlb
[264.911935] [083/131] (756s left) kms_vblank (query-busy-hang)
[265.022779] Starting subtest: query-busy-hang
[265.024665] Starting dynamic subtest: pipe-A-eDP-1
[291.568406] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.553s)
[291.582565] Starting dynamic subtest: pipe-D-eDP-1
[306.526055] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.956s)
[306.528223] Subtest query-busy-hang: SUCCESS (41.514s)
[307.348456] [084/131] (714s left) kms_plane_multiple (tiling-4)
[307.444415] Starting subtest: tiling-4
[307.447121] Starting dynamic subtest: pipe-A-eDP-1
[311.147955] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.703s)
[311.158776] Starting dynamic subtest: pipe-B-eDP-1
[315.502428] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.348s)
[315.513470] Starting dynamic subtest: pipe-C-eDP-1
[319.818495] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.315s)
[319.833321] Starting dynamic subtest: pipe-D-eDP-1
[324.164897] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.344s)
[324.167257] Subtest tiling-4: SUCCESS (16.715s)
[324.990817] [085/131] (696s left) gem_userptr_blits (vma-merge)
[325.066645] Starting subtest: vma-merge
[325.104672] Subtest vma-merge: SUCCESS (0.038s)
[325.267144] [086/131] (696s left) syncobj_timeline (etime-single-wait-all-submitted)
[325.327482] Starting subtest: etime-single-wait-all-submitted
[325.433607] Subtest etime-single-wait-all-submitted: SUCCESS (0.105s)
[325.533158] [087/131] (696s left) kms_feature_discovery (display)
[325.640099] Starting subtest: display
[325.642060] Subtest display: SUCCESS (0.000s)
[325.741066] [088/131] (695s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[325.844120] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip
[325.848314] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[325.982224] [089/131] (695s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[326.035312] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[326.037525] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.000s)
[326.172511] [090/131] (695s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-sf)
[331.174404] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-sf
[331.178767] Subtest fbc-pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.002s)
[332.041591] [091/131] (689s left) perf (invalid-remove-userspace-config)
[332.181802] Starting subtest: invalid-remove-userspace-config
[332.187308] Subtest invalid-remove-userspace-config: SUCCESS (0.007s)
[332.234883] [092/131] (689s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-upscaling)
[332.330772] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-upscaling
[332.332901] Starting dynamic subtest: pipe-A-default-mode
[332.638292] Dynamic subtest pipe-A-default-mode: SKIP (0.305s)
[332.642773] Subtest flip-64bpp-yftile-to-16bpp-yftile-upscaling: SKIP (0.307s)
[333.481691] [093/131] (688s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[333.612190] Starting subtest: cursorA-vs-flipA-toggle
[344.740440] Subtest cursorA-vs-flipA-toggle: SUCCESS (11.128s)
[345.613224] [094/131] (676s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc)
[345.716071] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc
[345.718418] Starting dynamic subtest: pipe-A-eDP-1
[345.742002] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[345.752842] Starting dynamic subtest: pipe-B-eDP-1
[345.775013] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[345.783556] Starting dynamic subtest: pipe-C-eDP-1
[345.805076] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[345.813620] Starting dynamic subtest: pipe-D-eDP-1
[345.835990] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[345.840312] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.006s)
[348.089807] [095/131] (673s left) kms_flip (dpms-vs-vblank-race-interruptible)
[348.199003] Starting subtest: dpms-vs-vblank-race-interruptible
[348.201195] Starting dynamic subtest: A-eDP1
[353.168093] Dynamic subtest A-eDP1: SUCCESS (4.965s)
[353.177430] Starting dynamic subtest: B-eDP1
[357.780640] Dynamic subtest B-eDP1: SUCCESS (4.611s)
[357.791364] Starting dynamic subtest: C-eDP1
[362.404089] Dynamic subtest C-eDP1: SUCCESS (4.623s)
[362.414957] Starting dynamic subtest: D-eDP1
[367.020524] Dynamic subtest D-eDP1: SUCCESS (4.618s)
[367.025782] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (18.827s)
[367.928509] [096/131] (654s left) gem_exec_flush (basic-uc-rw-default)
[367.998219] Starting subtest: basic-uc-rw-default
[373.442535] Subtest basic-uc-rw-default: SUCCESS (5.446s)
[373.656783] [097/131] (648s left) gem_eio (reset-stress)
[373.899198] Starting subtest: reset-stress
[373.901195] Starting dynamic subtest: render
[379.164500] Dynamic subtest render: SUCCESS (5.265s)
[379.178438] Starting dynamic subtest: bsd1
[397.366565] Dynamic subtest bsd1: SUCCESS (18.205s)
[397.383137] Starting dynamic subtest: bsd2
[415.414880] Dynamic subtest bsd2: SUCCESS (18.051s)
[415.430907] Starting dynamic subtest: blt
[415.435198] Dynamic subtest blt: SKIP (0.000s)
[415.444429] Starting dynamic subtest: vebox
[433.381191] Dynamic subtest vebox: SUCCESS (17.969s)
[433.383199] Subtest reset-stress: SUCCESS (59.495s)
[434.790967] [098/131] (587s left) kms_content_protection (lic-type-0)
[434.935956] Starting subtest: lic-type-0
[434.940499] Subtest lic-type-0: SKIP (0.000s)
[435.108710] [099/131] (586s left) syncobj_timeline (invalid-signal-illegal-point)
[435.175970] Starting subtest: invalid-signal-illegal-point
[435.178052] Subtest invalid-signal-illegal-point: SUCCESS (0.000s)
[435.320983] [100/131] (586s left) kms_pipe_b_c_ivb (pipe-b-dpms-off-modeset-pipe-c)
[435.382522] Subtest pipe-B-dpms-off-modeset-pipe-C: SKIP (0.000s)
[435.450343] [101/131] (586s left) gem_exec_schedule (pi-common)
[435.631866] Starting subtest: pi-common
[435.634159] Starting dynamic subtest: rcs0
[435.655333] Dynamic subtest rcs0: SUCCESS (0.026s)
[435.667801] Starting dynamic subtest: bcs0
[435.684574] Dynamic subtest bcs0: SUCCESS (0.028s)
[435.696521] Starting dynamic subtest: vcs0
[435.712354] Dynamic subtest vcs0: SUCCESS (0.027s)
[435.726201] Starting dynamic subtest: vcs1
[435.738931] Dynamic subtest vcs1: SUCCESS (0.026s)
[435.752975] Starting dynamic subtest: vecs0
[435.764493] Dynamic subtest vecs0: SUCCESS (0.025s)
[435.778068] Starting dynamic subtest: ccs0
[435.792028] Dynamic subtest ccs0: SUCCESS (0.027s)
[435.794319] Subtest pi-common: SUCCESS (0.163s)
[436.049110] [102/131] (586s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs)
[436.146075] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs
[436.148343] Starting dynamic subtest: pipe-A-eDP-1
[436.204568] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[436.218666] Starting dynamic subtest: pipe-B-eDP-1
[436.276384] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[436.288528] Starting dynamic subtest: pipe-C-eDP-1
[436.343885] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[436.354926] Starting dynamic subtest: pipe-D-eDP-1
[436.411616] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[436.415854] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.008s)
[438.366183] [103/131] (583s left) kms_vblank (wait-forked-hang)
[438.460129] Starting subtest: wait-forked-hang
[438.462030] Starting dynamic subtest: pipe-A-eDP-1
[464.612404] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.146s)
[464.627039] Starting dynamic subtest: pipe-D-eDP-1
[479.524659] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.906s)
[479.526884] Subtest wait-forked-hang: SUCCESS (41.057s)
[480.417194] [104/131] (541s left) gem_exec_whisper (basic-normal)
[480.489940] Starting subtest: basic-normal
[485.610690] Subtest basic-normal: SUCCESS (5.118s)
[485.817880] [105/131] (536s left) syncobj_wait (reset-signaled)
[485.872130] Starting subtest: reset-signaled
[485.874494] Subtest reset-signaled: SUCCESS (0.000s)
[485.992891] [106/131] (536s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-gtt)
[486.083142] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-gtt
[486.087537] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[486.201132] [107/131] (536s left) gem_render_copy (y-tiled-to-vebox-yf-tiled)
[486.259420] Starting subtest: y-tiled-to-vebox-yf-tiled
[486.264154] Subtest y-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[486.466860] [108/131] (536s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions-varying-size)
[486.587844] Starting subtest: short-flip-after-cursor-atomic-transitions-varying-size
[487.553342] Subtest short-flip-after-cursor-atomic-transitions-varying-size: SUCCESS (0.965s)
[488.447115] [109/131] (534s left) kms_chamelium_hpd (hdmi-hpd-for-each-pipe)
[488.836905] Subtest hdmi-hpd-for-each-pipe: SKIP (0.000s)
[489.635883] [110/131] (532s left) gem_cs_tlb (engines)
[489.699131] Starting subtest: engines
[489.701552] Starting dynamic subtest: rcs0
[491.855901] Dynamic subtest rcs0: SUCCESS (2.153s)
[491.865674] Starting dynamic subtest: bcs0
[494.008730] Dynamic subtest bcs0: SUCCESS (2.151s)
[494.020643] Starting dynamic subtest: vcs0
[496.162894] Dynamic subtest vcs0: SUCCESS (2.152s)
[496.175679] Starting dynamic subtest: vcs1
[498.315859] Dynamic subtest vcs1: SUCCESS (2.153s)
[498.327957] Starting dynamic subtest: vecs0
[500.470491] Dynamic subtest vecs0: SUCCESS (2.153s)
[500.482782] Starting dynamic subtest: ccs0
[502.625708] Dynamic subtest ccs0: SUCCESS (2.155s)
[502.628384] Subtest engines: SUCCESS (12.923s)
[502.793175] [111/131] (519s left) gem_eio (in-flight-internal-1us)
[503.032550] Starting subtest: in-flight-internal-1us
[504.891381] Subtest in-flight-internal-1us: SUCCESS (1.857s)
[505.081923] [112/131] (517s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move)
[505.175425] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move
[505.179703] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[505.311645] [113/131] (517s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[505.418315] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt
[505.422530] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[505.551359] [114/131] (517s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[505.650021] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[505.654265] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[505.780664] [115/131] (516s left) api_intel_allocator (alloc-simple)
[505.844220] Starting subtest: alloc-simple
[505.846246] Subtest alloc-simple: SUCCESS (0.003s)
[505.996881] [116/131] (516s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs)
[506.102207] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs
[506.103996] Starting dynamic subtest: pipe-A-eDP-1
[506.124352] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[506.135881] Starting dynamic subtest: pipe-B-eDP-1
[506.154288] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[506.163854] Starting dynamic subtest: pipe-C-eDP-1
[506.183581] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[506.192952] Starting dynamic subtest: pipe-D-eDP-1
[506.211799] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[506.215174] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[508.451702] [117/131] (514s left) gem_exec_fence (invalid-fence-array)
[508.933653] Starting subtest: invalid-fence-array
[508.936188] Subtest invalid-fence-array: SUCCESS (0.002s)
[509.930612] [118/131] (512s left) kms_frontbuffer_tracking (fbc-tiling-y)
[510.038392] Starting subtest: fbc-tiling-y
[510.042780] Subtest fbc-tiling-y: SKIP (0.000s)
[510.160941] [119/131] (512s left) gem_exec_reloc (basic-wc-cpu-active)
[510.223551] Subtest basic-wc-cpu-active: SKIP (0.000s)
[510.295171] [120/131] (512s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-sf)
[515.285061] Starting subtest: psr2-overlay-plane-move-continuous-exceed-sf
[515.287428] Starting dynamic subtest: pipe-A-eDP-1
[527.310434] Dynamic subtest pipe-A-eDP-1: SUCCESS (12.026s)
[527.322383] Starting dynamic subtest: pipe-B-eDP-1
[539.362131] Dynamic subtest pipe-B-eDP-1: SUCCESS (12.048s)
[539.364420] Subtest psr2-overlay-plane-move-continuous-exceed-sf: SUCCESS (24.078s)
[540.224697] [121/131] (482s left) perf_pmu (render-node-busy)
[540.319194] Starting subtest: render-node-busy
[540.321719] Starting dynamic subtest: rcs0
[540.932780] Dynamic subtest rcs0: SUCCESS (0.616s)
[540.946030] Starting dynamic subtest: bcs0
[541.498601] Dynamic subtest bcs0: SUCCESS (0.564s)
[541.511953] Starting dynamic subtest: vcs0
[542.820234] Dynamic subtest vcs0: SUCCESS (1.318s)
[542.833559] Starting dynamic subtest: vcs1
[544.807099] Dynamic subtest vcs1: SUCCESS (1.983s)
[544.819826] Starting dynamic subtest: vecs0
[546.788804] Dynamic subtest vecs0: SUCCESS (1.979s)
[546.801580] Starting dynamic subtest: ccs0
[547.355650] Dynamic subtest ccs0: SUCCESS (0.565s)
[547.358549] Subtest render-node-busy: SUCCESS (7.041s)
[547.457283] [122/131] (475s left) gem_exec_reloc (basic-active)
[547.524600] Subtest basic-active: SKIP (0.000s)
[547.615960] [123/131] (475s left) gem_lmem_swapping (parallel-random-engines)
[547.662815] Subtest parallel-random-engines: SKIP (0.000s)
[547.707420] [124/131] (475s left) gem_lmem_swapping (parallel-random)
[547.753195] Subtest parallel-random: SKIP (0.000s)
[547.802023] [125/131] (475s left) i915_fb_tiling (basic-x-tiling)
[547.859937] Subtest basic-x-tiling: SKIP (0.000s)
[547.930326] [126/131] (475s left) gem_eio (context-create)
[548.144709] Starting subtest: context-create
[548.447553] Subtest context-create: SUCCESS (0.303s)
[548.618740] [127/131] (474s left) gem_mmap_offset (bad-object)
[548.683636] Starting subtest: bad-object
[548.685305] Subtest bad-object: SUCCESS (0.001s)
[548.814989] [128/131] (474s left) kms_scaling_modes (scaling-mode-full-aspect)
[548.900117] Starting subtest: scaling-mode-full-aspect
[548.901798] Starting dynamic subtest: pipe-A-eDP-1
[548.994471] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.096s)
[549.004879] Starting dynamic subtest: pipe-B-eDP-1
[550.133303] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.137s)
[550.143538] Starting dynamic subtest: pipe-C-eDP-1
[551.249247] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.114s)
[551.259821] Starting dynamic subtest: pipe-D-eDP-1
[552.385969] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.135s)
[552.388374] Subtest scaling-mode-full-aspect: SUCCESS (3.488s)
[553.576943] [129/131] (469s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc)
[553.682384] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc
[560.617152] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (6.938s)
[560.786678] [130/131] (462s left) i915_suspend (forcewake)
[560.851869] Starting subtest: forcewake
[592.893817] Subtest forcewake: SUCCESS (2.210s)
[592.998550] [131/131] (430s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-blt)
[593.098894] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-blt
[597.468821] Subtest fbc-1p-primscrn-pri-indfb-draw-blt: SUCCESS (4.466s)
[598.661246] Closing watchdogs
results: parsing output: 0/ for test: kms_big_fb
results: parsing output: 1/ for test: kms_flip_scaled_crc
results: parsing output: 2/ for test: kms_cursor_edge_walk
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: kms_chamelium_edid
results: parsing output: 5/ for test: vgem_basic
results: parsing output: 6/ for test: kms_cursor_crc
results: parsing output: 7/ for test: kms_big_fb
results: parsing output: 8/ for test: kms_ccs
results: parsing output: 9/ for test: gem_ctx_persistence
results: parsing output: 10/ for test: gem_exec_reloc
results: parsing output: 11/ for test: syncobj_timeline
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: kms_lease
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_pm_lpsp
results: parsing output: 16/ for test: gen9_exec_parse
results: parsing output: 17/ for test: kms_cursor_legacy
results: parsing output: 18/ for test: gem_mmap_wc
results: parsing output: 19/ for test: gem_ctx_isolation
results: parsing output: 20/ for test: gem_bad_reloc
results: parsing output: 21/ for test: syncobj_wait
results: parsing output: 22/ for test: gem_mmap_gtt
results: parsing output: 23/ for test: kms_big_fb
results: parsing output: 24/ for test: kms_feature_discovery
results: parsing output: 25/ for test: gem_exec_reloc
results: parsing output: 26/ for test: gen9_exec_parse
results: parsing output: 27/ for test: kms_flip
results: parsing output: 28/ for test: kms_invalid_mode
results: parsing output: 29/ for test: syncobj_eventfd
results: parsing output: 30/ for test: gem_exec_schedule
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_psr
results: parsing output: 33/ for test: gem_ccs
results: parsing output: 34/ for test: kms_plane_scaling
results: parsing output: 35/ for test: kms_big_fb
results: parsing output: 36/ for test: kms_addfb_basic
results: parsing output: 37/ for test: gem_workarounds
results: parsing output: 38/ for test: kms_flip
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: gem_mmap_gtt
results: parsing output: 41/ for test: prime_vgem
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: kms_flip
results: parsing output: 44/ for test: perf_pmu
results: parsing output: 45/ for test: kms_rotation_crc
results: parsing output: 46/ for test: dmabuf_sync_file
results: parsing output: 47/ for test: kms_dirtyfb
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_addfb_basic
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: kms_ccs
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_psr
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_busy
results: parsing output: 56/ for test: syncobj_wait
results: parsing output: 57/ for test: gem_userptr_blits
results: parsing output: 58/ for test: kms_cursor_crc
results: parsing output: 59/ for test: kms_big_fb
results: parsing output: 60/ for test: kms_cursor_legacy
results: parsing output: 61/ for test: gem_exec_basic
results: parsing output: 62/ for test: kms_psr
results: parsing output: 63/ for test: gem_spin_batch
results: parsing output: 64/ for test: kms_cursor_legacy
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_plane_scaling
results: parsing output: 67/ for test: kms_atomic
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: prime_vgem
results: parsing output: 70/ for test: gem_exec_balancer
results: parsing output: 71/ for test: gem_render_copy
results: parsing output: 72/ for test: kms_cursor_legacy
results: parsing output: 73/ for test: gem_exec_reloc
results: parsing output: 74/ for test: i915_pm_rps
results: parsing output: 75/ for test: api_intel_bb
results: parsing output: 76/ for test: gem_tiled_pread_pwrite
results: parsing output: 77/ for test: kms_plane_alpha_blend
results: parsing output: 78/ for test: kms_prop_blob
results: parsing output: 79/ for test: gem_exec_reloc
results: parsing output: 80/ for test: gem_shrink
results: parsing output: 81/ for test: gem_gtt_cpu_tlb
results: parsing output: 82/ for test: kms_vblank
results: parsing output: 83/ for test: kms_plane_multiple
results: parsing output: 84/ for test: gem_userptr_blits
results: parsing output: 85/ for test: syncobj_timeline
results: parsing output: 86/ for test: kms_feature_discovery
results: parsing output: 87/ for test: kms_big_fb
results: parsing output: 88/ for test: syncobj_timeline
results: parsing output: 89/ for test: kms_psr2_sf
results: parsing output: 90/ for test: perf
results: parsing output: 91/ for test: kms_flip_scaled_crc
results: parsing output: 92/ for test: kms_cursor_legacy
results: parsing output: 93/ for test: kms_ccs
results: parsing output: 94/ for test: kms_flip
results: parsing output: 95/ for test: gem_exec_flush
results: parsing output: 96/ for test: gem_eio
results: parsing output: 97/ for test: kms_content_protection
results: parsing output: 98/ for test: syncobj_timeline
results: parsing output: 99/ for test: kms_pipe_b_c_ivb
results: parsing output: 100/ for test: gem_exec_schedule
results: parsing output: 101/ for test: kms_ccs
results: parsing output: 102/ for test: kms_vblank
results: parsing output: 103/ for test: gem_exec_whisper
results: parsing output: 104/ for test: syncobj_wait
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: gem_render_copy
results: parsing output: 107/ for test: kms_cursor_legacy
results: parsing output: 108/ for test: kms_chamelium_hpd
results: parsing output: 109/ for test: gem_cs_tlb
results: parsing output: 110/ for test: gem_eio
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: api_intel_allocator
results: parsing output: 115/ for test: kms_ccs
results: parsing output: 116/ for test: gem_exec_fence
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: gem_exec_reloc
results: parsing output: 119/ for test: kms_psr2_sf
results: parsing output: 120/ for test: perf_pmu
results: parsing output: 121/ for test: gem_exec_reloc
results: parsing output: 122/ for test: gem_lmem_swapping
results: parsing output: 123/ for test: gem_lmem_swapping
results: parsing output: 124/ for test: i915_fb_tiling
results: parsing output: 125/ for test: gem_eio
results: parsing output: 126/ for test: gem_mmap_offset
results: parsing output: 127/ for test: kms_scaling_modes
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: i915_suspend
results: parsing output: 130/ for test: kms_frontbuffer_tracking
Done.