[59.372166] Initializing watchdogs
[59.372283]   /dev/watchdog0
[59.388620] [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.393365] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.395833] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.398360] [001/133] (960s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-pwrite)
[59.494997] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-pwrite
[59.496927] Subtest psr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[59.595808] [002/133] (960s left) kms_pipe_crc_basic (hang-read-crc)
[59.688266] Starting subtest: hang-read-crc
[59.689199] Starting dynamic subtest: pipe-A-eDP-1
[61.867041] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.164s)
[61.874091] Starting dynamic subtest: pipe-B-eDP-1
[64.567815] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.688s)
[64.574827] Starting dynamic subtest: pipe-C-eDP-1
[67.277632] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.701s)
[67.285025] Starting dynamic subtest: pipe-D-eDP-1
[69.951134] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.666s)
[69.952100] Subtest hang-read-crc: SUCCESS (10.222s)
[70.771353] [003/133] (949s left) gen3_render_tiledx_blits
[70.881374] [004/133] (949s left) perf_pmu (busy-hang)
[70.920145] Starting subtest: busy-hang
[70.921118] Starting dynamic subtest: rcs0
[72.131290] Dynamic subtest rcs0: SUCCESS (1.206s)
[72.139916] Starting dynamic subtest: bcs0
[73.285788] Dynamic subtest bcs0: SUCCESS (1.148s)
[73.292627] Starting dynamic subtest: vcs0
[75.414291] Dynamic subtest vcs0: SUCCESS (2.131s)
[75.421118] Starting dynamic subtest: vcs1
[77.399050] Dynamic subtest vcs1: SUCCESS (1.984s)
[77.410714] Starting dynamic subtest: vecs0
[79.447772] Dynamic subtest vecs0: SUCCESS (2.045s)
[79.456880] Starting dynamic subtest: ccs0
[80.614734] Dynamic subtest ccs0: SUCCESS (1.167s)
[80.615829] Subtest busy-hang: SUCCESS (9.685s)
[80.703915] [005/133] (939s left) perf (invalid-oa-metric-set-id)
[80.828067] Starting subtest: invalid-oa-metric-set-id
[80.838346] Subtest invalid-oa-metric-set-id: SUCCESS (0.011s)
[80.879574] [006/133] (939s left) kms_content_protection (dp-mst-type-1)
[81.015050] Starting subtest: dp-mst-type-1
[81.017091] Subtest dp-mst-type-1: SKIP (0.000s)
[81.127599] [007/133] (938s left) gem_userptr_blits (unsync-overlap)
[81.193151] Subtest unsync-overlap: SKIP (0.000s)
[81.307448] [008/133] (938s left) gem_exec_fence (syncobj-timeline-repeat)
[81.879551] Starting subtest: syncobj-timeline-repeat
[82.141785] Subtest syncobj-timeline-repeat: SUCCESS (0.262s)
[82.942687] [FACT gem_exec_fence (syncobj-timeline-repeat)] new: kernel.kmod_is_loaded.vgem: true
[82.944841] [009/133] (937s left) sw_sync (sync_busy_fork)
[82.977573] Starting subtest: sync_busy_fork
[83.997621] Subtest sync_busy_fork: SUCCESS (1.011s)
[84.047807] [010/133] (936s left) kms_plane_scaling (planes-upscale-factor-0-25)
[84.149011] Starting subtest: planes-upscale-factor-0-25
[84.149959] Starting dynamic subtest: pipe-A
[84.211761] Dynamic subtest pipe-A: SUCCESS (0.063s)
[84.220799] Starting dynamic subtest: pipe-B
[85.321826] Dynamic subtest pipe-B: SUCCESS (1.109s)
[85.329236] Starting dynamic subtest: pipe-C
[86.435459] Dynamic subtest pipe-C: SUCCESS (1.112s)
[86.444809] Starting dynamic subtest: pipe-D
[87.570049] Dynamic subtest pipe-D: SUCCESS (1.134s)
[87.571632] Subtest planes-upscale-factor-0-25: SUCCESS (3.420s)
[88.728796] [011/133] (931s left) kms_atomic_interruptible (legacy-cursor)
[88.835243] Starting subtest: legacy-cursor
[88.836296] Starting dynamic subtest: pipe-A-eDP-1
[96.253167] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.415s)
[96.253985] Subtest legacy-cursor: SUCCESS (7.416s)
[97.088387] [012/133] (923s left) gem_create (create-ext-cpu-access-sanity-check)
[97.251523] Starting subtest: create-ext-cpu-access-sanity-check
[97.253418] Subtest create-ext-cpu-access-sanity-check: SKIP (0.001s)
[97.314211] [013/133] (922s left) kms_rotation_crc (sprite-rotation-270)
[97.416434] Starting subtest: sprite-rotation-270
[97.417970] Subtest sprite-rotation-270: SKIP (0.001s)
[97.483866] [014/133] (922s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[97.851888] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[98.696132] [015/133] (921s left) kms_plane_multiple (tiling-x)
[98.783986] Starting subtest: tiling-x
[98.784901] Starting dynamic subtest: pipe-A-eDP-1
[102.658753] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.873s)
[102.666145] Starting dynamic subtest: pipe-B-eDP-1
[107.002219] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.342s)
[107.009345] Starting dynamic subtest: pipe-C-eDP-1
[111.323493] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.320s)
[111.330803] Starting dynamic subtest: pipe-D-eDP-1
[115.642909] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.317s)
[115.643814] Subtest tiling-x: SUCCESS (16.856s)
[116.513410] [016/133] (903s left) syncobj_wait (invalid-reset-zero-handles)
[116.570335] Starting subtest: invalid-reset-zero-handles
[116.571247] Subtest invalid-reset-zero-handles: SUCCESS (0.000s)
[116.707976] [017/133] (903s left) gem_mmap_gtt (close-race)
[116.763929] Subtest close-race: SKIP (0.000s)
[116.851314] [018/133] (903s left) kms_frontbuffer_tracking (psr-1p-rte)
[116.946179] Starting subtest: psr-1p-rte
[122.393873] Subtest psr-1p-rte: SUCCESS (5.449s)
[122.522611] [019/133] (898s left) kms_ccs (random-ccs-data-y-tiled-gen12-mc-ccs)
[122.620388] Starting subtest: random-ccs-data-y-tiled-gen12-mc-ccs
[122.621245] Starting dynamic subtest: pipe-A-eDP-1
[122.631703] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[122.642403] Starting dynamic subtest: pipe-B-eDP-1
[122.652753] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[122.662427] Starting dynamic subtest: pipe-C-eDP-1
[122.671461] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[122.678105] Starting dynamic subtest: pipe-D-eDP-1
[122.687514] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[122.689182] Subtest random-ccs-data-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[124.873752] [020/133] (895s left) syncobj_wait (wait-zero-handles)
[124.922772] Starting subtest: wait-zero-handles
[124.923806] Subtest wait-zero-handles: SUCCESS (0.000s)
[125.019099] [021/133] (895s left) kms_big_fb (4-tiled-32bpp-rotate-270)
[125.125420] Starting subtest: 4-tiled-32bpp-rotate-270
[125.147188] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.020s)
[125.264656] [022/133] (895s left) kms_ccs (bad-pixel-format-y-tiled-gen12-mc-ccs)
[125.360558] Starting subtest: bad-pixel-format-y-tiled-gen12-mc-ccs
[125.361489] Starting dynamic subtest: pipe-A-eDP-1
[125.370290] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[125.378034] Starting dynamic subtest: pipe-B-eDP-1
[125.386590] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[125.393712] Starting dynamic subtest: pipe-C-eDP-1
[125.401899] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[125.408556] Starting dynamic subtest: pipe-D-eDP-1
[125.416774] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[125.418407] Subtest bad-pixel-format-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[127.534111] [023/133] (893s left) gem_exec_flush (basic-batch-kernel-default-uc)
[127.595755] Starting subtest: basic-batch-kernel-default-uc
[134.830075] Subtest basic-batch-kernel-default-uc: SUCCESS (7.233s)
[135.008314] [024/133] (885s left) gem_ctx_persistence (smoketest)
[135.076193] Starting subtest: smoketest
[173.827328] Subtest smoketest: SUCCESS (38.750s)
[173.924629] [025/133] (846s left) kms_chamelium_hpd (common-hpd-after-suspend)
[174.297204] Subtest common-hpd-after-suspend: SKIP (0.000s)
[175.130776] [026/133] (845s left) kms_big_fb (y-tiled-addfb)
[175.223643] Starting subtest: y-tiled-addfb
[175.225523] Subtest y-tiled-addfb: SKIP (0.000s)
[175.310929] [027/133] (845s left) gem_mmap_gtt (big-bo-tiledy)
[175.358291] Subtest big-bo-tiledY: SKIP (0.000s)
[175.408977] [028/133] (845s left) prime_mmap (test_dup)
[175.461039] Starting subtest: test_dup
[175.462074] Starting dynamic subtest: test_dup-smem
[175.492279] Dynamic subtest test_dup-smem: SUCCESS (0.032s)
[175.493469] Subtest test_dup: SUCCESS (0.033s)
[175.578821] [029/133] (845s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[175.650969] Starting subtest: etime-multi-wait-all-submitted-signaled
[175.774823] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.110s)
[175.873318] [030/133] (845s left) kms_flip (plain-flip-ts-check)
[175.969096] Starting subtest: plain-flip-ts-check
[175.969999] Starting dynamic subtest: A-eDP1
[184.883323] Dynamic subtest A-eDP1: SUCCESS (8.887s)
[184.892758] Starting dynamic subtest: B-eDP1
[193.724879] Dynamic subtest B-eDP1: SUCCESS (8.839s)
[193.734293] Starting dynamic subtest: C-eDP1
[202.553382] Dynamic subtest C-eDP1: SUCCESS (8.813s)
[202.566495] Starting dynamic subtest: D-eDP1
[211.390069] Dynamic subtest D-eDP1: SUCCESS (8.833s)
[211.390992] Subtest plain-flip-ts-check: SUCCESS (35.387s)
[212.527412] [031/133] (808s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc)
[212.622458] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc
[212.623377] Starting dynamic subtest: pipe-A-eDP-1
[212.632238] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[212.640041] Starting dynamic subtest: pipe-B-eDP-1
[212.648777] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[212.655966] Starting dynamic subtest: pipe-C-eDP-1
[212.663792] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[212.670849] Starting dynamic subtest: pipe-D-eDP-1
[212.678862] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[212.680428] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[214.874840] [032/133] (806s left) gem_mmap_gtt (big-copy)
[214.940861] Subtest big-copy: SKIP (0.000s)
[214.997534] [033/133] (806s left) api_intel_bb (lot-of-buffers)
[215.055654] Starting subtest: lot-of-buffers
[216.204482] Subtest lot-of-buffers: SUCCESS (1.141s)
[216.554568] [034/133] (804s left) kms_psr2_sf (fbc-pr-overlay-plane-update-continuous-sf)
[216.650652] Starting subtest: fbc-pr-overlay-plane-update-continuous-sf
[216.652408] Subtest fbc-pr-overlay-plane-update-continuous-sf: SKIP (0.000s)
[216.717615] [035/133] (804s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-onoff)
[216.812422] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-onoff
[223.940495] Subtest fbcpsr-1p-primscrn-spr-indfb-onoff: SUCCESS (7.128s)
[224.085155] [036/133] (797s left) prime_busy (before)
[224.145277] Starting subtest: before
[224.147428] Starting dynamic subtest: rcs0
[224.174047] Dynamic subtest rcs0: SUCCESS (0.027s)
[224.181254] Starting dynamic subtest: bcs0
[224.212574] Dynamic subtest bcs0: SUCCESS (0.038s)
[224.219375] Starting dynamic subtest: vcs0
[224.252442] Dynamic subtest vcs0: SUCCESS (0.039s)
[224.259385] Starting dynamic subtest: vcs1
[224.292395] Dynamic subtest vcs1: SUCCESS (0.039s)
[224.299119] Starting dynamic subtest: vecs0
[224.332782] Dynamic subtest vecs0: SUCCESS (0.040s)
[224.339617] Starting dynamic subtest: ccs0
[224.371801] Dynamic subtest ccs0: SUCCESS (0.038s)
[224.479030] Subtest before: SUCCESS (0.334s)
[224.544640] [037/133] (796s left) i915_pm_rps (thresholds-idle)
[224.596489] Starting subtest: thresholds-idle
[224.598186] Subtest thresholds-idle: SKIP (0.001s)
[224.687787] [038/133] (796s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-pwrite)
[224.781855] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-pwrite
[230.322015] Subtest fbc-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (5.541s)
[231.504779] [039/133] (789s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt)
[231.619852] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt
[239.010156] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.390s)
[239.121328] [040/133] (782s left) syncobj_basic (bad-destroy-pad)
[239.168098] Starting subtest: bad-destroy-pad
[239.175232] Subtest bad-destroy-pad: SUCCESS (0.000s)
[239.283628] [041/133] (782s left) gem_render_copy (mixed-tiled-to-yf-tiled-ccs)
[239.333171] Starting subtest: mixed-tiled-to-yf-tiled-ccs
[239.334867] Subtest mixed-tiled-to-yf-tiled-ccs: SKIP (0.000s)
[239.510714] [042/133] (781s left) kms_cursor_crc (cursor-rapid-movement-32x32)
[239.656987] Starting subtest: cursor-rapid-movement-32x32
[239.701040] Subtest cursor-rapid-movement-32x32: SKIP (0.042s)
[239.972113] [043/133] (781s left) gem_eio (unwedge-stress)
[240.197862] Starting subtest: unwedge-stress
[240.198820] Starting dynamic subtest: render
[245.135425] Dynamic subtest render: SUCCESS (4.937s)
[245.144073] Starting dynamic subtest: bsd1
[268.946652] Dynamic subtest bsd1: SUCCESS (23.809s)
[268.961386] Starting dynamic subtest: bsd2
[287.430364] Dynamic subtest bsd2: SUCCESS (18.480s)
[287.443320] Starting dynamic subtest: blt
[287.445178] Dynamic subtest blt: SKIP (0.000s)
[287.452133] Starting dynamic subtest: vebox
[305.419545] Dynamic subtest vebox: SUCCESS (17.988s)
[305.420403] Subtest unwedge-stress: SUCCESS (65.218s)
[306.936863] [044/133] (714s left) kms_addfb_basic (bo-too-small)
[307.016056] Starting subtest: bo-too-small
[307.016850] Subtest bo-too-small: SUCCESS (0.000s)
[307.113902] [045/133] (714s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[307.195415] Starting subtest: primary-x-tiled-reflect-x-180
[314.339990] Subtest primary-x-tiled-reflect-x-180: SUCCESS (7.145s)
[315.495383] [046/133] (706s left) syncobj_wait (wait-all-for-submit-delayed-submit)
[315.547517] Starting subtest: wait-all-for-submit-delayed-submit
[315.650420] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.102s)
[315.734892] [047/133] (705s left) kms_color_pipeline (plane-ctm3x4-lut1d)
[315.827596] Starting subtest: plane-ctm3x4-lut1d
[315.974985] Starting dynamic subtest: pipe-A-plane-0
[316.141271] Dynamic subtest pipe-A-plane-0: SUCCESS (0.166s)
[316.149566] Starting dynamic subtest: pipe-A-plane-1
[316.297247] Dynamic subtest pipe-A-plane-1: SUCCESS (0.155s)
[316.306083] Starting dynamic subtest: pipe-A-plane-2
[316.485996] Dynamic subtest pipe-A-plane-2: SUCCESS (0.188s)
[317.734861] Starting dynamic subtest: pipe-B-plane-0
[317.923394] Dynamic subtest pipe-B-plane-0: SUCCESS (0.200s)
[317.931625] Starting dynamic subtest: pipe-B-plane-1
[318.089973] Dynamic subtest pipe-B-plane-1: SUCCESS (0.166s)
[318.097813] Starting dynamic subtest: pipe-B-plane-2
[318.278838] Dynamic subtest pipe-B-plane-2: SUCCESS (0.188s)
[319.442287] Starting dynamic subtest: pipe-C-plane-0
[319.590246] Dynamic subtest pipe-C-plane-0: SUCCESS (0.155s)
[319.598510] Starting dynamic subtest: pipe-C-plane-1
[319.734697] Dynamic subtest pipe-C-plane-1: SUCCESS (0.144s)
[319.742790] Starting dynamic subtest: pipe-C-plane-2
[319.879022] Dynamic subtest pipe-C-plane-2: SUCCESS (0.144s)
[321.085771] Starting dynamic subtest: pipe-D-plane-0
[321.217605] Dynamic subtest pipe-D-plane-0: SUCCESS (0.144s)
[321.233512] Starting dynamic subtest: pipe-D-plane-1
[321.361634] Dynamic subtest pipe-D-plane-1: SUCCESS (0.143s)
[321.369331] Starting dynamic subtest: pipe-D-plane-2
[321.506047] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s)
[321.795795] Subtest plane-ctm3x4-lut1d: SUCCESS (5.968s)
[322.656365] [048/133] (698s left) gem_exec_schedule (noreorder-priority)
[322.843526] Starting subtest: noreorder-priority
[322.844936] Starting dynamic subtest: rcs0
[323.985475] Dynamic subtest rcs0: SUCCESS (1.142s)
[323.997223] Starting dynamic subtest: vcs0
[325.929741] Dynamic subtest vcs0: SUCCESS (1.932s)
[325.940344] Starting dynamic subtest: vcs1
[327.875646] Dynamic subtest vcs1: SUCCESS (1.943s)
[327.885544] Starting dynamic subtest: vecs0
[329.880566] Dynamic subtest vecs0: SUCCESS (2.002s)
[329.890341] Starting dynamic subtest: ccs0
[331.019741] Dynamic subtest ccs0: SUCCESS (1.146s)
[331.021054] Subtest noreorder-priority: SUCCESS (8.177s)
[331.202306] [049/133] (690s left) kms_big_fb (linear-8bpp-rotate-0)
[331.297382] Starting subtest: linear-8bpp-rotate-0
[332.566709] Subtest linear-8bpp-rotate-0: SUCCESS (1.270s)
[332.686095] [050/133] (688s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs)
[332.769304] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs
[332.770153] Starting dynamic subtest: pipe-A-eDP-1
[333.698584] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.925s)
[333.708255] Starting dynamic subtest: pipe-B-eDP-1
[335.399697] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.701s)
[335.407555] Starting dynamic subtest: pipe-C-eDP-1
[336.880829] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.479s)
[336.888328] Starting dynamic subtest: pipe-D-eDP-1
[338.398727] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.517s)
[338.399642] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SUCCESS (5.627s)
[339.578332] [051/133] (682s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[339.680077] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[339.681964] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[339.788817] [052/133] (681s left) gem_pwrite (basic-self)
[339.827745] Subtest basic-self: SKIP (0.000s)
[339.887074] [053/133] (681s left) perf (disabled-read-error)
[339.973741] Starting subtest: disabled-read-error
[339.986811] Subtest disabled-read-error: SUCCESS (0.013s)
[340.023702] [054/133] (681s left) kms_plane (plane-position-hole-dpms)
[340.106544] Starting subtest: plane-position-hole-dpms
[340.645830] Starting dynamic subtest: pipe-A-plane-1
[343.091108] Dynamic subtest pipe-A-plane-1: SUCCESS (2.445s)
[343.098812] Starting dynamic subtest: pipe-A-plane-2
[345.539803] Dynamic subtest pipe-A-plane-2: SUCCESS (2.449s)
[345.547485] Starting dynamic subtest: pipe-A-plane-3
[347.919484] Dynamic subtest pipe-A-plane-3: SUCCESS (2.377s)
[347.929697] Starting dynamic subtest: pipe-A-plane-4
[350.298827] Dynamic subtest pipe-A-plane-4: SUCCESS (2.379s)
[350.306467] Starting dynamic subtest: pipe-A-plane-5
[350.324654] Dynamic subtest pipe-A-plane-5: SUCCESS (0.024s)
[351.547616] Starting dynamic subtest: pipe-B-plane-1
[353.991761] Dynamic subtest pipe-B-plane-1: SUCCESS (2.453s)
[354.000331] Starting dynamic subtest: pipe-B-plane-2
[356.409916] Dynamic subtest pipe-B-plane-2: SUCCESS (2.418s)
[356.417565] Starting dynamic subtest: pipe-B-plane-3
[358.796930] Dynamic subtest pipe-B-plane-3: SUCCESS (2.387s)
[358.804681] Starting dynamic subtest: pipe-B-plane-4
[361.146939] Dynamic subtest pipe-B-plane-4: SUCCESS (2.349s)
[361.154619] Starting dynamic subtest: pipe-B-plane-5
[361.171032] Dynamic subtest pipe-B-plane-5: SUCCESS (0.023s)
[361.172032] Subtest plane-position-hole-dpms: SUCCESS (21.064s)
[361.944069] [055/133] (659s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-onoff)
[362.041252] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-onoff
[362.043075] Subtest fbcpsr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[362.143831] [056/133] (659s left) gem_ctx_param (vm)
[362.196746] Starting subtest: vm
[362.238781] Subtest vm: SUCCESS (0.041s)
[362.362168] [057/133] (659s left) i915_pciid
[362.528812] [058/133] (659s left) gem_mmap_offset (clear)
[362.585018] Starting subtest: clear
[362.586157] Starting dynamic subtest: smem0
[387.368933] Dynamic subtest smem0: SUCCESS (24.778s)
[387.370044] Subtest clear: SUCCESS (24.779s)
[387.512893] [059/133] (634s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset)
[387.647121] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset
[387.658279] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset: SKIP (0.012s)
[387.749726] [060/133] (634s left) kms_psr (fbc-psr2-sprite-plane-move)
[387.833399] Starting subtest: fbc-psr2-sprite-plane-move
[387.834254] Starting dynamic subtest: eDP-1
[387.835866] Dynamic subtest eDP-1: SKIP (0.000s)
[387.837545] Subtest fbc-psr2-sprite-plane-move: SKIP (0.001s)
[387.917344] [061/133] (634s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-sf)
[388.010165] Starting subtest: fbc-psr2-overlay-plane-move-continuous-sf
[388.011028] Starting dynamic subtest: pipe-A-eDP-1
[388.110775] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s)
[388.120024] Starting dynamic subtest: pipe-B-eDP-1
[389.220202] Dynamic subtest pipe-B-eDP-1: SKIP (1.108s)
[389.222068] Subtest fbc-psr2-overlay-plane-move-continuous-sf: SKIP (1.211s)
[390.419025] [062/133] (631s left) kms_flip (flip-vs-rmfb)
[390.506287] Starting subtest: flip-vs-rmfb
[390.508549] Starting dynamic subtest: A-eDP1
[399.203226] Dynamic subtest A-eDP1: SUCCESS (8.695s)
[399.212785] Starting dynamic subtest: B-eDP1
[407.832208] Dynamic subtest B-eDP1: SUCCESS (8.627s)
[407.845621] Starting dynamic subtest: C-eDP1
[416.449811] Dynamic subtest C-eDP1: SUCCESS (8.615s)
[416.460058] Starting dynamic subtest: D-eDP1
[425.084984] Dynamic subtest D-eDP1: SUCCESS (8.632s)
[425.089247] Subtest flip-vs-rmfb: SUCCESS (34.582s)
[426.261245] [063/133] (595s left) kms_frontbuffer_tracking (fbc-1p-shrfb-fliptrack-mmap-gtt)
[426.357411] Starting subtest: fbc-1p-shrfb-fliptrack-mmap-gtt
[426.359113] Subtest fbc-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[426.447803] [064/133] (595s left) kms_draw_crc (draw-method-render)
[426.531476] Starting subtest: draw-method-render
[426.532401] Starting dynamic subtest: xrgb8888-untiled
[426.786572] Dynamic subtest xrgb8888-untiled: SUCCESS (0.256s)
[426.794648] Starting dynamic subtest: rgb565-untiled
[427.031100] Dynamic subtest rgb565-untiled: SUCCESS (0.244s)
[427.039575] Starting dynamic subtest: xrgb2101010-untiled
[427.242385] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.210s)
[427.252917] Starting dynamic subtest: xbgr16161616f-untiled
[427.486446] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.244s)
[427.495981] Starting dynamic subtest: xrgb8888-xtiled
[427.619819] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.132s)
[427.629133] Starting dynamic subtest: rgb565-xtiled
[427.730945] Dynamic subtest rgb565-xtiled: SUCCESS (0.109s)
[427.744836] Starting dynamic subtest: xrgb2101010-xtiled
[427.853210] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.121s)
[427.861384] Starting dynamic subtest: xbgr16161616f-xtiled
[427.986585] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.133s)
[427.995505] Starting dynamic subtest: xrgb8888-4tiled
[428.120341] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.132s)
[428.130143] Starting dynamic subtest: rgb565-4tiled
[428.253151] Dynamic subtest rgb565-4tiled: SUCCESS (0.131s)
[428.262262] Starting dynamic subtest: xrgb2101010-4tiled
[428.375451] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.121s)
[428.384210] Starting dynamic subtest: xbgr16161616f-4tiled
[428.508798] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.132s)
[428.509812] Subtest draw-method-render: SUCCESS (1.979s)
[428.598244] [065/133] (593s left) gem_lmem_swapping (massive-random)
[428.642368] Subtest massive-random: SKIP (0.000s)
[428.684112] [066/133] (593s left) kms_flip (flip-vs-suspend)
[428.765299] Starting subtest: flip-vs-suspend
[428.766208] Starting dynamic subtest: A-eDP1
[461.787720] Dynamic subtest A-eDP1: SUCCESS (4.351s)
[461.797885] Starting dynamic subtest: B-eDP1
[495.790271] Dynamic subtest B-eDP1: SUCCESS (4.186s)
[495.803349] Starting dynamic subtest: C-eDP1
[529.798837] Dynamic subtest C-eDP1: SUCCESS (4.142s)
[529.816312] Starting dynamic subtest: D-eDP1
[563.794497] Dynamic subtest D-eDP1: SUCCESS (4.199s)
[563.796807] Subtest flip-vs-suspend: SUCCESS (16.888s)
[571.026375] [067/133] (457s left) kms_vblank (ts-continuation-suspend)
[571.126853] Starting subtest: ts-continuation-suspend
[571.127974] Starting dynamic subtest: pipe-A-eDP-1
[588.054044] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.921s)
[588.064829] Starting dynamic subtest: pipe-D-eDP-1
[606.086765] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.593s)
[606.087615] Subtest ts-continuation-suspend: SUCCESS (4.518s)
[612.985849] [068/133] (421s left) gem_ringfill (engines-basic)
[618.410503] Starting subtest: engines-basic
[618.411734] Starting dynamic subtest: rcs0
[618.472586] Dynamic subtest rcs0: SUCCESS (0.061s)
[618.483080] Starting dynamic subtest: bcs0
[618.517650] Dynamic subtest bcs0: SUCCESS (0.044s)
[618.527999] Starting dynamic subtest: vcs0
[618.562942] Dynamic subtest vcs0: SUCCESS (0.043s)
[618.573063] Starting dynamic subtest: vcs1
[618.608683] Dynamic subtest vcs1: SUCCESS (0.043s)
[618.624931] Starting dynamic subtest: vecs0
[618.650690] Dynamic subtest vecs0: SUCCESS (0.040s)
[618.660383] Starting dynamic subtest: ccs0
[618.696928] Dynamic subtest ccs0: SUCCESS (0.044s)
[618.699480] Subtest engines-basic: SUCCESS (0.286s)
[618.770911] [069/133] (415s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[618.863187] Subtest addfb25-x-tiled-mismatch-legacy: SKIP (0.000s)
[618.947748] [070/133] (415s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-render)
[619.036954] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-render
[626.480120] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.405s)
[626.602757] [071/133] (407s left) gem_exec_balancer (bonded-sync)
[626.658813] Starting subtest: bonded-sync
[626.660608] Subtest bonded-sync: SKIP (0.000s)
[626.962507] [072/133] (407s left) gem_exec_parallel (contexts)
[627.022446] Starting subtest: contexts
[627.023401] Starting dynamic subtest: rcs0
[630.052596] Dynamic subtest rcs0: SUCCESS (3.012s)
[630.062883] Starting dynamic subtest: bcs0
[633.482269] Dynamic subtest bcs0: SUCCESS (3.420s)
[633.493210] Starting dynamic subtest: vcs0
[637.847998] Dynamic subtest vcs0: SUCCESS (4.358s)
[637.857074] Starting dynamic subtest: vcs1
[641.910508] Dynamic subtest vcs1: SUCCESS (4.058s)
[641.919192] Starting dynamic subtest: vecs0
[645.920068] Dynamic subtest vecs0: SUCCESS (4.005s)
[645.931715] Starting dynamic subtest: ccs0
[649.666765] Dynamic subtest ccs0: SUCCESS (3.746s)
[649.668080] Subtest contexts: SUCCESS (22.612s)
[649.846724] [073/133] (384s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs)
[649.938399] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs
[649.939364] Starting dynamic subtest: pipe-A-eDP-1
[649.948574] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[649.962296] Starting dynamic subtest: pipe-B-eDP-1
[649.970059] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[649.978787] Starting dynamic subtest: pipe-C-eDP-1
[649.985874] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[649.994660] Starting dynamic subtest: pipe-D-eDP-1
[650.001920] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[650.002773] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs: SUCCESS (0.009s)
[652.266730] [074/133] (382s left) kms_invalid_mode (bad-vsync-end)
[652.358012] Starting subtest: bad-vsync-end
[652.358834] Starting dynamic subtest: pipe-A-eDP-1
[652.643799] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[652.652895] Starting dynamic subtest: pipe-B-eDP-1
[652.653839] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[652.662272] Starting dynamic subtest: pipe-C-eDP-1
[652.663619] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[652.672042] Starting dynamic subtest: pipe-D-eDP-1
[652.673066] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[652.674049] Subtest bad-vsync-end: SUCCESS (0.290s)
[653.489703] [075/133] (381s left) gem_exec_reloc (basic-gtt-cpu-active)
[653.546716] Subtest basic-gtt-cpu-active: SKIP (0.000s)
[653.608151] [076/133] (381s left) gem_exec_capture (capture-recoverable)
[653.661871] Starting subtest: capture-recoverable
[653.664930] Subtest capture-recoverable: SUCCESS (0.003s)
[653.769309] [077/133] (381s left) i915_query (query-garbage)
[653.834950] Starting subtest: query-garbage
[653.836075] Subtest query-garbage: SUCCESS (0.000s)
[653.940604] [078/133] (380s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping)
[654.033486] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping
[654.063387] Starting dynamic subtest: pipe-A-plane-0
[654.496285] Dynamic subtest pipe-A-plane-0: SUCCESS (0.433s)
[654.506396] Starting dynamic subtest: pipe-A-plane-3
[654.752049] Dynamic subtest pipe-A-plane-3: SUCCESS (0.254s)
[655.881889] Starting dynamic subtest: pipe-B-plane-0
[656.305753] Dynamic subtest pipe-B-plane-0: SUCCESS (0.433s)
[656.315058] Starting dynamic subtest: pipe-B-plane-3
[656.561626] Dynamic subtest pipe-B-plane-3: SUCCESS (0.255s)
[656.874315] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping: SUCCESS (2.840s)
[657.745836] [079/133] (377s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[657.842391] Starting subtest: psr-farfromfence-mmap-gtt
[657.844058] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[657.930796] [080/133] (376s left) core_getversion (all-cards)
[657.962752] Starting subtest: all-cards
[657.972966] Subtest all-cards: SUCCESS (0.012s)
[658.008044] [081/133] (376s left) kms_flip (basic-flip-vs-wf_vblank)
[658.094546] Starting subtest: basic-flip-vs-wf_vblank
[658.095420] Starting dynamic subtest: A-eDP1
[659.996059] Dynamic subtest A-eDP1: SUCCESS (1.900s)
[660.007365] Starting dynamic subtest: B-eDP1
[661.928490] Dynamic subtest B-eDP1: SUCCESS (1.930s)
[661.938715] Starting dynamic subtest: C-eDP1
[663.865592] Dynamic subtest C-eDP1: SUCCESS (1.933s)
[663.877048] Starting dynamic subtest: D-eDP1
[665.800824] Dynamic subtest D-eDP1: SUCCESS (1.932s)
[665.804626] Subtest basic-flip-vs-wf_vblank: SUCCESS (7.709s)
[667.021129] [082/133] (367s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-fullscreen)
[667.119433] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-fullscreen
[667.121195] Subtest fbcpsr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[667.229335] [083/133] (367s left) gen9_exec_parse (allowed-single)
[667.285718] Subtest allowed-single: SKIP (0.000s)
[667.349004] [084/133] (367s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[667.445067] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt
[667.446805] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[667.555593] [085/133] (367s left) kms_big_fb (x-tiled-8bpp-rotate-180)
[667.654822] Starting subtest: x-tiled-8bpp-rotate-180
[668.869776] Subtest x-tiled-8bpp-rotate-180: SUCCESS (1.215s)
[668.988746] [086/133] (366s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs)
[669.072590] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs
[669.073506] Starting dynamic subtest: pipe-A-eDP-1
[669.081480] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[669.090797] Starting dynamic subtest: pipe-B-eDP-1
[669.098562] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[669.107599] Starting dynamic subtest: pipe-C-eDP-1
[669.115165] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[669.123824] Starting dynamic subtest: pipe-D-eDP-1
[669.131009] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[669.131888] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs: SUCCESS (0.008s)
[671.398131] [087/133] (363s left) gem_exec_whisper (basic-contexts-forked)
[671.461794] Starting subtest: basic-contexts-forked
[695.184550] Subtest basic-contexts-forked: SUCCESS (23.703s)
[695.362909] [088/133] (339s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[695.466645] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[696.457002] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (0.990s)
[696.592485] [089/133] (338s left) kms_setmode (invalid-clone-single-crtc-stealing)
[696.644977] Starting subtest: invalid-clone-single-crtc-stealing
[696.647684] Subtest invalid-clone-single-crtc-stealing: SKIP (0.000s)
[696.754442] [090/133] (338s left) kms_vblank (crtc-id)
[696.848307] Starting subtest: crtc-id
[696.849293] Starting dynamic subtest: pipe-A-eDP-1
[697.295685] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.446s)
[697.307690] Starting dynamic subtest: pipe-D-eDP-1
[698.410557] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.112s)
[698.411415] Subtest crtc-id: SUCCESS (1.562s)
[699.248082] [091/133] (336s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[699.342499] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[699.344248] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.000s)
[699.411645] [092/133] (335s left) kms_frontbuffer_tracking (fbc-tiling-4)
[699.500883] Starting subtest: fbc-tiling-4
[703.712202] Subtest fbc-tiling-4: SUCCESS (4.210s)
[704.864823] [093/133] (330s left) gem_softpin (evict-single-offset)
[704.916928] Starting subtest: evict-single-offset
[732.391022] Subtest evict-single-offset: SUCCESS (27.468s)
[732.469734] [094/133] (302s left) kms_pm_dc (dc5-retention-flops)
[733.647138] Starting subtest: dc5-retention-flops
[733.648827] Subtest dc5-retention-flops: SKIP (0.000s)
[733.729741] [095/133] (301s left) kms_cursor_legacy (cursorb-vs-flipb-legacy)
[733.845447] Starting subtest: cursorB-vs-flipB-legacy
[733.847254] Subtest cursorB-vs-flipB-legacy: SKIP (0.001s)
[733.982499] [096/133] (301s left) gem_ctx_param (set-priority-not-supported)
[734.030043] Starting subtest: set-priority-not-supported
[734.031652] Subtest set-priority-not-supported: SKIP (0.000s)
[734.102924] [097/133] (301s left) syncobj_timeline (multi-wait-all-available-submitted)
[734.162981] Starting subtest: multi-wait-all-available-submitted
[734.163965] Subtest multi-wait-all-available-submitted: SUCCESS (0.000s)
[734.276885] [098/133] (301s left) kms_prop_blob (basic)
[734.322406] Starting subtest: basic
[734.323290] Subtest basic: SUCCESS (0.000s)
[734.421339] [099/133] (301s left) kms_vrr (negative-basic)
[734.513751] Starting subtest: negative-basic
[734.516389] Starting dynamic subtest: pipe-A-eDP-1
[739.983272] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.421s)
[740.249027] Subtest negative-basic: SUCCESS (5.735s)
[741.085416] [100/133] (294s left) gen9_exec_parse (unaligned-jump)
[741.155517] Subtest unaligned-jump: SKIP (0.000s)
[741.214242] [101/133] (294s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-render)
[741.319925] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-render
[745.038498] Subtest fbc-1p-primscrn-spr-indfb-draw-render: SUCCESS (3.719s)
[746.189529] [102/133] (289s left) kms_psr (psr2-cursor-mmap-gtt)
[746.273428] Starting subtest: psr2-cursor-mmap-gtt
[746.274261] Starting dynamic subtest: eDP-1
[747.964685] Dynamic subtest eDP-1: SUCCESS (1.691s)
[747.965623] Subtest psr2-cursor-mmap-gtt: SUCCESS (1.692s)
[748.880030] [103/133] (286s left) gem_userptr_blits (sd-probe)
[748.947582] Starting subtest: sd-probe
[748.948639] Subtest sd-probe: SUCCESS (0.000s)
[749.061043] [104/133] (286s left) gem_exec_schedule (semaphore-user)
[749.123649] Starting subtest: semaphore-user
[749.180992] Subtest semaphore-user: SUCCESS (0.057s)
[750.464469] [105/133] (285s left) kms_psr (pr-cursor-plane-onoff)
[750.551379] Starting subtest: pr-cursor-plane-onoff
[750.553137] Subtest pr-cursor-plane-onoff: SKIP (0.000s)
[750.628481] [106/133] (285s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-onoff)
[750.709045] Starting subtest: fbc-2p-primscrn-cur-indfb-onoff
[750.711067] Subtest fbc-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[750.804898] [107/133] (285s left) kms_cursor_crc (cursor-offscreen-32x32)
[750.948257] Starting subtest: cursor-offscreen-32x32
[750.993764] Subtest cursor-offscreen-32x32: SKIP (0.044s)
[751.251664] [108/133] (284s left) kms_psr (fbc-pr-primary-page-flip)
[751.337834] Starting subtest: fbc-pr-primary-page-flip
[751.339635] Subtest fbc-pr-primary-page-flip: SKIP (0.000s)
[751.410391] [109/133] (284s left) i915_pm_rpm (sysfs-read)
[753.583125] Starting subtest: sysfs-read
[754.722109] Subtest sysfs-read: SUCCESS (1.150s)
[755.111037] [110/133] (280s left) kms_atomic_transition (plane-all-transition-fencing)
[755.206608] Starting subtest: plane-all-transition-fencing
[755.207557] Starting dynamic subtest: pipe-A-eDP-1
[757.703479] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.497s)
[758.022305] Starting dynamic subtest: pipe-B-eDP-1
[761.241604] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.232s)
[761.539143] Subtest plane-all-transition-fencing: SUCCESS (6.332s)
[762.353520] [111/133] (273s left) gem_userptr_blits (input-checking)
[762.415932] Starting subtest: input-checking
[762.417113] Subtest input-checking: SUCCESS (0.000s)
[762.540803] [112/133] (273s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[762.641283] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[762.643007] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[762.730912] [113/133] (273s left) syncobj_wait (wait-all-delayed-signal)
[762.793811] Starting subtest: wait-all-delayed-signal
[762.896372] Subtest wait-all-delayed-signal: SUCCESS (0.102s)
[762.981183] [114/133] (273s left) kms_scaling_modes (scaling-mode-none)
[763.068893] Starting subtest: scaling-mode-none
[763.069943] Starting dynamic subtest: pipe-A-eDP-1
[763.165284] Dynamic subtest pipe-A-eDP-1: SKIP (0.095s)
[763.176939] Starting dynamic subtest: pipe-B-eDP-1
[763.205790] Dynamic subtest pipe-B-eDP-1: SKIP (0.036s)
[763.215813] Starting dynamic subtest: pipe-C-eDP-1
[763.243386] Dynamic subtest pipe-C-eDP-1: SKIP (0.036s)
[763.253599] Starting dynamic subtest: pipe-D-eDP-1
[763.275640] Dynamic subtest pipe-D-eDP-1: SKIP (0.031s)
[763.277420] Subtest scaling-mode-none: SKIP (0.207s)
[763.400842] [115/133] (272s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[763.492525] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[763.494422] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[763.592495] [116/133] (272s left) kms_cursor_crc (cursor-sliding-64x64)
[763.775094] Starting subtest: cursor-sliding-64x64
[763.778775] Starting dynamic subtest: pipe-A-eDP-1
[766.984595] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.206s)
[767.022446] Starting dynamic subtest: pipe-D-eDP-1
[770.844107] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.835s)
[770.844912] Subtest cursor-sliding-64x64: SUCCESS (7.068s)
[771.709408] [117/133] (264s left) kms_psr (psr-dpms)
[771.804571] Starting subtest: psr-dpms
[771.805455] Starting dynamic subtest: eDP-1
[774.743312] Dynamic subtest eDP-1: SUCCESS (2.937s)
[774.744173] Subtest psr-dpms: SUCCESS (2.939s)
[775.626440] [118/133] (260s left) syncobj_eventfd (invalid-bad-flags)
[775.684511] Starting subtest: invalid-bad-flags
[775.685421] Subtest invalid-bad-flags: SUCCESS (0.000s)
[775.793117] [119/133] (260s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt)
[775.894801] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt
[775.896432] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[776.006332] [120/133] (260s left) api_intel_allocator (alloc-simple)
[776.064285] Starting subtest: alloc-simple
[776.065835] Subtest alloc-simple: SUCCESS (0.003s)
[776.191492] [121/133] (260s left) gem_ctx_shared (q-smoketest-all)
[776.245161] Starting subtest: Q-smoketest-all
[808.630338] Subtest Q-smoketest-all: SUCCESS (32.349s)
[810.386977] [122/133] (226s left) kms_cursor_legacy (short-busy-flip-before-cursor-toggle)
[810.524479] Starting subtest: short-busy-flip-before-cursor-toggle
[810.526801] Subtest short-busy-flip-before-cursor-toggle: SKIP (0.000s)
[810.661781] [123/133] (225s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner)
[810.748206] Starting subtest: switch-modeset-ultra-joiner-big-joiner
[810.749754] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s)
[810.817196] [124/133] (225s left) kms_atomic (plane-cursor-legacy)
[810.902024] Starting subtest: plane-cursor-legacy
[810.903184] Starting dynamic subtest: pipe-A-eDP-1
[811.277224] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.376s)
[811.278078] Subtest plane-cursor-legacy: SUCCESS (0.377s)
[812.145821] [125/133] (224s left) kms_atomic_transition (plane-toggle-modeset-transition)
[812.233535] Starting subtest: plane-toggle-modeset-transition
[812.234374] Starting dynamic subtest: pipe-A-eDP-1
[824.991767] Dynamic subtest pipe-A-eDP-1: SUCCESS (12.753s)
[825.003572] Starting dynamic subtest: pipe-B-eDP-1
[837.418865] Dynamic subtest pipe-B-eDP-1: SUCCESS (12.419s)
[837.419907] Subtest plane-toggle-modeset-transition: SUCCESS (25.178s)
[838.227775] [126/133] (198s left) fbdev (info)
[838.256704] Starting subtest: info
[838.257666] Subtest info: SUCCESS (0.000s)
[838.313330] [127/133] (198s left) syncobj_timeline (wait-all-for-submit-snapshot)
[838.377298] Starting subtest: wait-all-for-submit-snapshot
[838.459318] Subtest wait-all-for-submit-snapshot: SUCCESS (0.081s)
[838.533296] [128/133] (198s left) syncobj_timeline (multi-wait-available-unsubmitted-signaled)
[838.585324] Starting subtest: multi-wait-available-unsubmitted-signaled
[838.586246] Subtest multi-wait-available-unsubmitted-signaled: SUCCESS (0.000s)
[838.684678] [129/133] (197s left) syncobj_wait (wait-all-complex)
[838.740473] Starting subtest: wait-all-complex
[838.964653] Subtest wait-all-complex: SUCCESS (0.214s)
[839.029909] [130/133] (197s left) kms_rotation_crc (cursor-rotation-180)
[839.126530] Starting subtest: cursor-rotation-180
[840.606048] Subtest cursor-rotation-180: SUCCESS (1.481s)
[841.788781] [131/133] (194s left) kms_psr (fbc-pr-primary-blt)
[841.879420] Starting subtest: fbc-pr-primary-blt
[841.881093] Subtest fbc-pr-primary-blt: SKIP (0.000s)
[841.997531] [132/133] (194s left) gem_exec_params (readonly)
[842.170442] Starting subtest: readonly
[842.173849] Subtest readonly: SUCCESS (0.004s)
[842.453953] [133/133] (194s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[842.590613] Starting subtest: multi-wait-all-for-submit-unsubmitted
[842.696751] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.106s)
[842.777844] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_pipe_crc_basic
results: parsing output: 2/ for test: gen3_render_tiledx_blits
results: parsing output: 3/ for test: perf_pmu
results: parsing output: 4/ for test: perf
results: parsing output: 5/ for test: kms_content_protection
results: parsing output: 6/ for test: gem_userptr_blits
results: parsing output: 7/ for test: gem_exec_fence
results: parsing output: 8/ for test: sw_sync
results: parsing output: 9/ for test: kms_plane_scaling
results: parsing output: 10/ for test: kms_atomic_interruptible
results: parsing output: 11/ for test: gem_create
results: parsing output: 12/ for test: kms_rotation_crc
results: parsing output: 13/ for test: kms_chamelium_edid
results: parsing output: 14/ for test: kms_plane_multiple
results: parsing output: 15/ for test: syncobj_wait
results: parsing output: 16/ for test: gem_mmap_gtt
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: kms_ccs
results: parsing output: 19/ for test: syncobj_wait
results: parsing output: 20/ for test: kms_big_fb
results: parsing output: 21/ for test: kms_ccs
results: parsing output: 22/ for test: gem_exec_flush
results: parsing output: 23/ for test: gem_ctx_persistence
results: parsing output: 24/ for test: kms_chamelium_hpd
results: parsing output: 25/ for test: kms_big_fb
results: parsing output: 26/ for test: gem_mmap_gtt
results: parsing output: 27/ for test: prime_mmap
results: parsing output: 28/ for test: syncobj_timeline
results: parsing output: 29/ for test: kms_flip
results: parsing output: 30/ for test: kms_ccs
results: parsing output: 31/ for test: gem_mmap_gtt
results: parsing output: 32/ for test: api_intel_bb
results: parsing output: 33/ for test: kms_psr2_sf
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: prime_busy
results: parsing output: 36/ for test: i915_pm_rps
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: syncobj_basic
results: parsing output: 40/ for test: gem_render_copy
results: parsing output: 41/ for test: kms_cursor_crc
results: parsing output: 42/ for test: gem_eio
results: parsing output: 43/ for test: kms_addfb_basic
results: parsing output: 44/ for test: kms_rotation_crc
results: parsing output: 45/ for test: syncobj_wait
results: parsing output: 46/ for test: kms_color_pipeline
results: parsing output: 47/ for test: gem_exec_schedule
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: kms_ccs
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: gem_pwrite
results: parsing output: 52/ for test: perf
results: parsing output: 53/ for test: kms_plane
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: gem_ctx_param
results: parsing output: 56/ for test: i915_pciid
results: parsing output: 57/ for test: gem_mmap_offset
results: parsing output: 58/ for test: kms_flip
results: parsing output: 59/ for test: kms_psr
results: parsing output: 60/ for test: kms_psr2_sf
results: parsing output: 61/ for test: kms_flip
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_draw_crc
results: parsing output: 64/ for test: gem_lmem_swapping
results: parsing output: 65/ for test: kms_flip
results: parsing output: 66/ for test: kms_vblank
results: parsing output: 67/ for test: gem_ringfill
results: parsing output: 68/ for test: kms_addfb_basic
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_exec_balancer
results: parsing output: 71/ for test: gem_exec_parallel
results: parsing output: 72/ for test: kms_ccs
results: parsing output: 73/ for test: kms_invalid_mode
results: parsing output: 74/ for test: gem_exec_reloc
results: parsing output: 75/ for test: gem_exec_capture
results: parsing output: 76/ for test: i915_query
results: parsing output: 77/ for test: kms_plane
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: core_getversion
results: parsing output: 80/ for test: kms_flip
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: gen9_exec_parse
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_big_fb
results: parsing output: 85/ for test: kms_ccs
results: parsing output: 86/ for test: gem_exec_whisper
results: parsing output: 87/ for test: kms_big_fb
results: parsing output: 88/ for test: kms_setmode
results: parsing output: 89/ for test: kms_vblank
results: parsing output: 90/ for test: kms_flip_scaled_crc
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: gem_softpin
results: parsing output: 93/ for test: kms_pm_dc
results: parsing output: 94/ for test: kms_cursor_legacy
results: parsing output: 95/ for test: gem_ctx_param
results: parsing output: 96/ for test: syncobj_timeline
results: parsing output: 97/ for test: kms_prop_blob
results: parsing output: 98/ for test: kms_vrr
results: parsing output: 99/ for test: gen9_exec_parse
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_psr
results: parsing output: 102/ for test: gem_userptr_blits
results: parsing output: 103/ for test: gem_exec_schedule
results: parsing output: 104/ for test: kms_psr
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_cursor_crc
results: parsing output: 107/ for test: kms_psr
results: parsing output: 108/ for test: i915_pm_rpm
results: parsing output: 109/ for test: kms_atomic_transition
results: parsing output: 110/ for test: gem_userptr_blits
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: syncobj_wait
results: parsing output: 113/ for test: kms_scaling_modes
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: kms_cursor_crc
results: parsing output: 116/ for test: kms_psr
results: parsing output: 117/ for test: syncobj_eventfd
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: api_intel_allocator
results: parsing output: 120/ for test: gem_ctx_shared
results: parsing output: 121/ for test: kms_cursor_legacy
results: parsing output: 122/ for test: kms_joiner
results: parsing output: 123/ for test: kms_atomic
results: parsing output: 124/ for test: kms_atomic_transition
results: parsing output: 125/ for test: fbdev
results: parsing output: 126/ for test: syncobj_timeline
results: parsing output: 127/ for test: syncobj_timeline
results: parsing output: 128/ for test: syncobj_wait
results: parsing output: 129/ for test: kms_rotation_crc
results: parsing output: 130/ for test: kms_psr
results: parsing output: 131/ for test: gem_exec_params
results: parsing output: 132/ for test: syncobj_wait
Done.