[59.375910] Initializing watchdogs
[59.375959]   /dev/watchdog0
[59.390922] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[59.395771] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.398077] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.400002] [001/133] (960s left) gem_ctx_bad_destroy (double-destroy)
[59.452178] Starting subtest: double-destroy
[59.452935] Subtest double-destroy: SUCCESS (0.000s)
[59.531809] [002/133] (960s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-mc-ccs)
[59.617662] Starting subtest: crc-primary-suspend-4-tiled-mtl-mc-ccs
[59.618469] Starting dynamic subtest: pipe-A-eDP-1
[92.843660] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.834s)
[92.851054] Starting dynamic subtest: pipe-B-eDP-1
[127.672229] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.750s)
[127.679771] Starting dynamic subtest: pipe-C-eDP-1
[162.749315] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.488s)
[162.757682] Starting dynamic subtest: pipe-D-eDP-1
[197.751472] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.432s)
[197.752405] Subtest crc-primary-suspend-4-tiled-mtl-mc-ccs: SUCCESS (18.507s)
[204.989759] [003/133] (820s left) syncobj_wait (wait-all-complex)
[205.045033] Starting subtest: wait-all-complex
[205.270820] Subtest wait-all-complex: SUCCESS (0.212s)
[205.349024] [004/133] (820s left) kms_addfb_basic (invalid-get-prop)
[205.411821] Starting subtest: invalid-get-prop
[205.412830] Subtest invalid-get-prop: SUCCESS (0.000s)
[205.554928] [005/133] (820s left) syncobj_wait (reset-multiple-signaled)
[205.610575] Starting subtest: reset-multiple-signaled
[205.611504] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[205.725753] [006/133] (820s left) kms_chamelium_hpd (dp-hpd-with-enabled-mode)
[206.112127] Subtest dp-hpd-with-enabled-mode: SKIP (0.000s)
[206.917488] [007/133] (819s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers)
[207.013686] Starting subtest: plane-downscale-factor-0-5-with-modifiers
[207.014617] Starting dynamic subtest: pipe-A
[207.032220] Dynamic subtest pipe-A: SKIP (0.017s)
[207.039210] Starting dynamic subtest: pipe-B
[207.062164] Dynamic subtest pipe-B: SKIP (0.030s)
[207.068722] Starting dynamic subtest: pipe-C
[207.092684] Dynamic subtest pipe-C: SKIP (0.030s)
[207.099156] Starting dynamic subtest: pipe-D
[207.123796] Dynamic subtest pipe-D: SKIP (0.030s)
[207.125611] Subtest plane-downscale-factor-0-5-with-modifiers: SKIP (0.107s)
[207.213507] [008/133] (818s left) kms_cursor_crc (cursor-sliding-32x32)
[207.356243] Starting subtest: cursor-sliding-32x32
[207.402052] Subtest cursor-sliding-32x32: SKIP (0.043s)
[207.679617] [009/133] (818s left) gem_exec_parallel (engines)
[207.734831] Starting subtest: engines
[207.735818] Starting dynamic subtest: basic
[209.473778] Dynamic subtest basic: SUCCESS (1.705s)
[209.483302] Starting dynamic subtest: contexts
[213.861987] Dynamic subtest contexts: SUCCESS (4.343s)
[213.872147] Starting dynamic subtest: fds
[217.620625] Dynamic subtest fds: SUCCESS (3.735s)
[217.627492] Starting dynamic subtest: userptr
[219.459627] Dynamic subtest userptr: SUCCESS (1.831s)
[219.460998] Subtest engines: SUCCESS (11.621s)
[219.651501] [010/133] (806s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0)
[219.757095] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0
[219.759167] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[219.858270] [011/133] (806s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area)
[219.943707] Starting subtest: fbc-psr2-overlay-plane-update-sf-dmg-area
[219.944647] Starting dynamic subtest: pipe-A-eDP-1
[220.044700] Dynamic subtest pipe-A-eDP-1: SKIP (0.101s)
[220.053953] Starting dynamic subtest: pipe-B-eDP-1
[221.244278] Dynamic subtest pipe-B-eDP-1: SKIP (1.193s)
[221.246192] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (1.297s)
[222.419914] [012/133] (803s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[222.514302] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu
[222.516382] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[222.602568] [013/133] (803s left) kms_flip (2x-wf_vblank-ts-check)
[222.686106] Starting subtest: 2x-wf_vblank-ts-check
[222.696762] Subtest 2x-wf_vblank-ts-check: SKIP (0.011s)
[222.777177] [014/133] (803s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[222.866495] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[222.868420] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[222.964000] [015/133] (803s left) gen7_exec_parse (basic-allowed)
[223.023027] Subtest basic-allowed: SKIP (0.000s)
[223.070802] [016/133] (803s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-pwrite)
[223.166052] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-pwrite
[228.589971] Subtest fbc-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (5.414s)
[229.750740] [017/133] (796s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen)
[229.840016] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen
[229.841900] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[229.936119] [018/133] (796s left) perf_pmu (busy-start)
[229.972587] Starting subtest: busy-start
[229.973476] Starting dynamic subtest: rcs0
[232.526042] Dynamic subtest rcs0: SUCCESS (2.550s)
[232.536354] Starting dynamic subtest: bcs0
[235.087919] Dynamic subtest bcs0: SUCCESS (2.546s)
[235.097798] Starting dynamic subtest: vcs0
[238.530756] Dynamic subtest vcs0: SUCCESS (3.442s)
[238.541038] Starting dynamic subtest: vcs1
[242.498233] Dynamic subtest vcs1: SUCCESS (3.964s)
[242.508601] Starting dynamic subtest: vecs0
[246.530757] Dynamic subtest vecs0: SUCCESS (4.028s)
[246.541262] Starting dynamic subtest: ccs0
[249.083030] Dynamic subtest ccs0: SUCCESS (2.547s)
[249.084191] Subtest busy-start: SUCCESS (19.086s)
[249.164435] [019/133] (777s left) gem_mmap_wc (write-read-distinct)
[249.211248] Subtest write-read-distinct: SKIP (0.000s)
[249.263750] [020/133] (777s left) sriov_basic (enable-vfs-autoprobe-on)
[249.317359] Starting subtest: enable-vfs-autoprobe-on
[249.318359] Starting dynamic subtest: numvfs-1
[249.346336] Dynamic subtest numvfs-1: FAIL (0.009s)
[249.354196] Starting dynamic subtest: numvfs-2
[249.381128] Dynamic subtest numvfs-2: FAIL (0.004s)
[249.388844] Starting dynamic subtest: numvfs-3
[249.416366] Dynamic subtest numvfs-3: FAIL (0.004s)
[249.423563] Starting dynamic subtest: numvfs-4
[249.451558] Dynamic subtest numvfs-4: FAIL (0.004s)
[249.459141] Starting dynamic subtest: numvfs-5
[249.485578] Dynamic subtest numvfs-5: FAIL (0.004s)
[249.492492] Starting dynamic subtest: numvfs-6
[249.518233] Dynamic subtest numvfs-6: FAIL (0.004s)
[249.525046] Starting dynamic subtest: numvfs-7
[249.550843] Dynamic subtest numvfs-7: FAIL (0.004s)
[249.557756] Starting dynamic subtest: numvfs-random
[249.582698] Dynamic subtest numvfs-random: FAIL (0.004s)
[249.589524] Starting dynamic subtest: numvfs-all
[249.615059] Dynamic subtest numvfs-all: FAIL (0.004s)
[249.615894] Subtest enable-vfs-autoprobe-on: FAIL (0.043s)
[249.643395] [021/133] (776s left) kms_addfb_basic (master-rmfb)
[249.700264] Starting subtest: master-rmfb
[249.701610] Subtest master-rmfb: SUCCESS (0.001s)
[249.836170] [022/133] (776s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[249.951666] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[249.953542] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[250.041664] [023/133] (776s left) gem_ctx_persistence (engines-cleanup)
[250.089540] Starting subtest: engines-cleanup
[250.090575] Starting dynamic subtest: rcs0
[250.167816] Dynamic subtest rcs0: SUCCESS (0.078s)
[250.179194] Starting dynamic subtest: bcs0
[250.207471] Dynamic subtest bcs0: SUCCESS (0.039s)
[250.217526] Starting dynamic subtest: vcs0
[250.250479] Dynamic subtest vcs0: SUCCESS (0.042s)
[250.260028] Starting dynamic subtest: vcs1
[250.301667] Dynamic subtest vcs1: SUCCESS (0.050s)
[250.311049] Starting dynamic subtest: vecs0
[250.356803] Dynamic subtest vecs0: SUCCESS (0.054s)
[250.365818] Starting dynamic subtest: ccs0
[250.407977] Dynamic subtest ccs0: SUCCESS (0.050s)
[250.409522] Subtest engines-cleanup: SUCCESS (0.318s)
[250.480794] [024/133] (776s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-75)
[250.574354] Starting subtest: planes-unity-scaling-downscale-factor-0-75
[250.575226] Starting dynamic subtest: pipe-A
[250.640614] Dynamic subtest pipe-A: SUCCESS (0.066s)
[250.650755] Starting dynamic subtest: pipe-B
[251.788869] Dynamic subtest pipe-B: SUCCESS (1.147s)
[251.798586] Starting dynamic subtest: pipe-C
[252.897379] Dynamic subtest pipe-C: SUCCESS (1.107s)
[252.904998] Starting dynamic subtest: pipe-D
[254.038401] Dynamic subtest pipe-D: SUCCESS (1.140s)
[254.039303] Subtest planes-unity-scaling-downscale-factor-0-75: SUCCESS (3.463s)
[255.202624] [025/133] (771s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-submi
[255.259159] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-submitted
[255.365683] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-submitted: SUCCESS (0.107s)
[255.440823] [026/133] (771s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-gtt)
[255.530937] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-gtt
[255.532625] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[255.634049] [027/133] (771s left) kms_cursor_crc (cursor-offscreen-512x512)
[255.898044] Starting subtest: cursor-offscreen-512x512
[255.900134] Subtest cursor-offscreen-512x512: SKIP (0.001s)
[256.063912] [028/133] (770s left) syncobj_basic (bad-pad-handle-to-fd)
[256.128601] Starting subtest: bad-pad-handle-to-fd
[256.129504] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s)
[256.232352] [029/133] (770s left) gem_fence_thrash (bo-write-verify-threaded-y)
[256.266826] Starting subtest: bo-write-verify-threaded-y
[256.291643] Subtest bo-write-verify-threaded-y: SKIP (0.023s)
[256.352304] [030/133] (770s left) kms_color_pipeline (plane-lut1d-pre-ctm3x4)
[256.437715] Starting subtest: plane-lut1d-pre-ctm3x4
[256.554605] Starting dynamic subtest: pipe-A-plane-0
[256.732307] Dynamic subtest pipe-A-plane-0: SUCCESS (0.178s)
[256.740587] Starting dynamic subtest: pipe-A-plane-1
[256.899095] Dynamic subtest pipe-A-plane-1: SUCCESS (0.166s)
[256.907422] Starting dynamic subtest: pipe-A-plane-2
[257.065854] Dynamic subtest pipe-A-plane-2: SUCCESS (0.166s)
[258.318715] Starting dynamic subtest: pipe-B-plane-0
[258.478568] Dynamic subtest pipe-B-plane-0: SUCCESS (0.167s)
[258.489751] Starting dynamic subtest: pipe-B-plane-1
[258.656636] Dynamic subtest pipe-B-plane-1: SUCCESS (0.175s)
[258.666265] Starting dynamic subtest: pipe-B-plane-2
[258.822728] Dynamic subtest pipe-B-plane-2: SUCCESS (0.166s)
[260.017620] Starting dynamic subtest: pipe-C-plane-0
[260.177154] Dynamic subtest pipe-C-plane-0: SUCCESS (0.166s)
[260.185461] Starting dynamic subtest: pipe-C-plane-1
[260.321972] Dynamic subtest pipe-C-plane-1: SUCCESS (0.144s)
[260.330825] Starting dynamic subtest: pipe-C-plane-2
[260.466366] Dynamic subtest pipe-C-plane-2: SUCCESS (0.144s)
[261.676000] Starting dynamic subtest: pipe-D-plane-0
[261.836140] Dynamic subtest pipe-D-plane-0: SUCCESS (0.166s)
[261.845480] Starting dynamic subtest: pipe-D-plane-1
[262.025640] Dynamic subtest pipe-D-plane-1: SUCCESS (0.187s)
[262.037513] Starting dynamic subtest: pipe-D-plane-2
[262.191896] Dynamic subtest pipe-D-plane-2: SUCCESS (0.165s)
[262.491056] Subtest plane-lut1d-pre-ctm3x4: SUCCESS (6.059s)
[263.337495] [031/133] (763s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions-varying-size)
[263.449481] Starting subtest: cursorB-vs-flipA-atomic-transitions-varying-size
[263.451759] Subtest cursorB-vs-flipA-atomic-transitions-varying-size: SKIP (0.001s)
[263.589383] [032/133] (763s left) kms_big_fb (4-tiled-64bpp-rotate-0)
[263.686654] Starting subtest: 4-tiled-64bpp-rotate-0
[265.233822] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.546s)
[265.406450] [033/133] (761s left) kms_sequence (get-forked-busy)
[265.486658] Starting subtest: get-forked-busy
[265.487590] Starting dynamic subtest: pipe-A-eDP-1
[267.430587] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.943s)
[267.438799] Starting dynamic subtest: pipe-B-eDP-1
[270.024523] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.591s)
[270.032088] Starting dynamic subtest: pipe-C-eDP-1
[272.636378] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.610s)
[272.643925] Starting dynamic subtest: pipe-D-eDP-1
[275.177330] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.538s)
[275.178185] Subtest get-forked-busy: SUCCESS (9.687s)
[276.047107] [034/133] (750s left) kms_invalid_mode (clock-too-high)
[276.135756] Starting subtest: clock-too-high
[276.136644] Starting dynamic subtest: pipe-A-eDP-1
[276.138292] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[276.149773] Starting dynamic subtest: pipe-B-eDP-1
[276.151577] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[276.162363] Starting dynamic subtest: pipe-C-eDP-1
[276.164664] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[276.173018] Starting dynamic subtest: pipe-D-eDP-1
[276.174731] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[276.176569] Subtest clock-too-high: SKIP (0.004s)
[276.214185] [035/133] (750s left) kms_dsc (dsc-with-output-formats)
[276.313745] Starting subtest: dsc-with-output-formats
[276.322276] Subtest dsc-with-output-formats: SKIP (0.000s)
[276.380610] [036/133] (750s left) gem_mmap (big-bo)
[276.432923] Subtest big-bo: SKIP (0.000s)
[276.487884] [037/133] (750s left) kms_flip (2x-flip-vs-rmfb-interruptible)
[276.579778] Starting subtest: 2x-flip-vs-rmfb-interruptible
[276.591898] Subtest 2x-flip-vs-rmfb-interruptible: SKIP (0.011s)
[276.661427] [038/133] (750s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf)
[276.745719] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf
[276.746682] Starting dynamic subtest: pipe-A-eDP-1
[276.824686] Dynamic subtest pipe-A-eDP-1: SKIP (0.078s)
[276.834788] Starting dynamic subtest: pipe-B-eDP-1
[277.927530] Dynamic subtest pipe-B-eDP-1: SKIP (1.100s)
[277.929352] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (1.181s)
[279.110044] [039/133] (748s left) gem_mmap_offset (pf-nonblock)
[279.158408] Starting subtest: pf-nonblock
[279.164502] Subtest pf-nonblock: SUCCESS (0.006s)
[279.276368] [040/133] (747s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[279.365932] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[283.418215] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (4.059s)
[284.558637] [041/133] (742s left) kms_hdr (bpc-switch-suspend)
[284.637587] Starting subtest: bpc-switch-suspend
[285.700994] Starting dynamic subtest: pipe-A-eDP-1
[305.714179] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.991s)
[305.715232] Subtest bpc-switch-suspend: SUCCESS (6.055s)
[311.875141] [042/133] (721s left) kms_psr (psr2-primary-page-flip)
[311.970422] Starting subtest: psr2-primary-page-flip
[311.971333] Starting dynamic subtest: eDP-1
[313.705505] Dynamic subtest eDP-1: SUCCESS (1.698s)
[313.706389] Subtest psr2-primary-page-flip: SUCCESS (1.699s)
[314.600817] [043/133] (718s left) gem_exec_schedule (promotion)
[314.668730] Starting subtest: promotion
[314.669791] Starting dynamic subtest: rcs0
[314.781724] Dynamic subtest rcs0: SUCCESS (0.110s)
[314.792426] Starting dynamic subtest: vcs0
[314.867323] Dynamic subtest vcs0: SUCCESS (0.083s)
[314.878025] Starting dynamic subtest: vcs1
[314.949794] Dynamic subtest vcs1: SUCCESS (0.081s)
[314.960251] Starting dynamic subtest: vecs0
[315.036846] Dynamic subtest vecs0: SUCCESS (0.085s)
[315.049607] Starting dynamic subtest: ccs0
[315.125807] Dynamic subtest ccs0: SUCCESS (0.085s)
[315.127322] Subtest promotion: SUCCESS (0.450s)
[316.609823] [044/133] (716s left) kms_psr (psr2-cursor-blt)
[316.693764] Starting subtest: psr2-cursor-blt
[316.694816] Starting dynamic subtest: eDP-1
[318.429671] Dynamic subtest eDP-1: SUCCESS (1.715s)
[318.430560] Subtest psr2-cursor-blt: SUCCESS (1.716s)
[319.228141] [045/133] (714s left) kms_setmode (invalid-clone-exclusive-crtc)
[319.284363] Starting subtest: invalid-clone-exclusive-crtc
[319.287392] Subtest invalid-clone-exclusive-crtc: SKIP (0.000s)
[319.371401] [046/133] (714s left) kms_rotation_crc (sprite-rotation-90)
[319.455633] Starting subtest: sprite-rotation-90
[319.457420] Subtest sprite-rotation-90: SKIP (0.001s)
[319.539982] [047/133] (713s left) i915_pm_rps (thresholds-idle-park)
[319.595064] Starting subtest: thresholds-idle-park
[319.597313] Subtest thresholds-idle-park: SKIP (0.000s)
[319.705784] [048/133] (713s left) sysfs_timeslice_duration (invalid)
[319.760827] Starting subtest: invalid
[319.761790] Starting dynamic subtest: vecs0
[319.762748] Dynamic subtest vecs0: SUCCESS (0.000s)
[319.771369] Starting dynamic subtest: ccs0
[319.772177] Dynamic subtest ccs0: SUCCESS (0.000s)
[319.779416] Starting dynamic subtest: vcs0
[319.780241] Dynamic subtest vcs0: SUCCESS (0.000s)
[319.787488] Starting dynamic subtest: bcs0
[319.788313] Dynamic subtest bcs0: SUCCESS (0.000s)
[319.795848] Starting dynamic subtest: rcs0
[319.796717] Dynamic subtest rcs0: SUCCESS (0.000s)
[319.804030] Starting dynamic subtest: vcs1
[319.805067] Dynamic subtest vcs1: SUCCESS (0.000s)
[319.805975] Subtest invalid: SUCCESS (0.006s)
[319.836750] [049/133] (713s left) kms_plane (pixel-format-y-tiled-ccs-modifier)
[319.932374] Starting subtest: pixel-format-y-tiled-ccs-modifier
[319.934123] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s)
[320.013758] [050/133] (713s left) kms_plane_multiple (tiling-none)
[320.094659] Starting subtest: tiling-none
[320.095598] Starting dynamic subtest: pipe-A-eDP-1
[323.870622] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.750s)
[323.879184] Starting dynamic subtest: pipe-B-eDP-1
[328.297293] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.408s)
[328.307842] Starting dynamic subtest: pipe-C-eDP-1
[332.614724] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.305s)
[332.622347] Starting dynamic subtest: pipe-D-eDP-1
[336.950666] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.328s)
[336.953155] Subtest tiling-none: SUCCESS (16.797s)
[337.774288] [051/133] (695s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[337.880052] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip
[338.883516] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.002s)
[339.000853] [052/133] (694s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-render)
[339.104039] Starting subtest: psr-1p-primscrn-pri-indfb-draw-render
[346.392771] Subtest psr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.286s)
[346.524136] [053/133] (687s left) kms_vblank (wait-forked-busy-hang)
[346.624431] Starting subtest: wait-forked-busy-hang
[346.627434] Starting dynamic subtest: pipe-A-eDP-1
[373.362944] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.731s)
[373.372275] Starting dynamic subtest: pipe-D-eDP-1
[398.240088] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.870s)
[398.241220] Subtest wait-forked-busy-hang: SUCCESS (51.608s)
[399.083131] [054/133] (634s left) kms_psr (psr-primary-mmap-cpu)
[399.177538] Starting subtest: psr-primary-mmap-cpu
[399.178423] Starting dynamic subtest: eDP-1
[400.874923] Dynamic subtest eDP-1: SUCCESS (1.696s)
[400.875824] Subtest psr-primary-mmap-cpu: SUCCESS (1.697s)
[401.748500] [055/133] (632s left) syncobj_timeline (etime-multi-wait-for-submit-submitted)
[401.792130] Starting subtest: etime-multi-wait-for-submit-submitted
[401.897753] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.104s)
[401.966084] [056/133] (631s left) vgem_basic (dmabuf-fence)
[402.092627] Starting subtest: dmabuf-fence
[402.094771] Subtest dmabuf-fence: SUCCESS (0.001s)
[402.157358] [FACT vgem_basic (dmabuf-fence)] new: kernel.kmod_is_loaded.vgem: true
[402.160217] [057/133] (631s left) api_intel_bb (intel-bb-blit-none)
[402.209913] Starting subtest: intel-bb-blit-none
[406.184689] Subtest intel-bb-blit-none: SUCCESS (3.964s)
[406.279725] [058/133] (627s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt)
[406.370077] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt
[413.822471] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.451s)
[413.963522] [059/133] (619s left) syncobj_timeline (multi-wait-for-submit-available-submitted)
[414.014893] Starting subtest: multi-wait-for-submit-available-submitted
[414.015673] Subtest multi-wait-for-submit-available-submitted: SUCCESS (0.001s)
[414.101422] [060/133] (619s left) gem_exec_capture (pi)
[414.161493] Starting subtest: pi
[414.162280] Starting dynamic subtest: rcs0
[418.620614] Dynamic subtest rcs0: SUCCESS (4.458s)
[418.629492] Starting dynamic subtest: bcs0
[422.728535] Dynamic subtest bcs0: SUCCESS (4.106s)
[422.738934] Starting dynamic subtest: vcs0
[426.827511] Dynamic subtest vcs0: SUCCESS (4.095s)
[426.839658] Starting dynamic subtest: vcs1
[430.930654] Dynamic subtest vcs1: SUCCESS (4.100s)
[430.945056] Starting dynamic subtest: vecs0
[435.078789] Dynamic subtest vecs0: SUCCESS (4.144s)
[435.090118] Starting dynamic subtest: ccs0
[439.254775] Dynamic subtest ccs0: SUCCESS (4.173s)
[439.256065] Subtest pi: SUCCESS (25.087s)
[439.333487] [061/133] (594s left) kms_legacy_colorkey (basic)
[439.484683] Starting subtest: basic
[439.485711] Starting dynamic subtest: pipe-A
[439.521573] Dynamic subtest pipe-A: SUCCESS (0.045s)
[439.533790] Starting dynamic subtest: pipe-B
[439.534779] Dynamic subtest pipe-B: SUCCESS (0.001s)
[439.542545] Starting dynamic subtest: pipe-C
[439.543489] Dynamic subtest pipe-C: SUCCESS (0.000s)
[439.551561] Starting dynamic subtest: pipe-D
[439.552482] Dynamic subtest pipe-D: SUCCESS (0.000s)
[439.553426] Subtest basic: SUCCESS (0.052s)
[439.585356] [062/133] (594s left) gem_exec_store (cachelines)
[439.639873] Starting subtest: cachelines
[439.640772] Starting dynamic subtest: rcs0
[439.703686] Dynamic subtest rcs0: SUCCESS (0.063s)
[439.715806] Starting dynamic subtest: bcs0
[439.760920] Dynamic subtest bcs0: SUCCESS (0.055s)
[439.772279] Starting dynamic subtest: vcs0
[439.823408] Dynamic subtest vcs0: SUCCESS (0.061s)
[439.835352] Starting dynamic subtest: vcs1
[439.882523] Dynamic subtest vcs1: SUCCESS (0.057s)
[439.893978] Starting dynamic subtest: vecs0
[439.948544] Dynamic subtest vecs0: SUCCESS (0.064s)
[439.959648] Starting dynamic subtest: ccs0
[440.004910] Dynamic subtest ccs0: SUCCESS (0.054s)
[440.006030] Subtest cachelines: SUCCESS (0.366s)
[440.184120] [063/133] (593s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[440.277790] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[447.785318] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.506s)
[447.914489] [064/133] (586s left) kms_chamelium_frames (hdmi-aspect-ratio)
[448.289468] Subtest hdmi-aspect-ratio: SKIP (0.000s)
[449.120644] [065/133] (584s left) gem_render_copy (y-tiled-ccs-to-y-tiled)
[449.175643] Starting subtest: y-tiled-ccs-to-y-tiled
[449.177503] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s)
[449.348693] [066/133] (584s left) gem_flink_race (flink_close)
[449.387286] Starting subtest: flink_close
[454.481025] Subtest flink_close: SUCCESS (5.091s)
[454.566925] [067/133] (579s left) kms_addfb_basic (addfb25-modifier-no-flag)
[454.665668] Starting subtest: addfb25-modifier-no-flag
[454.666493] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[454.783725] [068/133] (579s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[454.866937] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[454.867854] Starting dynamic subtest: pipe-A-eDP-1
[455.768898] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.899s)
[455.779604] Starting dynamic subtest: pipe-B-eDP-1
[457.379878] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.609s)
[457.388830] Starting dynamic subtest: pipe-C-eDP-1
[458.874706] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.493s)
[458.882973] Starting dynamic subtest: pipe-D-eDP-1
[460.409164] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.532s)
[460.410106] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.538s)
[461.596319] [069/133] (572s left) kms_psr (fbc-psr2-sprite-mmap-gtt)
[461.689526] Starting subtest: fbc-psr2-sprite-mmap-gtt
[461.690452] Starting dynamic subtest: eDP-1
[461.692065] Dynamic subtest eDP-1: SKIP (0.000s)
[461.693621] Subtest fbc-psr2-sprite-mmap-gtt: SKIP (0.001s)
[461.759235] [070/133] (572s left) kms_ccs (bad-aux-stride-y-tiled-ccs)
[461.839606] Starting subtest: bad-aux-stride-y-tiled-ccs
[461.840505] Starting dynamic subtest: pipe-A-eDP-1
[461.848927] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[461.857412] Starting dynamic subtest: pipe-B-eDP-1
[461.865622] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[461.874150] Starting dynamic subtest: pipe-C-eDP-1
[461.882235] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[461.890317] Starting dynamic subtest: pipe-D-eDP-1
[461.898132] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[461.899933] Subtest bad-aux-stride-y-tiled-ccs: SKIP (0.005s)
[464.152471] [071/133] (570s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[464.257072] Starting subtest: basic-busy-flip-before-cursor-atomic
[464.258863] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[464.396239] [072/133] (569s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-move)
[464.493475] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-move
[472.077210] Subtest fbcpsr-1p-primscrn-spr-indfb-move: SUCCESS (7.582s)
[472.207287] [073/133] (562s left) gem_exec_alignment (many)
[472.273934] Starting subtest: many
[496.673921] Subtest many: SUCCESS (24.345s)
[497.986176] [074/133] (536s left) perf_pmu (busy-accuracy-98)
[498.061602] Starting subtest: busy-accuracy-98
[498.062642] Starting dynamic subtest: rcs0
[501.115168] Dynamic subtest rcs0: SUCCESS (3.048s)
[501.129852] Starting dynamic subtest: bcs0
[504.165320] Dynamic subtest bcs0: SUCCESS (3.049s)
[504.174234] Starting dynamic subtest: vcs0
[507.210198] Dynamic subtest vcs0: SUCCESS (3.043s)
[507.220935] Starting dynamic subtest: vcs1
[510.252374] Dynamic subtest vcs1: SUCCESS (3.041s)
[510.260783] Starting dynamic subtest: vecs0
[513.294681] Dynamic subtest vecs0: SUCCESS (3.040s)
[513.303213] Starting dynamic subtest: ccs0
[516.345430] Dynamic subtest ccs0: SUCCESS (3.049s)
[516.346543] Subtest busy-accuracy-98: SUCCESS (18.285s)
[516.454520] [075/133] (518s left) gem_render_copy (yf-tiled-to-vebox-x-tiled)
[516.507315] Starting subtest: yf-tiled-to-vebox-x-tiled
[516.509040] Subtest yf-tiled-to-vebox-x-tiled: SKIP (0.000s)
[516.699378] [076/133] (517s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs)
[516.815597] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs
[516.816547] Starting dynamic subtest: pipe-A-eDP-1
[516.838657] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[516.851047] Starting dynamic subtest: pipe-B-eDP-1
[516.872586] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[516.880617] Starting dynamic subtest: pipe-C-eDP-1
[516.900815] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[516.909154] Starting dynamic subtest: pipe-D-eDP-1
[516.930832] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[516.932372] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.009s)
[518.983715] [077/133] (515s left) gem_exec_params (rel-constants-invalid)
[519.051736] Starting subtest: rel-constants-invalid
[519.053281] Subtest rel-constants-invalid: SUCCESS (0.000s)
[519.170731] [078/133] (515s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-render)
[519.258734] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-render
[519.260402] Subtest fbc-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[519.352936] [079/133] (515s left) api_intel_allocator (fork-simple-once)
[519.402748] Starting subtest: fork-simple-once
[519.416945] Subtest fork-simple-once: SUCCESS (0.016s)
[519.545070] [080/133] (515s left) dumb_buffer (invalid-bpp)
[519.600119] Starting subtest: invalid-bpp
[519.601099] Subtest invalid-bpp: SUCCESS (0.000s)
[519.687476] [081/133] (515s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[519.948283] Starting subtest: cursor-rapid-movement-256x256
[519.952938] Starting dynamic subtest: pipe-A-eDP-1
[520.521527] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.570s)
[520.551901] Starting dynamic subtest: pipe-D-eDP-1
[521.731023] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.187s)
[521.731919] Subtest cursor-rapid-movement-256x256: SUCCESS (1.783s)
[522.553902] [082/133] (512s left) kms_cursor_legacy (modeset-atomic-cursor-hotspot)
[522.671245] Starting subtest: modeset-atomic-cursor-hotspot
[522.672988] Subtest modeset-atomic-cursor-hotspot: SKIP (0.000s)
[522.810328] [083/133] (511s left) gem_busy (busy)
[522.863559] Starting subtest: busy
[522.864433] Starting dynamic subtest: all-engines
[522.917078] Dynamic subtest all-engines: SUCCESS (0.055s)
[522.929010] Starting dynamic subtest: rcs0
[524.466939] Dynamic subtest rcs0: SUCCESS (1.541s)
[524.477158] Starting dynamic subtest: bcs0
[524.500366] Dynamic subtest bcs0: SUCCESS (0.039s)
[524.509352] Starting dynamic subtest: vcs0
[524.539845] Dynamic subtest vcs0: SUCCESS (0.038s)
[524.549422] Starting dynamic subtest: vcs1
[526.514455] Dynamic subtest vcs1: SUCCESS (1.962s)
[526.526536] Starting dynamic subtest: vecs0
[528.499886] Dynamic subtest vecs0: SUCCESS (1.985s)
[528.510427] Starting dynamic subtest: ccs0
[530.546606] Dynamic subtest ccs0: SUCCESS (2.044s)
[530.547694] Subtest busy: SUCCESS (7.676s)
[530.896017] [084/133] (503s left) gem_exec_schedule (pi-shared-iova)
[531.080403] Starting subtest: pi-shared-iova
[531.081392] Starting dynamic subtest: rcs0
[531.218303] Dynamic subtest rcs0: SUCCESS (0.136s)
[531.229969] Starting dynamic subtest: vcs0
[531.300093] Dynamic subtest vcs0: SUCCESS (0.091s)
[531.311718] Starting dynamic subtest: vcs1
[531.385007] Dynamic subtest vcs1: SUCCESS (0.083s)
[531.397433] Starting dynamic subtest: vecs0
[531.471333] Dynamic subtest vecs0: SUCCESS (0.086s)
[531.485685] Starting dynamic subtest: ccs0
[531.570706] Dynamic subtest ccs0: SUCCESS (0.098s)
[531.572296] Subtest pi-shared-iova: SUCCESS (0.499s)
[532.617265] [085/133] (502s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[532.715700] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[533.341513] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.626s)
[533.497152] [086/133] (501s left) sw_sync (sync_busy_fork_unixsocket)
[533.528778] Starting subtest: sync_busy_fork_unixsocket
[533.537731] Subtest sync_busy_fork_unixsocket: SUCCESS (0.010s)
[533.599447] [087/133] (501s left) gem_userptr_blits (create-destroy-unsync)
[533.652461] Subtest create-destroy-unsync: SKIP (0.000s)
[533.772817] [088/133] (501s left) kms_flip (plain-flip-fb-recreate-interruptible)
[533.864232] Starting subtest: plain-flip-fb-recreate-interruptible
[533.865301] Starting dynamic subtest: A-eDP1
[542.753044] Dynamic subtest A-eDP1: SUCCESS (8.889s)
[542.764368] Starting dynamic subtest: B-eDP1
[551.582984] Dynamic subtest B-eDP1: SUCCESS (8.827s)
[551.596454] Starting dynamic subtest: C-eDP1
[560.393315] Dynamic subtest C-eDP1: SUCCESS (8.809s)
[560.402165] Starting dynamic subtest: D-eDP1
[569.229608] Dynamic subtest D-eDP1: SUCCESS (8.835s)
[569.235274] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (35.373s)
[570.413085] [089/133] (464s left) gem_exec_reloc (basic-write-cpu)
[570.469145] Subtest basic-write-cpu: SKIP (0.000s)
[570.541040] [090/133] (464s left) prime_mmap_coherency (write)
[570.592632] Starting subtest: write
[576.019593] Subtest write: SUCCESS (5.379s)
[576.115505] [091/133] (458s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[576.216101] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[576.217745] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[576.310766] [092/133] (458s left) gem_create (busy-create)
[576.367703] Starting subtest: busy-create
[576.368599] Starting dynamic subtest: smem0
[609.521832] Dynamic subtest smem0: SUCCESS (33.139s)
[609.523043] Subtest busy-create: SUCCESS (33.140s)
[609.725835] [093/133] (425s left) gem_lmem_swapping (verify-random-ccs)
[609.769253] Subtest verify-random-ccs: SKIP (0.000s)
[609.811006] [094/133] (425s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[609.864038] Starting subtest: invalid-multi-wait-unsubmitted
[609.865036] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[609.965839] [095/133] (425s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move)
[610.051918] Starting subtest: psr-2p-scndscrn-cur-indfb-move
[610.053801] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[610.152008] [096/133] (425s left) kms_chamelium_audio (dp-audio)
[610.526307] Subtest dp-audio: SKIP (0.000s)
[611.319672] [097/133] (423s left) kms_psr (fbc-psr2-primary-blt)
[611.422601] Starting subtest: fbc-psr2-primary-blt
[611.423436] Starting dynamic subtest: eDP-1
[611.425111] Dynamic subtest eDP-1: SKIP (0.000s)
[611.427021] Subtest fbc-psr2-primary-blt: SKIP (0.001s)
[611.487627] [098/133] (423s left) gem_render_copy (mixed-tiled-to-y-tiled-ccs)
[611.540252] Starting subtest: mixed-tiled-to-y-tiled-ccs
[611.541931] Subtest mixed-tiled-to-y-tiled-ccs: SKIP (0.000s)
[611.716943] [099/133] (423s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-wc)
[611.805609] Starting subtest: fbcpsr-rgb101010-draw-mmap-wc
[618.576920] Subtest fbcpsr-rgb101010-draw-mmap-wc: SUCCESS (6.770s)
[618.697185] [100/133] (416s left) i915_pm_freq_api (freq-reset-multiple)
[618.764349] Starting subtest: freq-reset-multiple
[618.765427] Starting dynamic subtest: gt0
[628.604510] Dynamic subtest gt0: SUCCESS (9.838s)
[628.613655] Starting dynamic subtest: gt1
[637.069230] Dynamic subtest gt1: SUCCESS (8.453s)
[637.070562] Subtest freq-reset-multiple: SUCCESS (18.293s)
[637.149486] [101/133] (398s left) gem_exec_balancer (indices)
[637.210815] Starting subtest: indices
[639.499249] Subtest indices: SUCCESS (2.280s)
[639.795907] [102/133] (395s left) kms_cursor_legacy (flip-vs-cursor-crc-legacy)
[639.916113] Starting subtest: flip-vs-cursor-crc-legacy
[640.605521] Subtest flip-vs-cursor-crc-legacy: SUCCESS (0.689s)
[641.397406] [103/133] (394s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-sf)
[641.501493] Starting subtest: psr2-overlay-plane-move-continuous-sf
[641.502311] Starting dynamic subtest: pipe-A-eDP-1
[647.471074] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.967s)
[647.479988] Starting dynamic subtest: pipe-B-eDP-1
[654.191704] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.718s)
[654.192576] Subtest psr2-overlay-plane-move-continuous-sf: SUCCESS (12.688s)
[655.067776] [104/133] (380s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[655.156406] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[655.158165] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.000s)
[655.227684] [105/133] (380s left) gen9_exec_parse (basic-rejected-ctx-param)
[655.284412] Subtest basic-rejected-ctx-param: SKIP (0.000s)
[655.344685] [106/133] (380s left) perf (invalid-create-userspace-config)
[655.459520] Starting subtest: invalid-create-userspace-config
[655.460279] Subtest invalid-create-userspace-config: SUCCESS (0.001s)
[655.498740] [107/133] (380s left) syncobj_basic (bad-flags-fd-to-handle)
[655.556403] Starting subtest: bad-flags-fd-to-handle
[655.557289] Subtest bad-flags-fd-to-handle: SUCCESS (0.000s)
[655.672153] [108/133] (379s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[655.763743] Starting subtest: psr-shrfb-scaledprimary
[661.568241] Subtest psr-shrfb-scaledprimary: SUCCESS (5.804s)
[661.682454] [109/133] (373s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-render)
[661.765252] Starting subtest: psr-2p-primscrn-pri-indfb-draw-render
[661.766905] Subtest psr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[661.862067] [110/133] (373s left) kms_hdmi_inject (inject-audio)
[662.209195] Starting subtest: inject-audio
[662.488277] Subtest inject-audio: SUCCESS (0.279s)
[663.049889] [111/133] (372s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-onoff)
[663.143125] Starting subtest: fbc-1p-primscrn-cur-indfb-onoff
[667.058148] Subtest fbc-1p-primscrn-cur-indfb-onoff: SUCCESS (3.915s)
[668.228546] [112/133] (367s left) gem_exec_reloc (basic-cpu-wc)
[668.289686] Subtest basic-cpu-wc: SKIP (0.000s)
[668.364215] [113/133] (367s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[668.459823] Starting subtest: read-crc-frame-sequence
[668.460826] Starting dynamic subtest: pipe-A-eDP-1
[669.173479] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.714s)
[669.183315] Starting dynamic subtest: pipe-B-eDP-1
[670.583832] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.406s)
[670.592982] Starting dynamic subtest: pipe-C-eDP-1
[671.923478] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.339s)
[671.932775] Starting dynamic subtest: pipe-D-eDP-1
[673.226060] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.301s)
[673.227111] Subtest read-crc-frame-sequence: SUCCESS (4.766s)
[674.014074] [114/133] (361s left) kms_frontbuffer_tracking (fbcpsr-tiling-y)
[674.111633] Starting subtest: fbcpsr-tiling-y
[674.113222] Subtest fbcpsr-tiling-y: SKIP (0.000s)
[674.202460] [115/133] (361s left) i915_pm_rpm (gem-idle)
[675.718975] Starting subtest: gem-idle
[681.935317] Subtest gem-idle: SUCCESS (6.215s)
[682.258801] [116/133] (353s left) kms_pm_rpm (legacy-planes-dpms)
[683.790155] Starting subtest: legacy-planes-dpms
[683.791944] Starting dynamic subtest: plane-65
[692.125954] Dynamic subtest plane-65: SUCCESS (8.333s)
[692.139730] Starting dynamic subtest: plane-95
[700.434070] Dynamic subtest plane-95: SUCCESS (8.302s)
[700.447312] Starting dynamic subtest: plane-125
[708.753113] Dynamic subtest plane-125: SUCCESS (8.314s)
[708.766609] Starting dynamic subtest: plane-135
[717.371475] Dynamic subtest plane-135: SUCCESS (8.613s)
[717.373120] Subtest legacy-planes-dpms: SUCCESS (33.574s)
[717.801696] [117/133] (318s left) gem_spin_batch (spin-all)
[717.854374] Starting subtest: spin-all
[717.865829] Subtest spin-all: SUCCESS (0.012s)
[719.568709] [118/133] (316s left) i915_drm_fdinfo (memory-info-shared)
[719.606995] Starting subtest: memory-info-shared
[719.607896] Starting dynamic subtest: smem0
[719.662312] Dynamic subtest smem0: SUCCESS (0.055s)
[719.663591] Subtest memory-info-shared: SUCCESS (0.055s)
[719.745008] [119/133] (316s left) kms_pm_dc (dc5-psr)
[720.835094] Starting subtest: dc5-psr
[723.725722] Subtest dc5-psr: SUCCESS (2.890s)
[724.520791] [120/133] (311s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt)
[724.606834] Starting subtest: psr-rgb101010-draw-mmap-gtt
[724.608599] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[724.697892] [121/133] (311s left) gem_exec_fence (invalid-timeline-fence-array)
[725.281208] Starting subtest: invalid-timeline-fence-array
[725.282305] Subtest invalid-timeline-fence-array: SUCCESS (0.006s)
[726.601892] [122/133] (309s left) kms_content_protection (dp-mst-lic-type-0)
[726.747194] Starting subtest: dp-mst-lic-type-0
[726.749153] Subtest dp-mst-lic-type-0: SKIP (0.000s)
[726.857151] [123/133] (309s left) kms_async_flips (crc-atomic)
[726.947988] Starting subtest: crc-atomic
[727.337678] Starting dynamic subtest: pipe-A-eDP-1
[730.221835] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.883s)
[730.600326] Starting dynamic subtest: pipe-B-eDP-1
[733.511149] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.919s)
[733.886767] Starting dynamic subtest: pipe-C-eDP-1
[736.796216] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.917s)
[737.159135] Starting dynamic subtest: pipe-D-eDP-1
[740.077880] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.927s)
[740.078761] Subtest crc-atomic: SUCCESS (13.127s)
[741.233410] [124/133] (294s left) gem_tiled_partial_pwrite_pread (writes-after-reads)
[741.297581] Subtest writes-after-reads: SKIP (0.000s)
[741.375228] [125/133] (294s left) gem_ctx_persistence (saturated-hostile)
[741.434345] Starting subtest: saturated-hostile
[741.435325] Starting dynamic subtest: rcs0
[742.261105] Dynamic subtest rcs0: SUCCESS (0.825s)
[742.274306] Starting dynamic subtest: bcs0
[743.045158] Dynamic subtest bcs0: SUCCESS (0.782s)
[743.056650] Starting dynamic subtest: vcs0
[743.844830] Dynamic subtest vcs0: SUCCESS (0.798s)
[743.856734] Starting dynamic subtest: vcs1
[744.640289] Dynamic subtest vcs1: SUCCESS (0.794s)
[744.653180] Starting dynamic subtest: vecs0
[745.440546] Dynamic subtest vecs0: SUCCESS (0.798s)
[745.453639] Starting dynamic subtest: ccs0
[746.292008] Dynamic subtest ccs0: SUCCESS (0.849s)
[746.293687] Subtest saturated-hostile: SUCCESS (4.857s)
[746.373672] [126/133] (289s left) gem_sync (basic-store-each)
[746.437305] Starting subtest: basic-store-each
[748.653300] Subtest basic-store-each: SUCCESS (2.223s)
[748.838399] [127/133] (287s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling)
[748.933245] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling
[748.934218] Starting dynamic subtest: pipe-A-default-mode
[750.065367] Dynamic subtest pipe-A-default-mode: SKIP (1.130s)
[750.067028] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (1.132s)
[750.199287] [128/133] (286s left) syncobj_timeline (single-wait-available-submitted)
[750.258912] Starting subtest: single-wait-available-submitted
[750.260201] Subtest single-wait-available-submitted: SUCCESS (0.000s)
[750.354800] [129/133] (286s left) sw_sync (alloc_merge_fence)
[750.385657] Starting subtest: alloc_merge_fence
[750.386524] Subtest alloc_merge_fence: SUCCESS (0.000s)
[750.447866] [130/133] (285s left) kms_big_fb (x-tiled-8bpp-rotate-90)
[750.546840] Starting subtest: x-tiled-8bpp-rotate-90
[750.570292] Subtest x-tiled-8bpp-rotate-90: SKIP (0.022s)
[750.681526] [131/133] (285s left) gem_mmap_gtt (pf-nonblock)
[750.734733] Subtest pf-nonblock: SKIP (0.000s)
[750.807793] [132/133] (285s left) kms_flip (basic-flip-vs-wf_vblank)
[750.892357] Starting subtest: basic-flip-vs-wf_vblank
[750.894727] Starting dynamic subtest: A-eDP1
[752.846134] Dynamic subtest A-eDP1: SUCCESS (1.952s)
[752.857189] Starting dynamic subtest: B-eDP1
[754.745823] Dynamic subtest B-eDP1: SUCCESS (1.896s)
[754.755419] Starting dynamic subtest: C-eDP1
[756.644184] Dynamic subtest C-eDP1: SUCCESS (1.897s)
[756.655653] Starting dynamic subtest: D-eDP1
[758.533460] Dynamic subtest D-eDP1: SUCCESS (1.889s)
[758.536504] Subtest basic-flip-vs-wf_vblank: SUCCESS (7.646s)
[759.718910] [133/133] (276s left) gem_exec_whisper (basic-sync)
[759.781007] Starting subtest: basic-sync
[767.741987] Subtest basic-sync: SUCCESS (7.954s)
[767.911102] Closing watchdogs
results: parsing output: 0/ for test: gem_ctx_bad_destroy
results: parsing output: 1/ for test: kms_ccs
results: parsing output: 2/ for test: syncobj_wait
results: parsing output: 3/ for test: kms_addfb_basic
results: parsing output: 4/ for test: syncobj_wait
results: parsing output: 5/ for test: kms_chamelium_hpd
results: parsing output: 6/ for test: kms_plane_scaling
results: parsing output: 7/ for test: kms_cursor_crc
results: parsing output: 8/ for test: gem_exec_parallel
results: parsing output: 9/ for test: kms_big_fb
results: parsing output: 10/ for test: kms_psr2_sf
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_flip
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: gen7_exec_parse
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: perf_pmu
results: parsing output: 18/ for test: gem_mmap_wc
results: parsing output: 19/ for test: sriov_basic
results: parsing output: 20/ for test: kms_addfb_basic
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: gem_ctx_persistence
results: parsing output: 23/ for test: kms_plane_scaling
results: parsing output: 24/ for test: syncobj_timeline
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_cursor_crc
results: parsing output: 27/ for test: syncobj_basic
results: parsing output: 28/ for test: gem_fence_thrash
results: parsing output: 29/ for test: kms_color_pipeline
results: parsing output: 30/ for test: kms_cursor_legacy
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: kms_sequence
results: parsing output: 33/ for test: kms_invalid_mode
results: parsing output: 34/ for test: kms_dsc
results: parsing output: 35/ for test: gem_mmap
results: parsing output: 36/ for test: kms_flip
results: parsing output: 37/ for test: kms_psr2_sf
results: parsing output: 38/ for test: gem_mmap_offset
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_hdr
results: parsing output: 41/ for test: kms_psr
results: parsing output: 42/ for test: gem_exec_schedule
results: parsing output: 43/ for test: kms_psr
results: parsing output: 44/ for test: kms_setmode
results: parsing output: 45/ for test: kms_rotation_crc
results: parsing output: 46/ for test: i915_pm_rps
results: parsing output: 47/ for test: sysfs_timeslice_duration
results: parsing output: 48/ for test: kms_plane
results: parsing output: 49/ for test: kms_plane_multiple
results: parsing output: 50/ for test: kms_big_fb
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_vblank
results: parsing output: 53/ for test: kms_psr
results: parsing output: 54/ for test: syncobj_timeline
results: parsing output: 55/ for test: vgem_basic
results: parsing output: 56/ for test: api_intel_bb
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: syncobj_timeline
results: parsing output: 59/ for test: gem_exec_capture
results: parsing output: 60/ for test: kms_legacy_colorkey
results: parsing output: 61/ for test: gem_exec_store
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_chamelium_frames
results: parsing output: 64/ for test: gem_render_copy
results: parsing output: 65/ for test: gem_flink_race
results: parsing output: 66/ for test: kms_addfb_basic
results: parsing output: 67/ for test: kms_ccs
results: parsing output: 68/ for test: kms_psr
results: parsing output: 69/ for test: kms_ccs
results: parsing output: 70/ for test: kms_cursor_legacy
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_exec_alignment
results: parsing output: 73/ for test: perf_pmu
results: parsing output: 74/ for test: gem_render_copy
results: parsing output: 75/ for test: kms_ccs
results: parsing output: 76/ for test: gem_exec_params
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: api_intel_allocator
results: parsing output: 79/ for test: dumb_buffer
results: parsing output: 80/ for test: kms_cursor_crc
results: parsing output: 81/ for test: kms_cursor_legacy
results: parsing output: 82/ for test: gem_busy
results: parsing output: 83/ for test: gem_exec_schedule
results: parsing output: 84/ for test: kms_big_fb
results: parsing output: 85/ for test: sw_sync
results: parsing output: 86/ for test: gem_userptr_blits
results: parsing output: 87/ for test: kms_flip
results: parsing output: 88/ for test: gem_exec_reloc
results: parsing output: 89/ for test: prime_mmap_coherency
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: gem_create
results: parsing output: 92/ for test: gem_lmem_swapping
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_chamelium_audio
results: parsing output: 96/ for test: kms_psr
results: parsing output: 97/ for test: gem_render_copy
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: i915_pm_freq_api
results: parsing output: 100/ for test: gem_exec_balancer
results: parsing output: 101/ for test: kms_cursor_legacy
results: parsing output: 102/ for test: kms_psr2_sf
results: parsing output: 103/ for test: kms_flip_scaled_crc
results: parsing output: 104/ for test: gen9_exec_parse
results: parsing output: 105/ for test: perf
results: parsing output: 106/ for test: syncobj_basic
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_hdmi_inject
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: gem_exec_reloc
results: parsing output: 112/ for test: kms_pipe_crc_basic
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: i915_pm_rpm
results: parsing output: 115/ for test: kms_pm_rpm
results: parsing output: 116/ for test: gem_spin_batch
results: parsing output: 117/ for test: i915_drm_fdinfo
results: parsing output: 118/ for test: kms_pm_dc
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: gem_exec_fence
results: parsing output: 121/ for test: kms_content_protection
results: parsing output: 122/ for test: kms_async_flips
results: parsing output: 123/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 124/ for test: gem_ctx_persistence
results: parsing output: 125/ for test: gem_sync
results: parsing output: 126/ for test: kms_flip_scaled_crc
results: parsing output: 127/ for test: syncobj_timeline
results: parsing output: 128/ for test: sw_sync
results: parsing output: 129/ for test: kms_big_fb
results: parsing output: 130/ for test: gem_mmap_gtt
results: parsing output: 131/ for test: kms_flip
results: parsing output: 132/ for test: gem_exec_whisper
Done.