[56.713972] Initializing watchdogs
[56.714498]   /dev/watchdog0
[56.728756] [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]
[56.732926] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.734851] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.736798] [001/131] (960s left) gem_eio (in-flight-suspend)
[56.881634] Starting subtest: in-flight-suspend
[100.260932] Subtest in-flight-suspend: SUCCESS (13.447s)
[107.429413] [FACT gem_eio (in-flight-suspend)] new: kernel.kmod_is_loaded.vgem: true
[107.431962] [002/131] (916s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area)
[112.448460] Starting subtest: fbc-pr-primary-plane-update-sf-dmg-area
[112.452695] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.002s)
[113.269661] [003/131] (911s left) prime_vgem (busy)
[113.345547] Starting subtest: busy
[113.346564] Starting dynamic subtest: rcs0
[113.399197] Dynamic subtest rcs0: SUCCESS (0.055s)
[113.405479] Starting dynamic subtest: bcs0
[113.455843] Dynamic subtest bcs0: SUCCESS (0.058s)
[113.462113] Starting dynamic subtest: vcs0
[113.505124] Dynamic subtest vcs0: SUCCESS (0.050s)
[113.511396] Starting dynamic subtest: vcs1
[113.550288] Dynamic subtest vcs1: SUCCESS (0.046s)
[113.556438] Starting dynamic subtest: vecs0
[113.597200] Dynamic subtest vecs0: SUCCESS (0.048s)
[113.603323] Starting dynamic subtest: ccs0
[113.642561] Dynamic subtest ccs0: SUCCESS (0.046s)
[113.643412] Subtest busy: SUCCESS (0.303s)
[113.766084] [004/131] (910s left) kms_pm_dc (dc5-psr)
[114.856967] Starting subtest: dc5-psr
[117.808859] Subtest dc5-psr: SUCCESS (2.992s)
[118.619291] [005/131] (905s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-signaled)
[118.662457] Starting subtest: multi-wait-all-for-submit-unsubmitted-signaled
[118.767774] Subtest multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.104s)
[118.835273] [006/131] (905s left) prime_vgem (basic-gtt)
[118.916781] Starting subtest: basic-gtt
[118.918763] Subtest basic-gtt: SKIP (0.000s)
[119.014970] [007/131] (905s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-upscaling)
[119.106577] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-upscaling
[119.107468] Starting dynamic subtest: pipe-A-default-mode
[121.844958] Dynamic subtest pipe-A-default-mode: SUCCESS (2.759s)
[121.846037] Subtest flip-64bpp-xtile-to-32bpp-xtile-upscaling: SUCCESS (2.760s)
[122.690181] [008/131] (901s left) gem_exec_params (sol-reset-not-gen7)
[122.745964] Starting subtest: sol-reset-not-gen7
[122.749095] Subtest sol-reset-not-gen7: SUCCESS (0.003s)
[122.880625] [009/131] (901s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[122.970043] Starting subtest: bad-pixel-format-4-tiled-dg2-mc-ccs
[122.970979] Starting dynamic subtest: pipe-A-eDP-1
[122.979463] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[122.986716] Starting dynamic subtest: pipe-B-eDP-1
[122.996152] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[123.002717] Starting dynamic subtest: pipe-C-eDP-1
[123.011221] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[123.017442] Starting dynamic subtest: pipe-D-eDP-1
[123.026222] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[123.027940] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.002s)
[125.157187] [010/131] (899s left) kms_cursor_legacy (cursora-vs-flipa-atomic)
[125.267648] Starting subtest: cursorA-vs-flipA-atomic
[136.393269] Subtest cursorA-vs-flipA-atomic: SUCCESS (11.152s)
[137.252189] [011/131] (887s left) api_intel_bb (bb-with-allocator)
[137.297762] Starting subtest: bb-with-allocator
[137.303551] Subtest bb-with-allocator: SUCCESS (0.007s)
[137.440639] [012/131] (887s left) kms_psr (fbc-pr-sprite-mmap-cpu)
[137.524683] Starting subtest: fbc-pr-sprite-mmap-cpu
[137.526377] Subtest fbc-pr-sprite-mmap-cpu: SKIP (0.000s)
[137.591849] [013/131] (887s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy)
[137.706017] Starting subtest: 2x-flip-vs-cursor-legacy
[137.708496] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.001s)
[137.846705] [014/131] (886s left) kms_psr (fbc-psr2-primary-page-flip)
[137.940652] Starting subtest: fbc-psr2-primary-page-flip
[137.941657] Starting dynamic subtest: eDP-1
[137.943424] Dynamic subtest eDP-1: SKIP (0.000s)
[137.945265] Subtest fbc-psr2-primary-page-flip: SKIP (0.000s)
[138.005412] [015/131] (886s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render)
[138.104482] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render
[138.106446] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[138.193632] [016/131] (886s left) kms_joiner (invalid-modeset-force-big-joiner)
[138.288037] Starting subtest: invalid-modeset-force-big-joiner
[138.289055] Starting dynamic subtest: big_joiner_on_last_pipe
[138.627130] Dynamic subtest big_joiner_on_last_pipe: SUCCESS (0.343s)
[138.628097] Subtest invalid-modeset-force-big-joiner: SUCCESS (0.343s)
[139.380890] [017/131] (885s left) i915_pm_rc6_residency (rc6-idle)
[139.437887] Starting subtest: rc6-idle
[139.470746] Starting dynamic subtest: gt0-rcs0
[163.909901] Dynamic subtest gt0-rcs0: SUCCESS (24.431s)
[163.917673] Starting dynamic subtest: gt0-bcs0
[188.243274] Dynamic subtest gt0-bcs0: SUCCESS (24.339s)
[188.250339] Starting dynamic subtest: gt0-ccs0
[212.627823] Dynamic subtest gt0-ccs0: SUCCESS (24.384s)
[212.637101] Starting dynamic subtest: gt1-vcs0
[218.803222] Dynamic subtest gt1-vcs0: SUCCESS (6.169s)
[218.812611] Starting dynamic subtest: gt1-vecs0
[224.974291] Dynamic subtest gt1-vecs0: SUCCESS (6.169s)
[224.975870] Subtest rc6-idle: SUCCESS (85.531s)
[225.043600] [018/131] (799s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[225.152550] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[225.154345] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[225.293557] [019/131] (799s left) gem_eio (execbuf)
[225.485041] Starting subtest: execbuf
[225.770579] Subtest execbuf: SUCCESS (0.286s)
[225.936568] [020/131] (798s left) gem_lmem_swapping (verify-random-ccs)
[225.971895] Subtest verify-random-ccs: SKIP (0.000s)
[226.009572] [021/131] (798s left) gem_exec_gttfill (basic)
[226.054751] Starting subtest: basic
[229.001774] Subtest basic: SUCCESS (2.946s)
[229.184358] [022/131] (795s left) kms_addfb_basic (bad-pitch-999)
[229.274076] Starting subtest: bad-pitch-999
[229.275000] Subtest bad-pitch-999: SUCCESS (0.000s)
[229.415124] [023/131] (795s left) gem_render_copy (y-tiled-ccs-to-y-tiled-ccs)
[229.472272] Starting subtest: y-tiled-ccs-to-y-tiled-ccs
[229.474146] Subtest y-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s)
[229.648377] [024/131] (795s left) gem_exec_fence (syncobj-timeline-invalid-flags)
[230.191272] Starting subtest: syncobj-timeline-invalid-flags
[230.192810] Subtest syncobj-timeline-invalid-flags: SUCCESS (0.000s)
[232.068124] [025/131] (792s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt)
[232.171443] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt
[239.469467] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.299s)
[239.608675] [026/131] (785s left) syncobj_timeline (signal-point-0)
[239.657240] Starting subtest: signal-point-0
[239.658304] Subtest signal-point-0: SUCCESS (0.000s)
[239.736141] [027/131] (785s left) gem_spin_batch (legacy-resubmit)
[239.781416] Starting subtest: legacy-resubmit
[239.782632] Starting dynamic subtest: default
[239.786900] Dynamic subtest default: SUCCESS (0.005s)
[239.796014] Starting dynamic subtest: render
[239.796969] Dynamic subtest render: SUCCESS (0.001s)
[239.804305] Starting dynamic subtest: bsd
[239.805249] Dynamic subtest bsd: SUCCESS (0.002s)
[239.812322] Starting dynamic subtest: bsd1
[239.813317] Dynamic subtest bsd1: SUCCESS (0.001s)
[239.820424] Starting dynamic subtest: bsd2
[239.821413] Dynamic subtest bsd2: SUCCESS (0.002s)
[239.828412] Starting dynamic subtest: blt
[239.829403] Dynamic subtest blt: SUCCESS (0.003s)
[239.836362] Starting dynamic subtest: vebox
[239.837391] Dynamic subtest vebox: SUCCESS (0.002s)
[239.838373] Subtest legacy-resubmit: SUCCESS (0.019s)
[240.039801] [028/131] (785s left) perf_pmu (interrupts)
[240.071043] Starting subtest: interrupts
[241.168368] Subtest interrupts: SUCCESS (1.094s)
[241.275010] [029/131] (783s left) gem_exec_reloc (basic-concurrent16)
[241.335411] Subtest basic-concurrent16: SKIP (0.000s)
[241.408908] [030/131] (783s left) gem_exec_await (wide-contexts)
[241.571395] Starting subtest: wide-contexts
[264.688491] Subtest wide-contexts: SUCCESS (23.119s)
[264.873158] [031/131] (760s left) gem_reg_read (timestamp-moving)
[264.945620] Starting subtest: timestamp-moving
[265.949536] Subtest timestamp-moving: SUCCESS (1.001s)
[266.018946] [032/131] (759s left) gem_render_copy_redux (flink-interruptible)
[266.074043] Starting subtest: flink-interruptible
[267.217478] Subtest flink-interruptible: SUCCESS (1.144s)
[267.350754] [033/131] (757s left) vgem_basic (dmabuf-fence-before)
[267.385861] Starting subtest: dmabuf-fence-before
[267.386779] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[267.439339] [034/131] (757s left) vgem_basic (bad-handle)
[267.474936] Starting subtest: bad-handle
[267.475940] Subtest bad-handle: SUCCESS (0.000s)
[267.526149] [035/131] (757s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[267.624415] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[267.634806] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.011s)
[267.706118] [036/131] (757s left) gem_ctx_param (invalid-size-get)
[267.756793] Starting subtest: invalid-size-get
[267.757891] Subtest invalid-size-get: SUCCESS (0.001s)
[267.873916] [037/131] (757s left) gem_mmap_wc (close)
[267.933142] Subtest close: SKIP (0.000s)
[267.990270] [038/131] (757s left) core_sysfs (read-all-entries)
[268.043545] Starting subtest: read-all-entries
[268.046636] Subtest read-all-entries: SUCCESS (0.004s)
[268.134047] [039/131] (757s left) gem_softpin (overlap)
[268.188772] Starting subtest: overlap
[269.138556] Subtest overlap: SUCCESS (0.947s)
[269.256766] [040/131] (756s left) gem_pread (display)
[269.309598] Subtest display: SKIP (0.000s)
[269.367791] [041/131] (756s left) kms_busy (basic-hang)
[269.458563] Starting subtest: basic-hang
[269.459413] Starting dynamic subtest: flip-pipe-A
[270.064150] Dynamic subtest flip-pipe-A: SUCCESS (0.604s)
[270.071961] Starting dynamic subtest: modeset-pipe-A
[273.455564] Dynamic subtest modeset-pipe-A: SUCCESS (3.392s)
[273.465028] Starting dynamic subtest: flip-pipe-D
[274.674874] Dynamic subtest flip-pipe-D: SUCCESS (1.218s)
[274.683190] Starting dynamic subtest: modeset-pipe-D
[278.108758] Dynamic subtest modeset-pipe-D: SUCCESS (3.432s)
[278.109870] Subtest basic-hang: SUCCESS (8.651s)
[278.901917] [042/131] (746s left) gem_exec_schedule (submit-golden-slice)
[278.960723] Starting subtest: submit-golden-slice
[278.961554] Starting dynamic subtest: rcs0
[279.000132] Dynamic subtest rcs0: SUCCESS (0.039s)
[279.009466] Starting dynamic subtest: bcs0
[279.041916] Dynamic subtest bcs0: SUCCESS (0.041s)
[279.051838] Starting dynamic subtest: vcs0
[279.078235] Dynamic subtest vcs0: SUCCESS (0.036s)
[279.085991] Starting dynamic subtest: vcs1
[279.111442] Dynamic subtest vcs1: SUCCESS (0.033s)
[279.119386] Starting dynamic subtest: vecs0
[279.145659] Dynamic subtest vecs0: SUCCESS (0.034s)
[279.153700] Starting dynamic subtest: ccs0
[279.185439] Dynamic subtest ccs0: SUCCESS (0.040s)
[279.186448] Subtest submit-golden-slice: SUCCESS (0.225s)
[281.071788] [043/131] (744s left) syncobj_timeline (single-wait-signaled)
[281.131719] Starting subtest: single-wait-signaled
[281.132961] Subtest single-wait-signaled: SUCCESS (0.000s)
[281.243401] [044/131] (744s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary)
[281.330122] Starting subtest: fbcpsr-shrfb-scaledprimary
[289.117016] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (7.789s)
[289.212311] [045/131] (736s left) kms_sequence (get-busy)
[289.294380] Starting subtest: get-busy
[289.295384] Starting dynamic subtest: pipe-A-eDP-1
[291.216388] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.922s)
[291.224180] Starting dynamic subtest: pipe-B-eDP-1
[293.847684] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.631s)
[293.856252] Starting dynamic subtest: pipe-C-eDP-1
[296.464793] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.617s)
[296.472927] Starting dynamic subtest: pipe-D-eDP-1
[299.091409] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.626s)
[299.092371] Subtest get-busy: SUCCESS (9.799s)
[299.886794] [046/131] (725s left) vgem_basic (create)
[299.924456] Starting subtest: create
[299.925396] Subtest create: SUCCESS (0.000s)
[299.978746] [047/131] (725s left) perf (invalid-open-flags)
[300.104531] Starting subtest: invalid-open-flags
[300.105409] Subtest invalid-open-flags: SUCCESS (0.000s)
[300.141610] [048/131] (725s left) kms_big_fb (linear-32bpp-rotate-90)
[300.233734] Starting subtest: linear-32bpp-rotate-90
[300.254534] Subtest linear-32bpp-rotate-90: SKIP (0.020s)
[300.386835] [049/131] (725s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[300.483074] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt
[300.484785] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[300.563456] [050/131] (725s left) gem_ctx_persistence (legacy-engines-hang)
[300.630327] Starting subtest: legacy-engines-hang
[300.631361] Starting dynamic subtest: render
[300.757541] Dynamic subtest render: SUCCESS (0.126s)
[300.767295] Starting dynamic subtest: bsd1
[300.869302] Dynamic subtest bsd1: SUCCESS (0.110s)
[300.880682] Starting dynamic subtest: bsd2
[300.957788] Dynamic subtest bsd2: SUCCESS (0.087s)
[300.968103] Starting dynamic subtest: blt
[301.086314] Dynamic subtest blt: SUCCESS (0.126s)
[301.102313] Starting dynamic subtest: vebox
[301.189030] Dynamic subtest vebox: SUCCESS (0.101s)
[301.190359] Subtest legacy-engines-hang: SUCCESS (0.559s)
[301.259286] [051/131] (724s left) kms_plane_scaling (planes-scaler-unity-scaling)
[301.333256] Starting subtest: planes-scaler-unity-scaling
[301.334267] Starting dynamic subtest: pipe-A
[301.401032] Dynamic subtest pipe-A: SUCCESS (0.067s)
[301.410535] Starting dynamic subtest: pipe-B
[302.522943] Dynamic subtest pipe-B: SUCCESS (1.122s)
[302.531666] Starting dynamic subtest: pipe-C
[303.653166] Dynamic subtest pipe-C: SUCCESS (1.130s)
[303.662381] Starting dynamic subtest: pipe-D
[304.763483] Dynamic subtest pipe-D: SUCCESS (1.110s)
[304.764469] Subtest planes-scaler-unity-scaling: SUCCESS (3.431s)
[305.912728] [052/131] (719s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-blt)
[306.010493] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-blt
[312.926045] Subtest fbcpsr-1p-offscren-pri-indfb-draw-blt: SUCCESS (6.916s)
[313.086211] [053/131] (712s left) gem_mmap (bad-object)
[313.144751] Subtest bad-object: SKIP (0.000s)
[313.209281] [054/131] (712s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted)
[313.266757] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted
[313.376565] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.107s)
[313.447350] [055/131] (712s left) kms_big_fb (y-tiled-8bpp-rotate-180)
[313.548321] Starting subtest: y-tiled-8bpp-rotate-180
[313.550164] Subtest y-tiled-8bpp-rotate-180: SKIP (0.000s)
[313.664978] [056/131] (712s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[313.762030] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[313.762966] Starting dynamic subtest: pipe-A-eDP-1
[313.964955] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.192s)
[313.973213] Starting dynamic subtest: pipe-B-eDP-1
[315.200077] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.234s)
[315.208796] Starting dynamic subtest: pipe-C-eDP-1
[316.415682] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.214s)
[316.424081] Starting dynamic subtest: pipe-D-eDP-1
[317.644858] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.225s)
[317.645797] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SUCCESS (3.868s)
[318.775346] [057/131] (707s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render)
[318.870175] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render
[318.871881] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[318.968040] [058/131] (707s left) kms_dirtyfb (drrs-dirtyfb-ioctl)
[319.062705] Starting subtest: drrs-dirtyfb-ioctl
[319.067443] Subtest drrs-dirtyfb-ioctl: SKIP (0.001s)
[319.167772] [059/131] (706s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt)
[319.259166] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt
[319.260841] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[319.346336] [060/131] (706s left) gem_exec_capture (capture)
[319.403846] Starting subtest: capture
[319.404744] Starting dynamic subtest: rcs0-smem
[320.233712] Dynamic subtest rcs0-smem: SUCCESS (0.830s)
[320.240925] Starting dynamic subtest: bcs0-smem
[321.263587] Dynamic subtest bcs0-smem: SUCCESS (1.030s)
[321.270755] Starting dynamic subtest: vcs0-smem
[322.092739] Dynamic subtest vcs0-smem: SUCCESS (0.830s)
[322.099988] Starting dynamic subtest: vcs1-smem
[322.913260] Dynamic subtest vcs1-smem: SUCCESS (0.819s)
[322.921322] Starting dynamic subtest: vecs0-smem
[324.268092] Dynamic subtest vecs0-smem: FAIL (1.336s)
[324.275915] Starting dynamic subtest: ccs0-smem
[325.575990] Dynamic subtest ccs0-smem: SUCCESS (1.327s)
[325.577155] Subtest capture: FAIL (6.174s)
[325.703863] [061/131] (700s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-pgflip-blt)
[325.795181] Starting subtest: psr-2p-scndscrn-indfb-pgflip-blt
[325.796901] Subtest psr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[325.891355] [062/131] (700s left) sw_sync (sync_merge_same)
[325.917170] Starting subtest: sync_merge_same
[325.918140] Subtest sync_merge_same: SUCCESS (0.000s)
[325.966006] [063/131] (700s left) gem_eio (kms)
[326.176901] Starting subtest: kms
[348.233078] Subtest kms: SUCCESS (22.052s)
[348.377968] [064/131] (677s left) gem_softpin (noreloc)
[348.447233] Starting subtest: noreloc
[353.836794] Subtest noreloc: SUCCESS (5.386s)
[353.945509] [065/131] (672s left) kms_chamelium_frames (hdmi-cmp-planar-formats)
[354.331493] Subtest hdmi-cmp-planar-formats: SKIP (0.000s)
[355.176394] [066/131] (671s left) kms_invalid_mode (bad-hsync-end)
[355.260079] Starting subtest: bad-hsync-end
[355.261114] Starting dynamic subtest: pipe-A-eDP-1
[355.552028] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.292s)
[355.560450] Starting dynamic subtest: pipe-B-eDP-1
[355.561411] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[355.568976] Starting dynamic subtest: pipe-C-eDP-1
[355.569886] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[355.577397] Starting dynamic subtest: pipe-D-eDP-1
[355.578403] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[355.579318] Subtest bad-hsync-end: SUCCESS (0.297s)
[356.344260] [067/131] (669s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[356.717557] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[357.554986] [068/131] (668s left) i915_fb_tiling (basic-x-tiling)
[357.602782] Subtest basic-x-tiling: SKIP (0.000s)
[357.663282] [069/131] (668s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite)
[357.752989] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite
[357.754601] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[357.846977] [070/131] (668s left) gem_caching (reads)
[357.911118] Subtest reads: SKIP (0.000s)
[357.988554] [071/131] (668s left) kms_tv_load_detect (load-detect)
[358.045461] Subtest load-detect: SKIP (0.000s)
[358.106601] [072/131] (668s left) gem_ctx_shared (detached-shared-gtt)
[358.166632] Starting subtest: detached-shared-gtt
[360.319146] Subtest detached-shared-gtt: SUCCESS (2.151s)
[361.050230] [073/131] (665s left) kms_flip (2x-flip-vs-dpms-on-nop-interruptible)
[361.133751] Starting subtest: 2x-flip-vs-dpms-on-nop-interruptible
[361.145459] Subtest 2x-flip-vs-dpms-on-nop-interruptible: SKIP (0.011s)
[361.256988] [074/131] (665s left) gem_ctx_exec (basic-nohangcheck)
[361.315420] Starting subtest: basic-nohangcheck
[361.594117] Subtest basic-nohangcheck: SUCCESS (0.278s)
[361.707684] [075/131] (664s left) dumb_buffer (map-uaf)
[361.762973] Starting subtest: map-uaf
[361.767774] Subtest map-uaf: SUCCESS (0.006s)
[361.862014] [076/131] (664s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[361.947779] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[361.948656] Starting dynamic subtest: pipe-A-default-mode
[362.298559] Dynamic subtest pipe-A-default-mode: SKIP (0.349s)
[362.300608] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.350s)
[363.098914] [077/131] (663s left) kms_ccs (random-ccs-data-yf-tiled-ccs)
[363.195073] Starting subtest: random-ccs-data-yf-tiled-ccs
[363.196003] Starting dynamic subtest: pipe-A-eDP-1
[363.205556] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[363.213871] Starting dynamic subtest: pipe-B-eDP-1
[363.223304] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[363.230966] Starting dynamic subtest: pipe-C-eDP-1
[363.240012] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[363.247722] Starting dynamic subtest: pipe-D-eDP-1
[363.257088] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[363.258759] Subtest random-ccs-data-yf-tiled-ccs: SKIP (0.004s)
[365.367629] [078/131] (661s left) syncobj_timeline (multi-wait-all-signaled)
[365.419978] Starting subtest: multi-wait-all-signaled
[365.421043] Subtest multi-wait-all-signaled: SUCCESS (0.000s)
[365.507886] [079/131] (661s left) core_auth (many-magics)
[365.559908] Starting subtest: many-magics
[366.417097] Subtest many-magics: SUCCESS (0.850s)
[366.627686] [080/131] (660s left) kms_psr (fbc-psr-sprite-mmap-gtt)
[366.715985] Starting subtest: fbc-psr-sprite-mmap-gtt
[366.716856] Starting dynamic subtest: eDP-1
[366.718436] Dynamic subtest eDP-1: SKIP (0.000s)
[366.720170] Subtest fbc-psr-sprite-mmap-gtt: SKIP (0.001s)
[366.785701] [081/131] (660s left) gem_wait (busy)
[366.840215] Starting subtest: busy
[366.841168] Starting dynamic subtest: all-engines
[367.963924] Dynamic subtest all-engines: SUCCESS (1.122s)
[367.982875] Starting dynamic subtest: rcs0
[368.505352] Dynamic subtest rcs0: SUCCESS (0.539s)
[368.517459] Starting dynamic subtest: bcs0
[369.047141] Dynamic subtest bcs0: SUCCESS (0.538s)
[369.076516] Starting dynamic subtest: vcs0
[370.972158] Dynamic subtest vcs0: SUCCESS (1.926s)
[370.984056] Starting dynamic subtest: vcs1
[373.025848] Dynamic subtest vcs1: SUCCESS (2.048s)
[373.061013] Starting dynamic subtest: vecs0
[375.003159] Dynamic subtest vecs0: SUCCESS (1.980s)
[375.013906] Starting dynamic subtest: ccs0
[375.545675] Dynamic subtest ccs0: SUCCESS (0.541s)
[375.546773] Subtest busy: SUCCESS (8.704s)
[375.736220] [082/131] (651s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[376.113584] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[376.878408] [083/131] (649s left) kms_cursor_crc (cursor-dpms)
[377.007802] Starting subtest: cursor-dpms
[377.008766] Starting dynamic subtest: pipe-A-eDP-1
[380.064391] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.054s)
[380.072821] Starting dynamic subtest: pipe-D-eDP-1
[383.659583] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.593s)
[383.660691] Subtest cursor-dpms: SUCCESS (6.650s)
[384.485311] [084/131] (642s left) gem_exec_balancer (invalid-balancer)
[384.552674] Starting subtest: invalid-balancer
[385.432870] Subtest invalid-balancer: SUCCESS (0.879s)
[385.715253] [085/131] (641s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area)
[390.664011] Starting subtest: pr-overlay-primary-update-sf-dmg-area
[390.667283] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.002s)
[391.502439] [086/131] (635s left) kms_psr (pr-sprite-render)
[391.588079] Starting subtest: pr-sprite-render
[391.589936] Subtest pr-sprite-render: SKIP (0.000s)
[391.656974] [087/131] (635s left) kms_vblank (query-idle)
[391.760914] Starting subtest: query-idle
[391.761816] Starting dynamic subtest: pipe-A-eDP-1
[393.516446] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.754s)
[393.528000] Starting dynamic subtest: pipe-D-eDP-1
[395.947036] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.429s)
[395.947999] Subtest query-idle: SUCCESS (4.186s)
[396.775805] [088/131] (630s left) kms_pipe_crc_basic (disable-crc-after-crtc)
[396.863630] Starting subtest: disable-crc-after-crtc
[396.864435] Starting dynamic subtest: pipe-A-eDP-1
[398.519471] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.654s)
[398.528633] Starting dynamic subtest: pipe-B-eDP-1
[400.794232] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.275s)
[400.802307] Starting dynamic subtest: pipe-C-eDP-1
[403.044556] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.248s)
[403.052450] Starting dynamic subtest: pipe-D-eDP-1
[405.302224] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.257s)
[405.303241] Subtest disable-crc-after-crtc: SUCCESS (8.439s)
[406.129607] [089/131] (620s left) gem_softpin (allocator-basic-reserve)
[406.186087] Starting subtest: allocator-basic-reserve
[406.257928] Subtest allocator-basic-reserve: SUCCESS (0.072s)
[406.377381] [090/131] (620s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc)
[406.463497] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc
[406.464385] Starting dynamic subtest: pipe-A-eDP-1
[406.472239] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[406.480199] Starting dynamic subtest: pipe-B-eDP-1
[406.488411] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[406.496380] Starting dynamic subtest: pipe-C-eDP-1
[406.505250] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[406.512793] Starting dynamic subtest: pipe-D-eDP-1
[406.521142] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[406.522754] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[408.600439] [091/131] (618s left) kms_addfb_basic (legacy-format)
[408.653812] Starting subtest: legacy-format
[408.679218] Subtest legacy-format: SUCCESS (0.026s)
[408.815779] [092/131] (618s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt)
[408.906336] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt
[408.907982] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[409.020351] [093/131] (618s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-signaled)
[409.077031] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[409.077980] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[409.173641] [094/131] (618s left) gem_pxp (create-valid-protected-context)
[409.292938] Starting subtest: create-valid-protected-context
[409.293961] Subtest create-valid-protected-context: SUCCESS (0.002s)
[409.395669] [095/131] (617s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[409.484604] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[413.988780] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (4.504s)
[415.095635] [096/131] (612s left) kms_atomic_transition (plane-all-transition-nonblocking-fencing)
[415.198088] Starting subtest: plane-all-transition-nonblocking-fencing
[415.199295] Starting dynamic subtest: pipe-A-eDP-1
[417.699608] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.503s)
[418.016084] Starting dynamic subtest: pipe-B-eDP-1
[421.231346] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.222s)
[421.525667] Subtest plane-all-transition-nonblocking-fencing: SUCCESS (6.329s)
[422.349060] [097/131] (604s left) kms_cursor_crc (cursor-offscreen-max-size)
[422.638728] Starting subtest: cursor-offscreen-max-size
[422.641270] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[422.766665] [098/131] (604s left) kms_vblank (ts-continuation-modeset-hang)
[422.844804] Starting subtest: ts-continuation-modeset-hang
[422.845691] Starting dynamic subtest: pipe-A-eDP-1
[449.747576] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.903s)
[449.758083] Starting dynamic subtest: pipe-D-eDP-1
[475.727054] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.980s)
[475.728119] Subtest ts-continuation-modeset-hang: SUCCESS (52.888s)
[476.557234] [099/131] (550s left) kms_big_fb (x-tiled-64bpp-rotate-270)
[476.650481] Starting subtest: x-tiled-64bpp-rotate-270
[476.670958] Subtest x-tiled-64bpp-rotate-270: SKIP (0.020s)
[476.800755] [100/131] (550s left) perf_pmu (busy-start)
[476.835456] Starting subtest: busy-start
[476.836296] Starting dynamic subtest: rcs0
[479.387540] Dynamic subtest rcs0: SUCCESS (2.552s)
[479.399950] Starting dynamic subtest: bcs0
[481.940776] Dynamic subtest bcs0: SUCCESS (2.551s)
[481.952558] Starting dynamic subtest: vcs0
[485.981094] Dynamic subtest vcs0: SUCCESS (4.037s)
[485.990403] Starting dynamic subtest: vcs1
[490.013864] Dynamic subtest vcs1: SUCCESS (4.031s)
[490.024247] Starting dynamic subtest: vecs0
[493.979996] Dynamic subtest vecs0: SUCCESS (3.964s)
[493.990616] Starting dynamic subtest: ccs0
[496.529584] Dynamic subtest ccs0: SUCCESS (2.550s)
[496.530731] Subtest busy-start: SUCCESS (19.697s)
[496.639785] [101/131] (530s left) gem_mmap_gtt (flink-race)
[496.688573] Subtest flink-race: SKIP (0.000s)
[496.749011] [102/131] (530s left) gem_exec_whisper (basic-contexts-priority)
[496.811773] Starting subtest: basic-contexts-priority
[521.231475] Subtest basic-contexts-priority: SUCCESS (24.421s)
[521.405312] [103/131] (506s left) kms_cursor_legacy (cursorb-vs-flipa-atomic)
[521.518341] Starting subtest: cursorB-vs-flipA-atomic
[521.521275] Subtest cursorB-vs-flipA-atomic: SKIP (0.002s)
[521.658227] [104/131] (505s left) kms_big_fb (yf-tiled-addfb)
[521.759304] Starting subtest: yf-tiled-addfb
[521.761233] Subtest yf-tiled-addfb: SKIP (0.000s)
[521.865059] [105/131] (505s left) gem_pwrite_snooped
[522.000933] [106/131] (505s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt)
[522.085831] Starting subtest: psr-rgb565-draw-mmap-gtt
[522.087499] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[522.192200] [107/131] (505s left) gem_ccs (block-copy-compressed)
[522.243982] Starting subtest: block-copy-compressed
[522.246096] Subtest block-copy-compressed: SKIP (0.000s)
[522.338290] [108/131] (505s left) gem_ctx_param (invalid-ctx-set)
[522.385878] Starting subtest: invalid-ctx-set
[522.386819] Subtest invalid-ctx-set: SUCCESS (0.001s)
[522.500554] [109/131] (505s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[522.597419] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu
[528.908277] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.313s)
[529.017541] [110/131] (498s left) kms_rotation_crc (cursor-rotation-180)
[529.105981] Starting subtest: cursor-rotation-180
[530.619889] Subtest cursor-rotation-180: SUCCESS (1.515s)
[531.808934] [111/131] (495s left) kms_psr (psr2-sprite-mmap-cpu)
[531.899293] Starting subtest: psr2-sprite-mmap-cpu
[531.900275] Starting dynamic subtest: eDP-1
[533.585054] Dynamic subtest eDP-1: SUCCESS (1.687s)
[533.586042] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.687s)
[534.454197] [112/131] (493s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[534.556286] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[535.248232] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.692s)
[535.422999] [113/131] (492s left) kms_plane_scaling (plane-downscale-factor-0-5-with-pixel-format)
[535.515663] Starting subtest: plane-downscale-factor-0-5-with-pixel-format
[535.517425] Starting dynamic subtest: pipe-A
[535.521647] Dynamic subtest pipe-A: SKIP (0.004s)
[535.530935] Starting dynamic subtest: pipe-B
[535.537701] Dynamic subtest pipe-B: SKIP (0.016s)
[535.547562] Starting dynamic subtest: pipe-C
[535.552336] Dynamic subtest pipe-C: SKIP (0.016s)
[535.560304] Starting dynamic subtest: pipe-D
[535.569468] Dynamic subtest pipe-D: SKIP (0.015s)
[535.571285] Subtest plane-downscale-factor-0-5-with-pixel-format: SKIP (0.053s)
[535.673985] [114/131] (492s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[535.764831] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[539.811154] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (4.048s)
[540.948422] [115/131] (486s left) kms_prop_blob (blob-prop-lifetime)
[541.000540] Starting subtest: blob-prop-lifetime
[541.001542] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[541.101090] [116/131] (486s left) i915_pm_rps (thresholds-idle)
[541.157233] Starting subtest: thresholds-idle
[541.159342] Subtest thresholds-idle: SKIP (0.000s)
[541.226920] [117/131] (486s left) i915_drm_fdinfo (busy-idle)
[541.259111] Starting subtest: busy-idle
[541.260040] Starting dynamic subtest: rcs0
[541.288716] Dynamic subtest rcs0: SKIP (0.028s)
[541.298187] Starting dynamic subtest: bcs0
[541.300246] Dynamic subtest bcs0: SKIP (0.000s)
[541.313153] Starting dynamic subtest: vcs0
[541.315733] Dynamic subtest vcs0: SKIP (0.000s)
[541.326012] Starting dynamic subtest: vcs1
[541.327813] Dynamic subtest vcs1: SKIP (0.000s)
[541.335556] Starting dynamic subtest: vecs0
[541.337310] Dynamic subtest vecs0: SKIP (0.000s)
[541.345051] Starting dynamic subtest: ccs0
[541.346877] Dynamic subtest ccs0: SKIP (0.000s)
[541.349079] Subtest busy-idle: SKIP (0.034s)
[541.377417] [118/131] (486s left) perf_pmu (busy-idle-check-all)
[541.412571] Starting subtest: busy-idle-check-all
[541.413475] Starting dynamic subtest: rcs0
[542.081359] Dynamic subtest rcs0: SUCCESS (0.668s)
[542.092625] Starting dynamic subtest: bcs0
[542.731895] Dynamic subtest bcs0: SUCCESS (0.649s)
[542.743107] Starting dynamic subtest: vcs0
[544.029357] Dynamic subtest vcs0: SUCCESS (1.292s)
[544.040572] Starting dynamic subtest: vcs1
[546.013269] Dynamic subtest vcs1: SUCCESS (1.982s)
[546.024310] Starting dynamic subtest: vecs0
[547.997100] Dynamic subtest vecs0: SUCCESS (1.982s)
[548.008255] Starting dynamic subtest: ccs0
[548.650245] Dynamic subtest ccs0: SUCCESS (0.654s)
[548.651371] Subtest busy-idle-check-all: SUCCESS (7.239s)
[548.751374] [119/131] (479s left) kms_plane_alpha_blend (coverage-7efc)
[548.849672] Starting subtest: coverage-7efc
[549.133421] Starting dynamic subtest: pipe-A-eDP-1
[549.717001] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.583s)
[549.740802] Starting dynamic subtest: pipe-D-eDP-1
[551.014284] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.281s)
[551.015364] Subtest coverage-7efc: SUCCESS (2.166s)
[551.894970] [120/131] (476s left) kms_cursor_crc (cursor-sliding-128x128)
[552.095857] Starting subtest: cursor-sliding-128x128
[552.099264] Starting dynamic subtest: pipe-A-eDP-1
[555.293754] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.195s)
[555.320078] Starting dynamic subtest: pipe-D-eDP-1
[559.189450] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.877s)
[559.190387] Subtest cursor-sliding-128x128: SUCCESS (7.095s)
[560.055697] [121/131] (468s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-plflip-blt)
[560.145796] Starting subtest: fbc-1p-primscrn-indfb-plflip-blt
[564.778603] Subtest fbc-1p-primscrn-indfb-plflip-blt: SUCCESS (4.634s)
[565.960464] [122/131] (462s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs)
[566.042935] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs
[566.043868] Starting dynamic subtest: pipe-A-eDP-1
[566.052263] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[566.060590] Starting dynamic subtest: pipe-B-eDP-1
[566.069030] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[566.076937] Starting dynamic subtest: pipe-C-eDP-1
[566.085084] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[566.092608] Starting dynamic subtest: pipe-D-eDP-1
[566.101005] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[566.102632] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.005s)
[568.204771] [123/131] (459s left) syncobj_timeline (device-signal-unordered)
[568.253359] Starting subtest: device-signal-unordered
[568.254275] Subtest device-signal-unordered: SUCCESS (0.000s)
[568.360944] [124/131] (459s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[568.456697] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[568.458368] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[568.547023] [125/131] (459s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt)
[568.641770] Starting subtest: fbcpsr-rgb565-draw-blt
[575.604869] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (6.965s)
[575.745721] [126/131] (452s left) kms_async_flips (async-flip-with-page-flip-events-tiled-atomic)
[575.832389] Starting subtest: async-flip-with-page-flip-events-tiled-atomic
[576.204604] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs
[578.942566] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.735s)
[578.953332] Starting dynamic subtest: pipe-A-eDP-1-4
[581.115742] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.172s)
[581.126347] Starting dynamic subtest: pipe-A-eDP-1-4
[583.125285] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.009s)
[583.136453] Starting dynamic subtest: pipe-A-eDP-1-x
[585.304452] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.179s)
[585.666550] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs
[588.468350] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.810s)
[588.479406] Starting dynamic subtest: pipe-B-eDP-1-4
[590.654974] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.183s)
[590.665495] Starting dynamic subtest: pipe-B-eDP-1-4
[592.665211] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.008s)
[592.676197] Starting dynamic subtest: pipe-B-eDP-1-x
[594.858197] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.190s)
[595.219546] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs
[597.999183] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.782s)
[598.010744] Starting dynamic subtest: pipe-C-eDP-1-4
[600.165246] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.164s)
[600.175922] Starting dynamic subtest: pipe-C-eDP-1-4
[602.174218] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s)
[602.184569] Starting dynamic subtest: pipe-C-eDP-1-x
[604.356288] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.179s)
[604.718970] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs
[607.541710] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.826s)
[607.553423] Starting dynamic subtest: pipe-D-eDP-1-4
[609.707409] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.163s)
[609.717603] Starting dynamic subtest: pipe-D-eDP-1-4
[611.716540] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s)
[611.727408] Starting dynamic subtest: pipe-D-eDP-1-x
[613.898626] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.179s)
[613.899952] Subtest async-flip-with-page-flip-events-tiled-atomic: SUCCESS (38.051s)
[615.128475] [127/131] (413s left) gem_mmap_wc (write-prefaulted)
[615.180809] Subtest write-prefaulted: SKIP (0.000s)
[615.237517] [128/131] (413s left) kms_big_fb (4-tiled-16bpp-rotate-270)
[615.327734] Starting subtest: 4-tiled-16bpp-rotate-270
[615.346867] Subtest 4-tiled-16bpp-rotate-270: SKIP (0.018s)
[615.444718] [129/131] (412s left) gem_exec_whisper (basic-normal-all)
[615.496180] Starting subtest: basic-normal-all
[617.603868] Subtest basic-normal-all: SUCCESS (2.105s)
[617.781212] [130/131] (410s left) kms_hdmi_inject (inject-audio)
[618.108334] Starting subtest: inject-audio
[618.363077] Subtest inject-audio: SUCCESS (0.257s)
[618.996880] [131/131] (409s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[619.095038] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt
[619.096986] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[619.207341] Closing watchdogs
results: parsing output: 0/ for test: gem_eio
results: parsing output: 1/ for test: kms_psr2_sf
results: parsing output: 2/ for test: prime_vgem
results: parsing output: 3/ for test: kms_pm_dc
results: parsing output: 4/ for test: syncobj_wait
results: parsing output: 5/ for test: prime_vgem
results: parsing output: 6/ for test: kms_flip_scaled_crc
results: parsing output: 7/ for test: gem_exec_params
results: parsing output: 8/ for test: kms_ccs
results: parsing output: 9/ for test: kms_cursor_legacy
results: parsing output: 10/ for test: api_intel_bb
results: parsing output: 11/ for test: kms_psr
results: parsing output: 12/ for test: kms_cursor_legacy
results: parsing output: 13/ for test: kms_psr
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_joiner
results: parsing output: 16/ for test: i915_pm_rc6_residency
results: parsing output: 17/ for test: kms_cursor_legacy
results: parsing output: 18/ for test: gem_eio
results: parsing output: 19/ for test: gem_lmem_swapping
results: parsing output: 20/ for test: gem_exec_gttfill
results: parsing output: 21/ for test: kms_addfb_basic
results: parsing output: 22/ for test: gem_render_copy
results: parsing output: 23/ for test: gem_exec_fence
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: syncobj_timeline
results: parsing output: 26/ for test: gem_spin_batch
results: parsing output: 27/ for test: perf_pmu
results: parsing output: 28/ for test: gem_exec_reloc
results: parsing output: 29/ for test: gem_exec_await
results: parsing output: 30/ for test: gem_reg_read
results: parsing output: 31/ for test: gem_render_copy_redux
results: parsing output: 32/ for test: vgem_basic
results: parsing output: 33/ for test: vgem_basic
results: parsing output: 34/ for test: kms_flip
results: parsing output: 35/ for test: gem_ctx_param
results: parsing output: 36/ for test: gem_mmap_wc
results: parsing output: 37/ for test: core_sysfs
results: parsing output: 38/ for test: gem_softpin
results: parsing output: 39/ for test: gem_pread
results: parsing output: 40/ for test: kms_busy
results: parsing output: 41/ for test: gem_exec_schedule
results: parsing output: 42/ for test: syncobj_timeline
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_sequence
results: parsing output: 45/ for test: vgem_basic
results: parsing output: 46/ for test: perf
results: parsing output: 47/ for test: kms_big_fb
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: gem_ctx_persistence
results: parsing output: 50/ for test: kms_plane_scaling
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: gem_mmap
results: parsing output: 53/ for test: syncobj_timeline
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: kms_ccs
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_dirtyfb
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: gem_exec_capture
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: sw_sync
results: parsing output: 62/ for test: gem_eio
results: parsing output: 63/ for test: gem_softpin
results: parsing output: 64/ for test: kms_chamelium_frames
results: parsing output: 65/ for test: kms_invalid_mode
results: parsing output: 66/ for test: kms_chamelium_edid
results: parsing output: 67/ for test: i915_fb_tiling
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: gem_caching
results: parsing output: 70/ for test: kms_tv_load_detect
results: parsing output: 71/ for test: gem_ctx_shared
results: parsing output: 72/ for test: kms_flip
results: parsing output: 73/ for test: gem_ctx_exec
results: parsing output: 74/ for test: dumb_buffer
results: parsing output: 75/ for test: kms_flip_scaled_crc
results: parsing output: 76/ for test: kms_ccs
results: parsing output: 77/ for test: syncobj_timeline
results: parsing output: 78/ for test: core_auth
results: parsing output: 79/ for test: kms_psr
results: parsing output: 80/ for test: gem_wait
results: parsing output: 81/ for test: kms_chamelium_hpd
results: parsing output: 82/ for test: kms_cursor_crc
results: parsing output: 83/ for test: gem_exec_balancer
results: parsing output: 84/ for test: kms_psr2_sf
results: parsing output: 85/ for test: kms_psr
results: parsing output: 86/ for test: kms_vblank
results: parsing output: 87/ for test: kms_pipe_crc_basic
results: parsing output: 88/ for test: gem_softpin
results: parsing output: 89/ for test: kms_ccs
results: parsing output: 90/ for test: kms_addfb_basic
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: syncobj_wait
results: parsing output: 93/ for test: gem_pxp
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_atomic_transition
results: parsing output: 96/ for test: kms_cursor_crc
results: parsing output: 97/ for test: kms_vblank
results: parsing output: 98/ for test: kms_big_fb
results: parsing output: 99/ for test: perf_pmu
results: parsing output: 100/ for test: gem_mmap_gtt
results: parsing output: 101/ for test: gem_exec_whisper
results: parsing output: 102/ for test: kms_cursor_legacy
results: parsing output: 103/ for test: kms_big_fb
results: parsing output: 104/ for test: gem_pwrite_snooped
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: gem_ccs
results: parsing output: 107/ for test: gem_ctx_param
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_rotation_crc
results: parsing output: 110/ for test: kms_psr
results: parsing output: 111/ for test: kms_big_fb
results: parsing output: 112/ for test: kms_plane_scaling
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_prop_blob
results: parsing output: 115/ for test: i915_pm_rps
results: parsing output: 116/ for test: i915_drm_fdinfo
results: parsing output: 117/ for test: perf_pmu
results: parsing output: 118/ for test: kms_plane_alpha_blend
results: parsing output: 119/ for test: kms_cursor_crc
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_ccs
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_async_flips
results: parsing output: 126/ for test: gem_mmap_wc
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: gem_exec_whisper
results: parsing output: 129/ for test: kms_hdmi_inject
results: parsing output: 130/ for test: kms_frontbuffer_tracking
Done.