[58.051555] Initializing watchdogs
[58.051621]   /dev/watchdog0
[58.066252] [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]
[58.070527] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.072678] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.076057] [001/133] (960s left) gem_ctx_persistence (processes)
[58.177266] Starting subtest: processes
[59.955644] Subtest processes: SUCCESS (1.766s)
[60.060017] [002/133] (958s left) kms_psr (psr-cursor-plane-move)
[60.164727] Starting subtest: psr-cursor-plane-move
[60.166906] Starting dynamic subtest: eDP-1
[61.852685] Dynamic subtest eDP-1: SUCCESS (1.677s)
[61.855023] Subtest psr-cursor-plane-move: SUCCESS (1.678s)
[62.752342] [003/133] (955s left) gem_lmem_swapping (basic)
[62.792102] Subtest basic: SKIP (0.000s)
[62.837502] [004/133] (955s left) kms_dp_aux_dev
[63.208732] [005/133] (955s left) gem_exec_reloc (basic-wc)
[63.276003] Subtest basic-wc: SKIP (0.000s)
[63.352116] [006/133] (955s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions)
[63.478586] Starting subtest: flip-vs-cursor-atomic-transitions
[71.133339] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (7.634s)
[72.010236] [007/133] (946s left) prime_vgem (fence-flip-hang)
[72.115370] Subtest fence-flip-hang: SKIP (0.000s)
[72.244646] [FACT prime_vgem (fence-flip-hang)] new: kernel.kmod_is_loaded.vgem: true
[72.247648] [008/133] (946s left) kms_frontbuffer_tracking (fbc-abgr161616f-draw-blt)
[72.341505] Starting subtest: fbc-abgr161616f-draw-blt
[72.346037] Subtest fbc-abgr161616f-draw-blt: SKIP (0.000s)
[72.478572] [009/133] (946s left) kms_rotation_crc (primary-rotation-180)
[72.584121] Starting subtest: primary-rotation-180
[79.613584] Subtest primary-rotation-180: SUCCESS (7.024s)
[80.886052] [010/133] (938s left) kms_properties (connector-properties-legacy)
[80.989472] Starting subtest: connector-properties-legacy
[80.991753] Starting dynamic subtest: pipe-A-eDP-1
[88.978841] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.983s)
[88.988284] Starting dynamic subtest: pipe-None-DP-1
[88.992695] Dynamic subtest pipe-None-DP-1: SUCCESS (0.001s)
[89.000106] Starting dynamic subtest: pipe-None-HDMI-A-1
[89.004090] Dynamic subtest pipe-None-HDMI-A-1: SUCCESS (0.001s)
[89.012136] Starting dynamic subtest: pipe-None-DP-2
[89.016422] Dynamic subtest pipe-None-DP-2: SUCCESS (0.002s)
[89.024783] Starting dynamic subtest: pipe-None-HDMI-A-2
[89.029197] Dynamic subtest pipe-None-HDMI-A-2: SUCCESS (0.001s)
[89.036593] Starting dynamic subtest: pipe-None-DP-3
[89.041055] Dynamic subtest pipe-None-DP-3: SUCCESS (0.001s)
[89.048570] Starting dynamic subtest: pipe-None-DP-4
[89.053026] Dynamic subtest pipe-None-DP-4: SUCCESS (0.001s)
[89.055245] Subtest connector-properties-legacy: SUCCESS (7.995s)
[89.863568] [011/133] (929s left) syncobj_eventfd (timeline-wait-signaled)
[89.921188] Starting subtest: timeline-wait-signaled
[89.923279] Subtest timeline-wait-signaled: SUCCESS (0.000s)
[90.045489] [012/133] (928s left) syncobj_timeline (single-wait-all-available-signaled)
[90.099865] Starting subtest: single-wait-all-available-signaled
[90.102204] Subtest single-wait-all-available-signaled: SUCCESS (0.000s)
[90.232190] [013/133] (928s left) gem_exec_create (basic)
[90.301318] Starting subtest: basic
[90.303685] Starting dynamic subtest: smem
[93.915706] Dynamic subtest smem: SUCCESS (3.610s)
[93.918478] Subtest basic: SUCCESS (3.611s)
[94.125741] [014/133] (924s left) kms_prop_blob (blob-prop-validate)
[94.182706] Starting subtest: blob-prop-validate
[94.184937] Subtest blob-prop-validate: SUCCESS (0.000s)
[94.305271] [015/133] (924s left) gem_exec_reloc (basic-wc-cpu)
[94.366054] Subtest basic-wc-cpu: SKIP (0.000s)
[94.449881] [016/133] (924s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-onoff)
[94.561089] Starting subtest: fbc-2p-scndscrn-cur-indfb-onoff
[94.565511] Subtest fbc-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[94.689173] [017/133] (924s left) core_getclient (basic)
[94.741538] Starting subtest: basic
[94.743604] Subtest basic: SUCCESS (0.000s)
[94.871184] [018/133] (924s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-render)
[94.969569] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-render
[98.670913] Subtest fbc-1p-primscrn-cur-indfb-draw-render: SUCCESS (3.703s)
[99.884820] [019/133] (919s left) gem_create (create-ext-placement-all)
[100.061121] Starting subtest: create-ext-placement-all
[100.063160] Subtest create-ext-placement-all: SUCCESS (0.000s)
[100.197489] [020/133] (919s left) fbdev (info)
[100.232064] Starting subtest: info
[100.234545] Subtest info: SUCCESS (0.000s)
[100.320821] [021/133] (919s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[100.420103] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[107.034830] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.614s)
[107.161838] [022/133] (912s left) kms_psr (fbc-psr2-suspend)
[107.258942] Starting subtest: fbc-psr2-suspend
[107.261280] Starting dynamic subtest: eDP-1
[107.265467] Dynamic subtest eDP-1: SKIP (0.000s)
[107.269629] Subtest fbc-psr2-suspend: SKIP (0.001s)
[107.356385] [023/133] (912s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs)
[107.450313] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs
[107.452608] Starting dynamic subtest: pipe-A-eDP-1
[107.512809] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[107.522598] Starting dynamic subtest: pipe-B-eDP-1
[107.580841] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[107.590628] Starting dynamic subtest: pipe-C-eDP-1
[107.649574] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[107.662254] Starting dynamic subtest: pipe-D-eDP-1
[107.721468] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[107.725722] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs: SKIP (0.007s)
[109.684386] [024/133] (909s left) prime_mmap (test_refcounting)
[109.740347] Starting subtest: test_refcounting
[109.742301] Starting dynamic subtest: test_refcounting-smem
[109.772208] Dynamic subtest test_refcounting-smem: SUCCESS (0.034s)
[109.774596] Subtest test_refcounting: SUCCESS (0.034s)
[109.914370] [025/133] (909s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render)
[110.016496] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render
[110.020566] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[110.146174] [026/133] (909s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180)
[110.245992] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180
[111.290978] Subtest x-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.046s)
[111.480099] [027/133] (908s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[111.577031] Starting subtest: plane-downscale-factor-0-75-with-rotation
[111.579034] Starting dynamic subtest: pipe-A
[111.819108] Dynamic subtest pipe-A: SUCCESS (0.242s)
[111.829594] Starting dynamic subtest: pipe-B
[113.169087] Dynamic subtest pipe-B: SUCCESS (1.349s)
[113.179530] Starting dynamic subtest: pipe-C
[114.479908] Dynamic subtest pipe-C: SUCCESS (1.310s)
[114.489503] Starting dynamic subtest: pipe-D
[115.804147] Dynamic subtest pipe-D: SUCCESS (1.323s)
[115.806510] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.226s)
[117.019618] [028/133] (902s left) i915_pm_rps (fence-order)
[117.089664] Starting subtest: fence-order
[120.056524] Subtest fence-order: SUCCESS (2.964s)
[120.210362] [029/133] (899s left) gem_mmap_gtt (basic)
[120.270667] Subtest basic: SKIP (0.000s)
[120.352292] [030/133] (899s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-downscaling)
[120.463937] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-downscaling
[120.466332] Starting dynamic subtest: pipe-A-default-mode
[121.658833] Dynamic subtest pipe-A-default-mode: SKIP (1.191s)
[121.663158] Subtest flip-64bpp-xtile-to-16bpp-xtile-downscaling: SKIP (1.192s)
[121.840882] [031/133] (897s left) gem_mmap_gtt (isolation)
[121.899436] Subtest isolation: SKIP (0.000s)
[121.968150] [032/133] (897s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[122.060849] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip
[122.065181] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[122.173082] [033/133] (897s left) kms_flip (plain-flip-fb-recreate)
[122.272923] Starting subtest: plain-flip-fb-recreate
[122.275217] Starting dynamic subtest: A-eDP1
[131.119925] Dynamic subtest A-eDP1: SUCCESS (8.845s)
[131.128864] Starting dynamic subtest: B-eDP1
[139.947404] Dynamic subtest B-eDP1: SUCCESS (8.825s)
[139.957176] Starting dynamic subtest: C-eDP1
[148.772686] Dynamic subtest C-eDP1: SUCCESS (8.824s)
[148.781930] Starting dynamic subtest: D-eDP1
[157.605176] Dynamic subtest D-eDP1: SUCCESS (8.831s)
[157.609142] Subtest plain-flip-fb-recreate: SUCCESS (35.334s)
[158.900334] [034/133] (861s left) kms_rotation_crc (primary-y-tiled-reflect-x-180)
[159.002069] Starting subtest: primary-y-tiled-reflect-x-180
[159.061733] Subtest primary-y-tiled-reflect-x-180: SKIP (0.059s)
[159.188876] [035/133] (860s left) gem_fenced_exec_thrash (2-spare-fences)
[159.249525] Subtest 2-spare-fences: SKIP (0.000s)
[159.325299] [036/133] (860s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[159.418282] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu
[159.422285] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[159.529480] [037/133] (860s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[159.593659] Starting subtest: x-tiled-to-vebox-y-tiled
[159.597592] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[159.795388] [038/133] (860s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[159.920128] Starting subtest: basic-flip-before-cursor-varying-size
[160.837765] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.915s)
[161.754891] [039/133] (858s left) kms_ccs (bad-rotation-90-4-tiled-mtl-mc-ccs)
[161.856273] Starting subtest: bad-rotation-90-4-tiled-mtl-mc-ccs
[161.858514] Starting dynamic subtest: pipe-A-eDP-1
[162.282108] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.428s)
[162.293690] Starting dynamic subtest: pipe-B-eDP-1
[162.314360] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.002s)
[162.323463] Starting dynamic subtest: pipe-C-eDP-1
[162.342616] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.004s)
[162.351509] Starting dynamic subtest: pipe-D-eDP-1
[162.371268] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.004s)
[162.373504] Subtest bad-rotation-90-4-tiled-mtl-mc-ccs: SUCCESS (0.441s)
[164.590070] [040/133] (855s left) kms_flip (dpms-off-confusion-interruptible)
[164.689710] Starting subtest: dpms-off-confusion-interruptible
[164.692051] Starting dynamic subtest: A-eDP1
[173.364856] Dynamic subtest A-eDP1: SUCCESS (8.674s)
[173.376242] Starting dynamic subtest: B-eDP1
[181.991826] Dynamic subtest B-eDP1: SUCCESS (8.626s)
[182.000984] Starting dynamic subtest: C-eDP1
[190.601179] Dynamic subtest C-eDP1: SUCCESS (8.607s)
[190.610059] Starting dynamic subtest: D-eDP1
[199.231285] Dynamic subtest D-eDP1: SUCCESS (8.627s)
[199.233777] Subtest dpms-off-confusion-interruptible: SUCCESS (34.543s)
[200.434874] [041/133] (819s left) gem_userptr_blits (mmap-offset-banned)
[200.506282] Starting subtest: mmap-offset-banned
[200.508650] Starting dynamic subtest: wb
[200.510881] Dynamic subtest wb: SUCCESS (0.000s)
[200.519883] Starting dynamic subtest: wc
[200.521814] Dynamic subtest wc: SUCCESS (0.000s)
[200.530085] Starting dynamic subtest: uc
[200.532049] Dynamic subtest uc: SUCCESS (0.000s)
[200.533860] Subtest mmap-offset-banned: SUCCESS (0.002s)
[200.659109] [042/133] (819s left) kms_psr (pr-primary-mmap-cpu)
[200.745107] Starting subtest: pr-primary-mmap-cpu
[200.749634] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[200.844143] [043/133] (819s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs-cc)
[200.947990] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs-cc
[200.949916] Starting dynamic subtest: pipe-A-eDP-1
[217.338384] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.606s)
[217.347698] Starting dynamic subtest: pipe-B-eDP-1
[234.335200] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.478s)
[234.345047] Starting dynamic subtest: pipe-C-eDP-1
[251.300799] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.337s)
[251.311454] Starting dynamic subtest: pipe-D-eDP-1
[268.288078] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.327s)
[268.291176] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs-cc: SUCCESS (8.753s)
[269.594364] [044/133] (750s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[269.664123] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[269.670089] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[269.879748] [045/133] (750s left) kms_pm_backlight (fade-with-dpms)
[269.978630] Starting subtest: fade-with-dpms
[272.107176] Starting dynamic subtest: eDP-1
[274.812774] Dynamic subtest eDP-1: SUCCESS (2.651s)
[274.815501] Subtest fade-with-dpms: SUCCESS (4.722s)
[275.689618] [046/133] (744s left) kms_cursor_legacy (flip-vs-cursor-crc-legacy)
[275.813096] Starting subtest: flip-vs-cursor-crc-legacy
[276.468924] Subtest flip-vs-cursor-crc-legacy: SUCCESS (0.647s)
[277.341992] [047/133] (743s left) gem_softpin (noreloc)
[277.416629] Starting subtest: noreloc
[282.907732] Subtest noreloc: SUCCESS (5.441s)
[283.039250] [048/133] (737s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted)
[283.090923] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[283.093391] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[283.204699] [049/133] (737s left) gen9_exec_parse (allowed-single)
[283.265052] Subtest allowed-single: SKIP (0.000s)
[283.347546] [050/133] (737s left) perf (global-sseu-config-invalid)
[283.487888] Starting subtest: global-sseu-config-invalid
[283.493064] Subtest global-sseu-config-invalid: SKIP (0.000s)
[283.536478] [051/133] (737s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[283.641996] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[290.958102] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.293s)
[291.138564] [052/133] (729s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180-hflip)
[291.243072] Starting subtest: linear-max-hw-stride-32bpp-rotate-180-hflip
[291.248518] Subtest linear-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[291.374967] [053/133] (729s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[291.483813] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[291.488982] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[291.622536] [054/133] (729s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[291.726656] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu
[298.307037] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.573s)
[298.466674] [055/133] (722s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[298.582992] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt
[298.587976] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[298.727929] [056/133] (722s left) kms_cursor_crc (cursor-onscreen-64x64)
[298.914706] Starting subtest: cursor-onscreen-64x64
[298.917467] Starting dynamic subtest: pipe-A-eDP-1
[301.013055] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.097s)
[301.044720] Starting dynamic subtest: pipe-D-eDP-1
[303.782983] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.746s)
[303.785795] Subtest cursor-onscreen-64x64: SUCCESS (4.870s)
[304.669143] [057/133] (716s left) gem_media_vme
[304.810930] [058/133] (716s left) i915_query (query-garbage)
[304.872695] Starting subtest: query-garbage
[304.875717] Subtest query-garbage: SUCCESS (0.000s)
[305.010554] [059/133] (716s left) kms_vblank (wait-busy)
[305.113078] Starting subtest: wait-busy
[305.115598] Starting dynamic subtest: pipe-A-eDP-1
[306.997092] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.885s)
[307.013921] Starting dynamic subtest: pipe-D-eDP-1
[309.616050] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.615s)
[309.619069] Subtest wait-busy: SUCCESS (4.504s)
[310.447889] [060/133] (710s left) syncobj_timeline (multi-wait-for-submit-available-submitted)
[310.501231] Starting subtest: multi-wait-for-submit-available-submitted
[310.503769] Subtest multi-wait-for-submit-available-submitted: SUCCESS (0.000s)
[310.636559] [061/133] (710s left) kms_sequence (queue-idle)
[310.727288] Starting subtest: queue-idle
[310.730014] Starting dynamic subtest: pipe-A-eDP-1
[312.534301] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.806s)
[312.544745] Starting dynamic subtest: pipe-B-eDP-1
[315.000676] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.466s)
[315.012803] Starting dynamic subtest: pipe-C-eDP-1
[317.517045] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.513s)
[317.529942] Starting dynamic subtest: pipe-D-eDP-1
[319.927788] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.410s)
[319.930690] Subtest queue-idle: SUCCESS (9.201s)
[320.767434] [062/133] (700s left) gem_flink_race (flink_close)
[320.807744] Starting subtest: flink_close
[325.909249] Subtest flink_close: SUCCESS (5.101s)
[326.022034] [063/133] (695s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[326.140632] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[326.145863] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[326.283563] [064/133] (695s left) kms_psr (fbc-pr-suspend)
[326.398410] Starting subtest: fbc-pr-suspend
[326.403678] Subtest fbc-pr-suspend: SKIP (0.000s)
[326.501557] [065/133] (694s left) kms_big_fb (y-tiled-addfb)
[326.628734] Starting subtest: y-tiled-addfb
[326.633954] Subtest y-tiled-addfb: SKIP (0.000s)
[326.777982] [066/133] (694s left) gem_exec_parallel (basic)
[326.855044] Starting subtest: basic
[326.857942] Starting dynamic subtest: rcs0
[328.592573] Dynamic subtest rcs0: SUCCESS (1.737s)
[328.605491] Starting dynamic subtest: bcs0
[330.378062] Dynamic subtest bcs0: SUCCESS (1.784s)
[330.390285] Starting dynamic subtest: vcs0
[332.238262] Dynamic subtest vcs0: SUCCESS (1.856s)
[332.251343] Starting dynamic subtest: vcs1
[334.202697] Dynamic subtest vcs1: SUCCESS (1.962s)
[334.216263] Starting dynamic subtest: vecs0
[336.248909] Dynamic subtest vecs0: SUCCESS (2.043s)
[336.260538] Starting dynamic subtest: ccs0
[338.087479] Dynamic subtest ccs0: SUCCESS (1.837s)
[338.090423] Subtest basic: SUCCESS (11.230s)
[338.301497] [067/133] (683s left) i915_pm_rps (thresholds-idle)
[338.372351] Starting subtest: thresholds-idle
[338.377978] Subtest thresholds-idle: SKIP (0.001s)
[338.525853] [068/133] (682s left) kms_plane (plane-position-hole-dpms)
[338.626491] Starting subtest: plane-position-hole-dpms
[339.161206] Starting dynamic subtest: pipe-A-plane-1
[341.562960] Dynamic subtest pipe-A-plane-1: SUCCESS (2.401s)
[341.575084] Starting dynamic subtest: pipe-A-plane-2
[343.989853] Dynamic subtest pipe-A-plane-2: SUCCESS (2.426s)
[344.000975] Starting dynamic subtest: pipe-A-plane-3
[346.358208] Dynamic subtest pipe-A-plane-3: SUCCESS (2.367s)
[346.368139] Starting dynamic subtest: pipe-A-plane-4
[348.709193] Dynamic subtest pipe-A-plane-4: SUCCESS (2.348s)
[348.720511] Starting dynamic subtest: pipe-A-plane-5
[348.735704] Dynamic subtest pipe-A-plane-5: SUCCESS (0.024s)
[349.875472] Starting dynamic subtest: pipe-B-plane-1
[352.227124] Dynamic subtest pipe-B-plane-1: SUCCESS (2.361s)
[352.240407] Starting dynamic subtest: pipe-B-plane-2
[354.586044] Dynamic subtest pipe-B-plane-2: SUCCESS (2.356s)
[354.601153] Starting dynamic subtest: pipe-B-plane-3
[356.954971] Dynamic subtest pipe-B-plane-3: SUCCESS (2.367s)
[356.965586] Starting dynamic subtest: pipe-B-plane-4
[359.302658] Dynamic subtest pipe-B-plane-4: SUCCESS (2.348s)
[359.313152] Starting dynamic subtest: pipe-B-plane-5
[359.329461] Dynamic subtest pipe-B-plane-5: SUCCESS (0.024s)
[359.331904] Subtest plane-position-hole-dpms: SUCCESS (20.695s)
[360.142771] [069/133] (661s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[365.180201] Starting subtest: pr-cursor-plane-move-continuous-sf
[365.186104] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.002s)
[366.066542] [070/133] (655s left) gem_exec_fence (submit)
[366.255014] Starting subtest: submit
[366.260021] Subtest submit: SKIP (0.000s)
[368.385111] [071/133] (653s left) kms_flip (2x-flip-vs-suspend-interruptible)
[368.475181] Starting subtest: 2x-flip-vs-suspend-interruptible
[368.487284] Subtest 2x-flip-vs-suspend-interruptible: SKIP (0.011s)
[368.586726] [072/133] (653s left) gem_ctx_shared (q-promotion)
[368.653693] Starting subtest: Q-promotion
[368.656760] Starting dynamic subtest: rcs0
[368.753492] Dynamic subtest rcs0: SUCCESS (0.099s)
[368.769959] Starting dynamic subtest: vcs0
[368.834734] Dynamic subtest vcs0: SUCCESS (0.080s)
[368.851846] Starting dynamic subtest: vcs1
[368.912530] Dynamic subtest vcs1: SUCCESS (0.078s)
[368.930282] Starting dynamic subtest: vecs0
[368.988788] Dynamic subtest vecs0: SUCCESS (0.075s)
[369.006190] Starting dynamic subtest: ccs0
[369.064155] Dynamic subtest ccs0: SUCCESS (0.075s)
[369.067381] Subtest Q-promotion: SUCCESS (0.411s)
[370.360099] [073/133] (651s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[370.470916] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip
[371.484806] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.015s)
[371.641649] [074/133] (650s left) gem_exec_schedule (preempt-queue-contexts)
[371.715825] Subtest preempt-queue-contexts: SKIP (0.000s)
[372.030731] [075/133] (649s left) kms_flip (2x-flip-vs-expired-vblank)
[372.131088] Starting subtest: 2x-flip-vs-expired-vblank
[372.142058] Subtest 2x-flip-vs-expired-vblank: SKIP (0.010s)
[372.248094] [076/133] (649s left) perf_pmu (busy-idle)
[372.291278] Starting subtest: busy-idle
[372.293843] Starting dynamic subtest: rcs0
[372.986262] Dynamic subtest rcs0: SUCCESS (0.697s)
[372.998072] Starting dynamic subtest: bcs0
[373.664533] Dynamic subtest bcs0: SUCCESS (0.675s)
[373.677851] Starting dynamic subtest: vcs0
[375.227992] Dynamic subtest vcs0: SUCCESS (1.560s)
[375.241426] Starting dynamic subtest: vcs1
[377.273490] Dynamic subtest vcs1: SUCCESS (2.043s)
[377.286838] Starting dynamic subtest: vecs0
[379.257436] Dynamic subtest vecs0: SUCCESS (1.981s)
[379.270753] Starting dynamic subtest: ccs0
[379.922159] Dynamic subtest ccs0: SUCCESS (0.663s)
[379.925157] Subtest busy-idle: SUCCESS (7.636s)
[380.062296] [077/133] (641s left) kms_chamelium_edid (hdmi-edid-stress-resolution-non-4k)
[380.460939] Subtest hdmi-edid-stress-resolution-non-4k: SKIP (0.000s)
[381.243655] [078/133] (640s left) gem_pxp (create-protected-buffer)
[381.371463] Starting subtest: create-protected-buffer
[381.374354] Subtest create-protected-buffer: SUCCESS (0.000s)
[381.516567] [079/133] (640s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc)
[381.607002] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc
[381.609153] Starting dynamic subtest: pipe-A-eDP-1
[382.351160] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.736s)
[382.360864] Starting dynamic subtest: pipe-B-eDP-1
[384.205713] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.853s)
[384.217032] Starting dynamic subtest: pipe-C-eDP-1
[386.027912] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.821s)
[386.038961] Starting dynamic subtest: pipe-D-eDP-1
[387.861456] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.832s)
[387.863776] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (6.247s)
[389.028014] [080/133] (632s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[389.129824] Starting subtest: addfb25-y-tiled-legacy
[389.131976] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[389.261446] [081/133] (632s left) kms_flip (dpms-vs-vblank-race)
[389.357089] Starting subtest: dpms-vs-vblank-race
[389.360031] Starting dynamic subtest: A-eDP1
[394.290678] Dynamic subtest A-eDP1: SUCCESS (4.933s)
[394.302225] Starting dynamic subtest: B-eDP1
[398.914008] Dynamic subtest B-eDP1: SUCCESS (4.623s)
[398.929691] Starting dynamic subtest: C-eDP1
[402.441668] Dynamic subtest C-eDP1: SUCCESS (3.524s)
[402.452684] Starting dynamic subtest: D-eDP1
[407.064671] Dynamic subtest D-eDP1: SUCCESS (4.623s)
[407.067340] Subtest dpms-vs-vblank-race: SUCCESS (17.712s)
[407.971973] [082/133] (614s left) kms_invalid_mode (bad-vtotal)
[408.078728] Starting subtest: bad-vtotal
[408.081177] Starting dynamic subtest: pipe-A-eDP-1
[408.369464] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.293s)
[408.380788] Starting dynamic subtest: pipe-B-eDP-1
[408.382946] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[408.393189] Starting dynamic subtest: pipe-C-eDP-1
[408.395989] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[408.406096] Starting dynamic subtest: pipe-D-eDP-1
[408.408750] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[408.411174] Subtest bad-vtotal: SUCCESS (0.299s)
[409.211857] [083/133] (612s left) i915_hangman (engine-engine-hang)
[409.281530] Starting subtest: engine-engine-hang
[409.283929] Starting dynamic subtest: rcs0
[411.224764] Dynamic subtest rcs0: SUCCESS (1.944s)
[411.238228] Starting dynamic subtest: bcs0
[413.143056] Dynamic subtest bcs0: SUCCESS (1.915s)
[413.156485] Starting dynamic subtest: vcs0
[414.230980] Dynamic subtest vcs0: SUCCESS (1.085s)
[414.244497] Starting dynamic subtest: vcs1
[416.215404] Dynamic subtest vcs1: SUCCESS (1.981s)
[416.231231] Starting dynamic subtest: vecs0
[418.199742] Dynamic subtest vecs0: SUCCESS (1.980s)
[418.213840] Starting dynamic subtest: ccs0
[420.184506] Dynamic subtest ccs0: SUCCESS (1.982s)
[420.187413] Subtest engine-engine-hang: SUCCESS (10.904s)
[420.291434] [084/133] (601s left) kms_addfb_basic (unused-handle)
[420.339766] Starting subtest: unused-handle
[420.341857] Subtest unused-handle: SUCCESS (0.000s)
[420.522235] [085/133] (601s left) core_auth (many-magics)
[420.588007] Starting subtest: many-magics
[421.343889] Subtest many-magics: SUCCESS (0.757s)
[421.600491] [086/133] (600s left) syncobj_wait (wait-zero-handles)
[421.658350] Starting subtest: wait-zero-handles
[421.661196] Subtest wait-zero-handles: SUCCESS (0.000s)
[421.792409] [087/133] (600s left) gen3_mixed_blits
[421.917403] [088/133] (600s left) gem_exec_whisper (basic-normal-all)
[421.979324] Starting subtest: basic-normal-all
[425.273692] Subtest basic-normal-all: SUCCESS (3.292s)
[425.480345] [089/133] (596s left) perf (mi-rpc)
[425.593554] Starting subtest: mi-rpc
[425.599166] Subtest mi-rpc: SKIP (0.000s)
[425.643920] [090/133] (596s left) kms_frontbuffer_tracking (fbcpsr-argb161616f-draw-mmap-gtt)
[425.747929] Starting subtest: fbcpsr-argb161616f-draw-mmap-gtt
[425.752981] Subtest fbcpsr-argb161616f-draw-mmap-gtt: SKIP (0.000s)
[425.891152] [091/133] (596s left) kms_chamelium_hpd (vga-hpd-after-suspend)
[426.280300] Subtest vga-hpd-after-suspend: SKIP (0.000s)
[427.089719] [092/133] (595s left) gem_ctx_exec (basic)
[427.145121] Starting subtest: basic
[427.150631] Subtest basic: SUCCESS (0.005s)
[427.278969] [093/133] (595s left) gem_reg_read (bad-register)
[427.335704] Starting subtest: bad-register
[427.338182] Subtest bad-register: SUCCESS (0.000s)
[427.462498] [094/133] (595s left) gem_eio (in-flight-10ms)
[427.704452] Starting subtest: in-flight-10ms
[436.443772] Subtest in-flight-10ms: SUCCESS (8.735s)
[436.650784] [095/133] (586s left) kms_big_fb (linear-16bpp-rotate-270)
[436.754713] Starting subtest: linear-16bpp-rotate-270
[436.773985] Subtest linear-16bpp-rotate-270: SKIP (0.019s)
[436.913716] [096/133] (585s left) syncobj_wait (multi-wait-submitted-signaled)
[436.984634] Starting subtest: multi-wait-submitted-signaled
[436.987414] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[437.113528] [097/133] (585s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted)
[437.174028] Starting subtest: etime-multi-wait-for-submit-unsubmitted
[437.277109] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.104s)
[437.378877] [098/133] (585s left) kms_atomic_transition (plane-all-transition)
[437.472908] Starting subtest: plane-all-transition
[437.475763] Starting dynamic subtest: pipe-A-eDP-1
[439.966331] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.495s)
[440.275928] Starting dynamic subtest: pipe-B-eDP-1
[443.545159] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.280s)
[443.855950] Subtest plane-all-transition: SUCCESS (6.384s)
[444.696826] [099/133] (578s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[444.806942] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[444.812000] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[444.945784] [100/133] (577s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-pwrite)
[445.042049] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-pwrite
[445.046185] Subtest fbc-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[445.172380] [101/133] (577s left) kms_psr2_sf (psr2-overlay-primary-update-sf-dmg-area)
[450.278838] Starting subtest: psr2-overlay-primary-update-sf-dmg-area
[450.280896] Starting dynamic subtest: pipe-A-eDP-1
[456.889422] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.608s)
[456.906729] Starting dynamic subtest: pipe-B-eDP-1
[463.554707] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.659s)
[463.557422] Subtest psr2-overlay-primary-update-sf-dmg-area: SUCCESS (13.272s)
[464.445869] [102/133] (558s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[464.551451] Starting subtest: nonblocking-crc-frame-sequence
[464.553451] Starting dynamic subtest: pipe-A-eDP-1
[465.287780] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.736s)
[465.299773] Starting dynamic subtest: pipe-B-eDP-1
[466.764858] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.476s)
[466.777037] Starting dynamic subtest: pipe-C-eDP-1
[468.127199] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.358s)
[468.147414] Starting dynamic subtest: pipe-D-eDP-1
[469.445992] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.319s)
[469.449073] Subtest nonblocking-crc-frame-sequence: SUCCESS (4.894s)
[470.290682] [103/133] (552s left) kms_color (ctm-0-25)
[470.380055] Starting subtest: ctm-0-25
[470.382766] Starting dynamic subtest: pipe-A-eDP-1
[473.895890] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.517s)
[473.906750] Starting dynamic subtest: pipe-B-eDP-1
[478.066190] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.168s)
[478.077095] Starting dynamic subtest: pipe-C-eDP-1
[482.023161] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.954s)
[482.034747] Starting dynamic subtest: pipe-D-eDP-1
[486.057475] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.034s)
[486.059967] Subtest ctm-0-25: SUCCESS (15.677s)
[486.914606] [104/133] (536s left) gem_spin_batch (resubmit)
[487.003106] Starting subtest: resubmit
[487.005494] Starting dynamic subtest: rcs0
[487.010992] Dynamic subtest rcs0: SUCCESS (0.011s)
[487.025508] Starting dynamic subtest: bcs0
[487.028086] Dynamic subtest bcs0: SUCCESS (0.003s)
[487.040488] Starting dynamic subtest: vcs0
[487.043186] Dynamic subtest vcs0: SUCCESS (0.002s)
[487.053621] Starting dynamic subtest: vcs1
[487.056168] Dynamic subtest vcs1: SUCCESS (0.002s)
[487.067072] Starting dynamic subtest: vecs0
[487.069880] Dynamic subtest vecs0: SUCCESS (0.002s)
[487.079982] Starting dynamic subtest: ccs0
[487.082966] Dynamic subtest ccs0: SUCCESS (0.003s)
[487.085634] Subtest resubmit: SUCCESS (0.029s)
[487.299000] [105/133] (535s left) kms_ccs (ccs-on-another-bo-y-tiled-ccs)
[487.393132] Starting subtest: ccs-on-another-bo-y-tiled-ccs
[487.395859] Starting dynamic subtest: pipe-A-eDP-1
[487.422979] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[487.434200] Starting dynamic subtest: pipe-B-eDP-1
[487.460562] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[487.471010] Starting dynamic subtest: pipe-C-eDP-1
[487.498183] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[487.509465] Starting dynamic subtest: pipe-D-eDP-1
[487.535707] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[487.540703] Subtest ccs-on-another-bo-y-tiled-ccs: SKIP (0.004s)
[489.570724] [106/133] (533s left) prime_vgem (sync)
[489.665178] Starting subtest: sync
[489.667702] Starting dynamic subtest: rcs0
[489.722096] Dynamic subtest rcs0: SUCCESS (0.058s)
[489.732541] Starting dynamic subtest: bcs0
[489.800775] Dynamic subtest bcs0: SUCCESS (0.078s)
[489.811098] Starting dynamic subtest: vcs0
[489.849625] Dynamic subtest vcs0: SUCCESS (0.048s)
[489.860054] Starting dynamic subtest: vcs1
[489.898068] Dynamic subtest vcs1: SUCCESS (0.047s)
[489.908641] Starting dynamic subtest: vecs0
[489.941710] Dynamic subtest vecs0: SUCCESS (0.043s)
[489.952787] Starting dynamic subtest: ccs0
[489.988199] Dynamic subtest ccs0: SUCCESS (0.046s)
[489.990738] Subtest sync: SUCCESS (0.325s)
[490.161871] [107/133] (533s left) gem_exec_flush (basic-wb-rw-before-default)
[490.228584] Starting subtest: basic-wb-rw-before-default
[495.732145] Subtest basic-wb-rw-before-default: SUCCESS (5.506s)
[495.946968] [108/133] (527s left) kms_concurrent (multi-plane-atomic-lowres)
[496.046565] Starting subtest: multi-plane-atomic-lowres
[496.049059] Starting dynamic subtest: pipe-A-eDP-1
[496.554993] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.505s)
[496.557965] Subtest multi-plane-atomic-lowres: SUCCESS (0.506s)
[497.394440] [109/133] (525s left) gem_exec_reloc (basic-write-gtt)
[497.452009] Subtest basic-write-gtt: SKIP (0.000s)
[497.543721] [110/133] (525s left) gem_exec_schedule (fairslice)
[497.616476] Starting subtest: fairslice
[497.618694] Starting dynamic subtest: rcs0
[499.628928] Dynamic subtest rcs0: SUCCESS (2.021s)
[499.640520] Starting dynamic subtest: bcs0
[501.647167] Dynamic subtest bcs0: SUCCESS (2.019s)
[501.657551] Starting dynamic subtest: vcs0
[503.668054] Dynamic subtest vcs0: SUCCESS (2.020s)
[503.679783] Starting dynamic subtest: vcs1
[505.689156] Dynamic subtest vcs1: SUCCESS (2.020s)
[505.700481] Starting dynamic subtest: vecs0
[507.713168] Dynamic subtest vecs0: SUCCESS (2.023s)
[507.724803] Starting dynamic subtest: ccs0
[509.739014] Dynamic subtest ccs0: SUCCESS (2.026s)
[509.742183] Subtest fairslice: SUCCESS (12.135s)
[510.064003] [111/133] (513s left) kms_pm_rpm (modeset-lpsp)
[511.598920] Starting subtest: modeset-lpsp
[513.070173] Subtest modeset-lpsp: SUCCESS (1.473s)
[513.217513] [112/133] (510s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[513.318790] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[520.131156] Subtest fbcpsr-rgb565-draw-mmap-wc: SUCCESS (6.815s)
[520.294327] [113/133] (503s left) gem_exec_balancer (individual)
[520.361523] Starting subtest: individual
[522.215811] Subtest individual: SUCCESS (1.855s)
[522.572376] [114/133] (500s left) syncobj_wait (multi-wait-submitted)
[522.631940] Starting subtest: multi-wait-submitted
[522.730806] Subtest multi-wait-submitted: SUCCESS (0.102s)
[522.837073] [115/133] (500s left) gem_exec_balancer (parallel-bb-first)
[523.103884] Starting subtest: parallel-bb-first
[524.035166] Subtest parallel-bb-first: SUCCESS (0.931s)
[525.246312] [116/133] (498s left) kms_invalid_mode (zero-hdisplay)
[525.347929] Starting subtest: zero-hdisplay
[525.350574] Starting dynamic subtest: pipe-A-eDP-1
[525.639789] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.296s)
[525.652191] Starting dynamic subtest: pipe-B-eDP-1
[525.655031] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[525.665788] Starting dynamic subtest: pipe-C-eDP-1
[525.668076] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[525.678422] Starting dynamic subtest: pipe-D-eDP-1
[525.682135] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[525.684852] Subtest zero-hdisplay: SUCCESS (0.301s)
[526.519820] [117/133] (497s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-pgflip-blt)
[526.633302] Starting subtest: psr-2p-primscrn-indfb-pgflip-blt
[526.638613] Subtest psr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[526.776555] [118/133] (496s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-blt)
[526.873421] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-blt
[526.878107] Subtest fbc-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[527.008491] [119/133] (496s left) kms_atomic (plane-primary-legacy)
[527.094453] Starting subtest: plane-primary-legacy
[527.096837] Starting dynamic subtest: pipe-A-eDP-1
[527.536787] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.443s)
[527.539775] Subtest plane-primary-legacy: SUCCESS (0.444s)
[528.364216] [120/133] (495s left) i915_drm_fdinfo (memory-info-purgeable)
[528.403213] Starting subtest: memory-info-purgeable
[528.406040] Starting dynamic subtest: smem0
[531.235467] Dynamic subtest smem0: SUCCESS (2.836s)
[531.238194] Subtest memory-info-purgeable: SUCCESS (2.837s)
[531.336443] [121/133] (492s left) gem_ctx_isolation (nonpriv-switch)
[531.413986] Starting subtest: nonpriv-switch
[531.416614] Starting dynamic subtest: rcs0
[531.794034] Dynamic subtest rcs0: SUCCESS (0.380s)
[531.805224] Starting dynamic subtest: bcs0
[532.208937] Dynamic subtest bcs0: SUCCESS (0.414s)
[532.220175] Starting dynamic subtest: vcs0
[532.600200] Dynamic subtest vcs0: SUCCESS (0.391s)
[532.613489] Starting dynamic subtest: vcs1
[534.616829] Dynamic subtest vcs1: SUCCESS (2.014s)
[534.629239] Starting dynamic subtest: vecs0
[536.579633] Dynamic subtest vecs0: SUCCESS (1.961s)
[536.591835] Starting dynamic subtest: ccs0
[538.614854] Dynamic subtest ccs0: SUCCESS (2.034s)
[538.617617] Subtest nonpriv-switch: SUCCESS (7.201s)
[538.900200] [122/133] (484s left) kms_cursor_crc (cursor-rapid-movement-128x128)
[539.120969] Starting subtest: cursor-rapid-movement-128x128
[539.124263] Starting dynamic subtest: pipe-A-eDP-1
[539.653592] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.530s)
[539.684848] Starting dynamic subtest: pipe-D-eDP-1
[540.862073] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.183s)
[540.865035] Subtest cursor-rapid-movement-128x128: SUCCESS (1.740s)
[541.725516] [123/133] (482s left) kms_cursor_crc (cursor-sliding-32x32)
[541.875012] Starting subtest: cursor-sliding-32x32
[541.922413] Subtest cursor-sliding-32x32: SKIP (0.042s)
[542.238458] [124/133] (481s left) kms_pipe_stress (stress-xrgb8888-xtiled)
[542.340964] Starting subtest: stress-xrgb8888-xtiled
[548.219180] Subtest stress-xrgb8888-xtiled: SUCCESS (5.878s)
[548.269399] [125/133] (475s left) kms_fb_coherency (memset-crc)
[548.369450] Starting subtest: memset-crc
[548.371328] Starting dynamic subtest: mmap-offset-wc
[548.745366] Dynamic subtest mmap-offset-wc: SUCCESS (0.376s)
[549.048095] Starting dynamic subtest: mmap-offset-uc
[555.049682] Dynamic subtest mmap-offset-uc: SUCCESS (6.009s)
[555.345664] Subtest memset-crc: SUCCESS (6.977s)
[556.214533] [126/133] (467s left) gem_close (basic)
[556.267524] Starting subtest: basic
[556.270012] Subtest basic: SUCCESS (0.000s)
[556.389551] [127/133] (467s left) kms_frontbuffer_tracking (psr-argb161616f-draw-mmap-cpu)
[556.489538] Starting subtest: psr-argb161616f-draw-mmap-cpu
[556.494195] Subtest psr-argb161616f-draw-mmap-cpu: SKIP (0.000s)
[556.632220] [128/133] (467s left) dmabuf (all-tests)
[556.673498] Starting subtest: all-tests
[556.675454] Starting dynamic subtest: sanitycheck
[556.872969] Dynamic subtest sanitycheck: SUCCESS (0.200s)
[556.887731] Starting dynamic subtest: dma_fence
[557.133892] Dynamic subtest dma_fence: SUCCESS (0.258s)
[557.148893] Starting dynamic subtest: dma_fence_chain
[565.417612] Dynamic subtest dma_fence_chain: SUCCESS (8.280s)
[565.432228] Starting dynamic subtest: dma_fence_unwrap
[565.562410] Dynamic subtest dma_fence_unwrap: SUCCESS (0.143s)
[565.577176] Starting dynamic subtest: dma_resv
[565.719966] Dynamic subtest dma_resv: SUCCESS (0.156s)
[565.723277] Subtest all-tests: SUCCESS (9.047s)
[565.812031] [129/133] (458s left) gem_exec_reloc (basic-cpu)
[565.879742] Subtest basic-cpu: SKIP (0.000s)
[565.967527] [130/133] (458s left) gem_exec_schedule (pi-common)
[566.158142] Starting subtest: pi-common
[566.160668] Starting dynamic subtest: rcs0
[566.190611] Dynamic subtest rcs0: SUCCESS (0.035s)
[566.204180] Starting dynamic subtest: bcs0
[566.222008] Dynamic subtest bcs0: SUCCESS (0.031s)
[566.232448] Starting dynamic subtest: vcs0
[566.256246] Dynamic subtest vcs0: SUCCESS (0.034s)
[566.269621] Starting dynamic subtest: vcs1
[566.287182] Dynamic subtest vcs1: SUCCESS (0.030s)
[566.300990] Starting dynamic subtest: vecs0
[566.317965] Dynamic subtest vecs0: SUCCESS (0.030s)
[566.331397] Starting dynamic subtest: ccs0
[566.349148] Dynamic subtest ccs0: SUCCESS (0.031s)
[566.352085] Subtest pi-common: SUCCESS (0.195s)
[566.608552] [131/133] (457s left) kms_psr (psr2-cursor-render)
[566.712571] Starting subtest: psr2-cursor-render
[566.715070] Starting dynamic subtest: eDP-1
[568.466505] Dynamic subtest eDP-1: SUCCESS (1.752s)
[568.468663] Subtest psr2-cursor-render: SUCCESS (1.753s)
[569.298072] [132/133] (455s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-msflip-blt)
[569.402154] Starting subtest: psr-2p-scndscrn-indfb-msflip-blt
[569.406522] Subtest psr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[569.553656] [133/133] (454s left) kms_atomic_interruptible (legacy-dpms)
[569.659440] Starting subtest: legacy-dpms
[569.662023] Starting dynamic subtest: pipe-A-eDP-1
[577.103385] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.442s)
[577.106092] Subtest legacy-dpms: SUCCESS (7.444s)
[577.941512] Closing watchdogs
results: parsing output: 0/ for test: gem_ctx_persistence
results: parsing output: 1/ for test: kms_psr
results: parsing output: 2/ for test: gem_lmem_swapping
results: parsing output: 3/ for test: kms_dp_aux_dev
results: parsing output: 4/ for test: gem_exec_reloc
results: parsing output: 5/ for test: kms_cursor_legacy
results: parsing output: 6/ for test: prime_vgem
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_rotation_crc
results: parsing output: 9/ for test: kms_properties
results: parsing output: 10/ for test: syncobj_eventfd
results: parsing output: 11/ for test: syncobj_timeline
results: parsing output: 12/ for test: gem_exec_create
results: parsing output: 13/ for test: kms_prop_blob
results: parsing output: 14/ for test: gem_exec_reloc
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: core_getclient
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: gem_create
results: parsing output: 19/ for test: fbdev
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: kms_psr
results: parsing output: 22/ for test: kms_ccs
results: parsing output: 23/ for test: prime_mmap
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_big_fb
results: parsing output: 26/ for test: kms_plane_scaling
results: parsing output: 27/ for test: i915_pm_rps
results: parsing output: 28/ for test: gem_mmap_gtt
results: parsing output: 29/ for test: kms_flip_scaled_crc
results: parsing output: 30/ for test: gem_mmap_gtt
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: kms_flip
results: parsing output: 33/ for test: kms_rotation_crc
results: parsing output: 34/ for test: gem_fenced_exec_thrash
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: gem_render_copy
results: parsing output: 37/ for test: kms_cursor_legacy
results: parsing output: 38/ for test: kms_ccs
results: parsing output: 39/ for test: kms_flip
results: parsing output: 40/ for test: gem_userptr_blits
results: parsing output: 41/ for test: kms_psr
results: parsing output: 42/ for test: kms_ccs
results: parsing output: 43/ for test: gem_render_copy
results: parsing output: 44/ for test: kms_pm_backlight
results: parsing output: 45/ for test: kms_cursor_legacy
results: parsing output: 46/ for test: gem_softpin
results: parsing output: 47/ for test: syncobj_timeline
results: parsing output: 48/ for test: gen9_exec_parse
results: parsing output: 49/ for test: perf
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: kms_big_fb
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_cursor_crc
results: parsing output: 56/ for test: gem_media_vme
results: parsing output: 57/ for test: i915_query
results: parsing output: 58/ for test: kms_vblank
results: parsing output: 59/ for test: syncobj_timeline
results: parsing output: 60/ for test: kms_sequence
results: parsing output: 61/ for test: gem_flink_race
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: kms_psr
results: parsing output: 64/ for test: kms_big_fb
results: parsing output: 65/ for test: gem_exec_parallel
results: parsing output: 66/ for test: i915_pm_rps
results: parsing output: 67/ for test: kms_plane
results: parsing output: 68/ for test: kms_psr2_sf
results: parsing output: 69/ for test: gem_exec_fence
results: parsing output: 70/ for test: kms_flip
results: parsing output: 71/ for test: gem_ctx_shared
results: parsing output: 72/ for test: kms_big_fb
results: parsing output: 73/ for test: gem_exec_schedule
results: parsing output: 74/ for test: kms_flip
results: parsing output: 75/ for test: perf_pmu
results: parsing output: 76/ for test: kms_chamelium_edid
results: parsing output: 77/ for test: gem_pxp
results: parsing output: 78/ for test: kms_ccs
results: parsing output: 79/ for test: kms_addfb_basic
results: parsing output: 80/ for test: kms_flip
results: parsing output: 81/ for test: kms_invalid_mode
results: parsing output: 82/ for test: i915_hangman
results: parsing output: 83/ for test: kms_addfb_basic
results: parsing output: 84/ for test: core_auth
results: parsing output: 85/ for test: syncobj_wait
results: parsing output: 86/ for test: gen3_mixed_blits
results: parsing output: 87/ for test: gem_exec_whisper
results: parsing output: 88/ for test: perf
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_chamelium_hpd
results: parsing output: 91/ for test: gem_ctx_exec
results: parsing output: 92/ for test: gem_reg_read
results: parsing output: 93/ for test: gem_eio
results: parsing output: 94/ for test: kms_big_fb
results: parsing output: 95/ for test: syncobj_wait
results: parsing output: 96/ for test: syncobj_timeline
results: parsing output: 97/ for test: kms_atomic_transition
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_psr2_sf
results: parsing output: 101/ for test: kms_pipe_crc_basic
results: parsing output: 102/ for test: kms_color
results: parsing output: 103/ for test: gem_spin_batch
results: parsing output: 104/ for test: kms_ccs
results: parsing output: 105/ for test: prime_vgem
results: parsing output: 106/ for test: gem_exec_flush
results: parsing output: 107/ for test: kms_concurrent
results: parsing output: 108/ for test: gem_exec_reloc
results: parsing output: 109/ for test: gem_exec_schedule
results: parsing output: 110/ for test: kms_pm_rpm
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: gem_exec_balancer
results: parsing output: 113/ for test: syncobj_wait
results: parsing output: 114/ for test: gem_exec_balancer
results: parsing output: 115/ for test: kms_invalid_mode
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_atomic
results: parsing output: 119/ for test: i915_drm_fdinfo
results: parsing output: 120/ for test: gem_ctx_isolation
results: parsing output: 121/ for test: kms_cursor_crc
results: parsing output: 122/ for test: kms_cursor_crc
results: parsing output: 123/ for test: kms_pipe_stress
results: parsing output: 124/ for test: kms_fb_coherency
results: parsing output: 125/ for test: gem_close
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: dmabuf
results: parsing output: 128/ for test: gem_exec_reloc
results: parsing output: 129/ for test: gem_exec_schedule
results: parsing output: 130/ for test: kms_psr
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: kms_atomic_interruptible
Done.