[57.946589] Initializing watchdogs
[57.946633]   /dev/watchdog0
[57.960898] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[57.965087] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.967481] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.971173] [001/132] (960s left) kms_ccs (crc-sprite-planes-basic-y-tiled-ccs)
[58.083679] Starting subtest: crc-sprite-planes-basic-y-tiled-ccs
[58.085779] Starting dynamic subtest: pipe-A-eDP-1
[58.141667] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[58.150315] Starting dynamic subtest: pipe-B-eDP-1
[58.207345] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[58.216307] Starting dynamic subtest: pipe-C-eDP-1
[58.273069] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[58.281150] Starting dynamic subtest: pipe-D-eDP-1
[58.338816] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[58.343177] Subtest crc-sprite-planes-basic-y-tiled-ccs: SKIP (0.007s)
[60.278675] [002/132] (958s left) sriov_basic (bind-unbind-vf)
[60.340370] Starting subtest: bind-unbind-vf
[60.342873] Starting dynamic subtest: vf-1
[60.425751] Dynamic subtest vf-1: FAIL (0.032s)
[60.434600] Starting dynamic subtest: vf-2
[60.507589] Dynamic subtest vf-2: FAIL (0.004s)
[60.517470] Starting dynamic subtest: vf-3
[60.592834] Dynamic subtest vf-3: FAIL (0.003s)
[60.601359] Starting dynamic subtest: vf-4
[60.674652] Dynamic subtest vf-4: FAIL (0.003s)
[60.683785] Starting dynamic subtest: vf-5
[60.757084] Dynamic subtest vf-5: FAIL (0.003s)
[60.766079] Starting dynamic subtest: vf-6
[60.840137] Dynamic subtest vf-6: FAIL (0.003s)
[60.848894] Starting dynamic subtest: vf-7
[60.922873] Dynamic subtest vf-7: FAIL (0.003s)
[60.931742] Starting dynamic subtest: vf-random
[61.003323] Dynamic subtest vf-random: FAIL (0.003s)
[61.012261] Starting dynamic subtest: vf-last
[61.085840] Dynamic subtest vf-last: FAIL (0.509s)
[61.088228] Subtest bind-unbind-vf: FAIL (0.568s)
[61.123267] [003/132] (957s left) gem_spin_batch (resubmit-all)
[61.185961] Starting subtest: resubmit-all
[61.188147] Starting dynamic subtest: rcs0
[61.197500] Dynamic subtest rcs0: SUCCESS (0.011s)
[61.206677] Starting dynamic subtest: bcs0
[61.208581] Dynamic subtest bcs0: SUCCESS (0.002s)
[61.216200] Starting dynamic subtest: vcs0
[61.217715] Dynamic subtest vcs0: SUCCESS (0.002s)
[61.224319] Starting dynamic subtest: vcs1
[61.225946] Dynamic subtest vcs1: SUCCESS (0.002s)
[61.232076] Starting dynamic subtest: vecs0
[61.233603] Dynamic subtest vecs0: SUCCESS (0.001s)
[61.239629] Starting dynamic subtest: ccs0
[61.241167] Dynamic subtest ccs0: SUCCESS (0.002s)
[61.242719] Subtest resubmit-all: SUCCESS (0.023s)
[62.998329] [004/132] (955s left) kms_cursor_crc (cursor-rapid-movement-128x128)
[63.204735] Starting subtest: cursor-rapid-movement-128x128
[63.207025] Starting dynamic subtest: pipe-A-eDP-1
[63.776538] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.564s)
[63.800687] Starting dynamic subtest: pipe-D-eDP-1
[64.992340] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.193s)
[64.994333] Subtest cursor-rapid-movement-128x128: SUCCESS (1.781s)
[65.861915] [005/132] (952s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[65.954261] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[65.958387] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[66.066059] [006/132] (952s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-upscaling)
[66.157688] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-upscaling
[66.160041] Starting dynamic subtest: pipe-A-default-mode
[66.450826] Dynamic subtest pipe-A-default-mode: SKIP (0.289s)
[66.455261] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-upscaling: SKIP (0.290s)
[67.309325] [007/132] (951s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[67.518843] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[67.529521] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.011s)
[67.739998] [008/132] (951s left) gem_mmap_offset (mmap-unmap)
[67.834075] Starting subtest: mmap-unmap
[67.836457] Starting dynamic subtest: smem0
[90.325973] Dynamic subtest smem0: SUCCESS (22.470s)
[90.328565] Subtest mmap-unmap: SUCCESS (22.470s)
[90.475983] [009/132] (928s left) prime_mmap (test_errors)
[90.542879] Starting subtest: test_errors
[90.545538] Starting dynamic subtest: test_errors-smem
[90.631233] Dynamic subtest test_errors-smem: SUCCESS (0.090s)
[90.634043] Subtest test_errors: SUCCESS (0.090s)
[90.773942] [010/132] (928s left) kms_psr (fbc-psr-cursor-blt)
[90.865962] Starting subtest: fbc-psr-cursor-blt
[90.867934] Starting dynamic subtest: eDP-1
[90.872128] Dynamic subtest eDP-1: SKIP (0.000s)
[90.876249] Subtest fbc-psr-cursor-blt: SKIP (0.000s)
[90.959972] [011/132] (927s left) fbdev (info)
[90.992721] Starting subtest: info
[90.995091] Subtest info: SUCCESS (0.000s)
[91.082938] [012/132] (927s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[91.187510] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip
[92.271639] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip: FAIL (0.485s)
[92.308060] [013/132] (926s left) kms_flip (plain-flip-ts-check-interruptible)
[92.415838] Starting subtest: plain-flip-ts-check-interruptible
[92.418280] Starting dynamic subtest: A-eDP1
[101.287590] Dynamic subtest A-eDP1: SUCCESS (8.867s)
[101.307173] Starting dynamic subtest: B-eDP1
[110.124236] Dynamic subtest B-eDP1: SUCCESS (8.833s)
[110.134103] Starting dynamic subtest: C-eDP1
[118.942190] Dynamic subtest C-eDP1: SUCCESS (8.816s)
[118.961666] Starting dynamic subtest: D-eDP1
[127.764790] Dynamic subtest D-eDP1: SUCCESS (8.820s)
[127.769636] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.347s)
[128.976383] [014/132] (890s left) i915_module_load (resize-bar)
[129.010645] Starting subtest: resize-bar
[129.017616] Subtest resize-bar: SKIP (0.006s)
[129.063670] [015/132] (889s left) gem_exec_params (invalid-bsd1-flag-on-render)
[129.120440] Starting subtest: invalid-bsd1-flag-on-render
[129.122658] Subtest invalid-bsd1-flag-on-render: SUCCESS (0.000s)
[129.244916] [016/132] (889s left) kms_pm_rpm (dpms-lpsp)
[131.072094] Starting subtest: dpms-lpsp
[131.428047] Subtest dpms-lpsp: SUCCESS (0.358s)
[131.536458] [017/132] (887s left) gem_mmap_wc (write-read)
[131.595599] Subtest write-read: SKIP (0.000s)
[131.653901] [018/132] (887s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[131.760693] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[131.765037] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[131.898767] [019/132] (887s left) kms_cursor_crc (cursor-random-128x42)
[132.105725] Starting subtest: cursor-random-128x42
[132.147963] Subtest cursor-random-128x42: SKIP (0.038s)
[132.371960] [020/132] (886s left) gem_ctx_param (invalid-get-engines)
[132.432345] Starting subtest: invalid-get-engines
[132.434616] Subtest invalid-get-engines: SUCCESS (0.001s)
[132.582208] [021/132] (886s left) gem_exec_reloc (basic-gtt-noreloc)
[132.645054] Subtest basic-gtt-noreloc: SKIP (0.000s)
[132.714581] [022/132] (886s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled)
[132.762551] Starting subtest: multi-wait-all-for-submit-available-signaled
[132.764185] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.000s)
[132.874481] [023/132] (886s left) kms_joiner (basic-force-ultra-joiner)
[132.974296] Starting subtest: basic-force-ultra-joiner
[132.977769] Subtest basic-force-ultra-joiner: SKIP (0.000s)
[133.063530] [024/132] (886s left) sysfs_preempt_timeout (invalid)
[133.135969] Starting subtest: invalid
[133.137907] Starting dynamic subtest: vecs0
[133.139562] Dynamic subtest vecs0: SUCCESS (0.000s)
[133.147996] Starting dynamic subtest: ccs0
[133.149553] Dynamic subtest ccs0: SUCCESS (0.000s)
[133.156024] Starting dynamic subtest: vcs0
[133.157552] Dynamic subtest vcs0: SUCCESS (0.000s)
[133.163768] Starting dynamic subtest: bcs0
[133.165323] Dynamic subtest bcs0: SUCCESS (0.000s)
[133.171534] Starting dynamic subtest: rcs0
[133.173092] Dynamic subtest rcs0: SUCCESS (0.000s)
[133.179367] Starting dynamic subtest: vcs1
[133.180987] Dynamic subtest vcs1: SUCCESS (0.000s)
[133.182532] Subtest invalid: SUCCESS (0.003s)
[133.268336] [025/132] (886s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-fully-sf)
[138.286442] Starting subtest: fbc-pr-cursor-plane-move-continuous-exceed-fully-sf
[138.291213] Subtest fbc-pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.002s)
[139.154765] [026/132] (880s left) kms_plane_multiple (2x-tiling-none)
[139.252922] Starting subtest: 2x-tiling-none
[139.257322] Subtest 2x-tiling-none: SKIP (0.000s)
[139.354081] [027/132] (880s left) i915_drm_fdinfo (busy-idle)
[139.389328] Starting subtest: busy-idle
[139.391198] Starting dynamic subtest: rcs0
[139.426991] Dynamic subtest rcs0: SKIP (0.037s)
[139.434580] Starting dynamic subtest: bcs0
[139.438625] Dynamic subtest bcs0: SKIP (0.000s)
[139.446065] Starting dynamic subtest: vcs0
[139.450260] Dynamic subtest vcs0: SKIP (0.000s)
[139.457161] Starting dynamic subtest: vcs1
[139.461191] Dynamic subtest vcs1: SKIP (0.000s)
[139.468077] Starting dynamic subtest: vecs0
[139.472075] Dynamic subtest vecs0: SKIP (0.000s)
[139.478960] Starting dynamic subtest: ccs0
[139.483085] Dynamic subtest ccs0: SKIP (0.000s)
[139.487705] Subtest busy-idle: SKIP (0.040s)
[139.525724] [028/132] (880s left) gem_mmap_wc (read-write-distinct)
[139.595376] Subtest read-write-distinct: SKIP (0.000s)
[139.660780] [029/132] (879s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt)
[139.763676] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt
[147.083250] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.322s)
[147.252660] [030/132] (872s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-move)
[147.358828] Starting subtest: fbc-2p-primscrn-spr-indfb-move
[147.363370] Subtest fbc-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[147.479466] [031/132] (872s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[147.588222] Starting subtest: 4-tiled-8bpp-rotate-270
[147.608577] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.020s)
[147.753133] [032/132] (871s left) gem_eio (wait-10ms)
[147.981495] Starting subtest: wait-10ms
[148.329057] Subtest wait-10ms: SUCCESS (0.349s)
[148.467039] [033/132] (871s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[148.534968] Starting subtest: map-fixed-invalidate-overlap
[148.538565] Subtest map-fixed-invalidate-overlap: SKIP (0.000s)
[148.696611] [034/132] (871s left) kms_rotation_crc (primary-rotation-180)
[148.791493] Starting subtest: primary-rotation-180
[155.767643] Subtest primary-rotation-180: SUCCESS (6.977s)
[156.931854] [035/132] (862s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[156.988976] Starting subtest: etime-multi-wait-all-submitted-signaled
[157.098083] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.109s)
[157.193724] [036/132] (862s left) gem_exec_balancer (full)
[157.264866] Starting subtest: full
[161.764609] Subtest full: SUCCESS (4.500s)
[162.109587] [037/132] (857s left) kms_flip (2x-flip-vs-dpms-on-nop-interruptible)
[162.211955] Starting subtest: 2x-flip-vs-dpms-on-nop-interruptible
[162.223188] Subtest 2x-flip-vs-dpms-on-nop-interruptible: SKIP (0.010s)
[162.318047] [038/132] (857s left) gem_bad_reloc (negative-reloc-bltcopy)
[162.385511] Subtest negative-reloc-bltcopy: SKIP (0.000s)
[162.457687] [039/132] (857s left) kms_ccs (crc-primary-basic-y-tiled-ccs)
[162.546850] Starting subtest: crc-primary-basic-y-tiled-ccs
[162.549074] Starting dynamic subtest: pipe-A-eDP-1
[162.571626] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[162.581994] Starting dynamic subtest: pipe-B-eDP-1
[162.602810] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[162.610429] Starting dynamic subtest: pipe-C-eDP-1
[162.631741] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[162.639539] Starting dynamic subtest: pipe-D-eDP-1
[162.661039] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[162.664983] Subtest crc-primary-basic-y-tiled-ccs: SKIP (0.004s)
[164.706298] [040/132] (855s left) gem_exec_fence (syncobj-repeat)
[165.171715] Starting subtest: syncobj-repeat
[165.350241] Subtest syncobj-repeat: SUCCESS (0.176s)
[167.022896] [FACT gem_exec_fence (syncobj-repeat)] new: kernel.kmod_is_loaded.vgem: true
[167.025948] [041/132] (853s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[167.126199] Starting subtest: y-tiled-32bpp-rotate-180
[167.130660] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[167.242278] [042/132] (852s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[167.356972] Starting subtest: flip-vs-cursor-legacy
[174.350745] Subtest flip-vs-cursor-legacy: SUCCESS (6.993s)
[175.239513] [043/132] (844s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[175.364517] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[175.368936] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[175.475528] [044/132] (844s left) syncobj_timeline (invalid-signal-illegal-handle)
[175.542302] Starting subtest: invalid-signal-illegal-handle
[175.544679] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[175.664734] [045/132] (844s left) prime_vgem (fence-read-hang)
[175.736436] Subtest fence-read-hang: SKIP (0.000s)
[175.859269] [046/132] (844s left) kms_plane_alpha_blend (constant-alpha-min)
[175.944693] Starting subtest: constant-alpha-min
[176.244263] Starting dynamic subtest: pipe-A-eDP-1
[176.969465] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.722s)
[176.979155] Starting dynamic subtest: pipe-D-eDP-1
[178.527951] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.555s)
[178.530407] Subtest constant-alpha-min: SUCCESS (2.581s)
[179.400937] [047/132] (840s left) kms_scaling_modes (scaling-mode-center)
[179.511034] Starting subtest: scaling-mode-center
[179.513359] Starting dynamic subtest: pipe-A-eDP-1
[179.608017] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.099s)
[179.618497] Starting dynamic subtest: pipe-B-eDP-1
[180.809711] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.200s)
[180.819750] Starting dynamic subtest: pipe-C-eDP-1
[181.930274] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.119s)
[181.939231] Starting dynamic subtest: pipe-D-eDP-1
[183.067479] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.136s)
[183.069761] Subtest scaling-mode-center: SUCCESS (3.559s)
[184.254616] [048/132] (836s left) kms_psr (psr-primary-mmap-cpu)
[184.360927] Starting subtest: psr-primary-mmap-cpu
[184.363196] Starting dynamic subtest: eDP-1
[186.123976] Dynamic subtest eDP-1: SUCCESS (1.764s)
[186.126210] Subtest psr-primary-mmap-cpu: SUCCESS (1.765s)
[187.014205] [049/132] (833s left) kms_cursor_legacy (cursorb-vs-flipa-varying-size)
[187.137545] Starting subtest: cursorB-vs-flipA-varying-size
[187.142518] Subtest cursorB-vs-flipA-varying-size: SKIP (0.001s)
[187.304288] [050/132] (833s left) gem_render_copy (yf-tiled-ccs-to-y-tiled-ccs)
[187.361623] Starting subtest: yf-tiled-ccs-to-y-tiled-ccs
[187.366174] Subtest yf-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s)
[187.568037] [051/132] (832s left) kms_frontbuffer_tracking (pipe-fbc-rte)
[187.671214] Starting subtest: pipe-fbc-rte
[187.677971] Starting dynamic subtest: pipe-B-eDP-1
[193.165785] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.498s)
[193.173080] Subtest pipe-fbc-rte: SUCCESS (5.500s)
[195.512404] [052/132] (824s left) gem_exec_schedule (wide)
[195.696540] Starting subtest: wide
[195.698946] Starting dynamic subtest: rcs0
[205.827034] Dynamic subtest rcs0: SUCCESS (10.128s)
[205.837749] Starting dynamic subtest: vcs0
[216.100139] Dynamic subtest vcs0: SUCCESS (10.272s)
[216.111286] Starting dynamic subtest: vcs1
[226.215259] Dynamic subtest vcs1: SUCCESS (10.113s)
[226.226831] Starting dynamic subtest: vecs0
[237.021576] Dynamic subtest vecs0: SUCCESS (10.805s)
[237.030994] Starting dynamic subtest: ccs0
[250.690448] Dynamic subtest ccs0: SUCCESS (13.667s)
[250.692892] Subtest wide: SUCCESS (54.989s)
[252.530177] [053/132] (768s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[252.638911] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[252.641269] Starting dynamic subtest: pipe-A-default-mode
[252.926494] Dynamic subtest pipe-A-default-mode: SKIP (0.287s)
[252.931141] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.288s)
[253.732115] [054/132] (766s left) kms_cursor_crc (cursor-alpha-transparent)
[253.828152] Starting subtest: cursor-alpha-transparent
[253.830139] Starting dynamic subtest: pipe-A-eDP-1
[254.438046] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.608s)
[254.448025] Starting dynamic subtest: pipe-D-eDP-1
[255.685574] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.247s)
[255.687700] Subtest cursor-alpha-transparent: SUCCESS (1.857s)
[256.508632] [055/132] (764s left) i915_pm_rps (basic-api)
[256.580714] Starting subtest: basic-api
[256.585085] Subtest basic-api: SKIP (0.001s)
[256.723169] [056/132] (763s left) syncobj_timeline (single-wait-all-available-signaled)
[256.780985] Starting subtest: single-wait-all-available-signaled
[256.783182] Subtest single-wait-all-available-signaled: SUCCESS (0.000s)
[256.915716] [057/132] (763s left) kms_psr (psr2-primary-mmap-gtt)
[257.027147] Starting subtest: psr2-primary-mmap-gtt
[257.029370] Starting dynamic subtest: eDP-1
[258.481485] Dynamic subtest eDP-1: SKIP (1.450s)
[258.486312] Subtest psr2-primary-mmap-gtt: SKIP (1.453s)
[258.679084] [058/132] (762s left) kms_cursor_legacy (nonblocking-modeset-vs-cursor-atomic)
[258.792460] Starting subtest: nonblocking-modeset-vs-cursor-atomic
[260.194629] Subtest nonblocking-modeset-vs-cursor-atomic: SUCCESS (1.404s)
[261.008112] [059/132] (759s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt)
[261.101851] Starting subtest: fbc-rgb101010-draw-blt
[265.712129] Subtest fbc-rgb101010-draw-blt: SUCCESS (4.611s)
[266.908304] [060/132] (753s left) kms_psr (fbc-pr-cursor-mmap-cpu)
[267.001080] Starting subtest: fbc-pr-cursor-mmap-cpu
[267.005399] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s)
[267.097979] [061/132] (753s left) kms_atomic_transition (plane-all-transition-fencing)
[267.199298] Starting subtest: plane-all-transition-fencing
[267.201582] Starting dynamic subtest: pipe-A-eDP-1
[269.697256] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.500s)
[270.008678] Starting dynamic subtest: pipe-B-eDP-1
[273.200277] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.205s)
[273.496193] Subtest plane-all-transition-fencing: SUCCESS (6.298s)
[274.350099] [062/132] (746s left) gem_exec_reloc (basic-cpu-read-active)
[274.426899] Subtest basic-cpu-read-active: SKIP (0.000s)
[274.493991] [063/132] (746s left) i915_pm_rps (waitboost)
[274.557090] Starting subtest: waitboost
[280.643302] Subtest waitboost: SUCCESS (6.089s)
[280.807402] [064/132] (740s left) kms_atomic (crtc-invalid-params)
[280.911907] Starting subtest: crtc-invalid-params
[280.914112] Starting dynamic subtest: pipe-A-eDP-1
[281.277704] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.365s)
[281.279946] Subtest crtc-invalid-params: SUCCESS (0.366s)
[282.185564] [065/132] (738s left) gem_workarounds (reset-context)
[282.252536] Starting subtest: reset-context
[282.430261] Subtest reset-context: SUCCESS (0.176s)
[282.570810] [066/132] (738s left) kms_psr (fbc-psr-primary-mmap-cpu)
[282.662325] Starting subtest: fbc-psr-primary-mmap-cpu
[282.664243] Starting dynamic subtest: eDP-1
[282.668281] Dynamic subtest eDP-1: SKIP (0.000s)
[282.672341] Subtest fbc-psr-primary-mmap-cpu: SKIP (0.001s)
[282.758497] [067/132] (738s left) gem_ctx_persistence (heartbeat-hang)
[282.814490] Starting subtest: heartbeat-hang
[282.819382] Subtest heartbeat-hang: SKIP (0.000s)
[282.954637] [068/132] (738s left) gem_exec_schedule (submit-golden-slice)
[283.017273] Starting subtest: submit-golden-slice
[283.019445] Starting dynamic subtest: rcs0
[283.050987] Dynamic subtest rcs0: SUCCESS (0.040s)
[283.060475] Starting dynamic subtest: bcs0
[283.113339] Dynamic subtest bcs0: SUCCESS (0.061s)
[283.124855] Starting dynamic subtest: vcs0
[283.161744] Dynamic subtest vcs0: SUCCESS (0.047s)
[283.170254] Starting dynamic subtest: vcs1
[283.196044] Dynamic subtest vcs1: SUCCESS (0.034s)
[283.204205] Starting dynamic subtest: vecs0
[283.228456] Dynamic subtest vecs0: SUCCESS (0.032s)
[283.236385] Starting dynamic subtest: ccs0
[283.268325] Dynamic subtest ccs0: SUCCESS (0.039s)
[283.270390] Subtest submit-golden-slice: SUCCESS (0.258s)
[285.016118] [069/132] (736s left) gem_pxp (create-regular-buffer)
[285.143036] Starting subtest: create-regular-buffer
[285.145355] Subtest create-regular-buffer: SUCCESS (0.000s)
[285.293662] [070/132] (735s left) kms_flip (2x-flip-vs-fences-interruptible)
[285.401318] Starting subtest: 2x-flip-vs-fences-interruptible
[285.405297] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.000s)
[285.568714] [071/132] (735s left) kms_cursor_crc (cursor-suspend)
[285.689875] Starting subtest: cursor-suspend
[285.692118] Starting dynamic subtest: pipe-A-eDP-1
[318.568283] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.820s)
[318.579539] Starting dynamic subtest: pipe-D-eDP-1
[352.578305] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.696s)
[352.581159] Subtest cursor-suspend: SUCCESS (10.519s)
[353.460352] [072/132] (667s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt)
[353.572615] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt
[358.131292] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (4.450s)
[359.311690] [073/132] (662s left) kms_big_fb (yf-tiled-32bpp-rotate-90)
[359.405863] Starting subtest: yf-tiled-32bpp-rotate-90
[359.411439] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s)
[359.520624] [074/132] (661s left) prime_vgem (basic-read)
[359.594149] Starting subtest: basic-read
[359.653803] Subtest basic-read: SKIP (0.059s)
[359.797201] [075/132] (661s left) kms_chamelium_frames (dp-crc-fast)
[360.187647] Subtest dp-crc-fast: SKIP (0.000s)
[361.000434] [076/132] (660s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[361.104217] Starting subtest: fbcpsr-indfb-scaledprimary
[366.977679] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.825s)
[367.154263] [077/132] (654s left) kms_frontbuffer_tracking (psr-modesetfrombusy)
[367.262542] Starting subtest: psr-modesetfrombusy
[373.377899] Subtest psr-modesetfrombusy: SUCCESS (6.094s)
[373.555249] [078/132] (648s left) gem_exec_schedule (implicit-boths)
[373.641483] Starting subtest: implicit-boths
[373.643995] Starting dynamic subtest: rcs0
[373.746753] Dynamic subtest rcs0: SUCCESS (0.116s)
[373.758145] Starting dynamic subtest: vcs0
[373.835786] Dynamic subtest vcs0: SUCCESS (0.088s)
[373.847422] Starting dynamic subtest: vcs1
[373.911467] Dynamic subtest vcs1: SUCCESS (0.074s)
[373.923666] Starting dynamic subtest: vecs0
[373.988243] Dynamic subtest vecs0: SUCCESS (0.076s)
[373.999852] Starting dynamic subtest: ccs0
[374.071272] Dynamic subtest ccs0: SUCCESS (0.082s)
[374.073340] Subtest implicit-boths: SUCCESS (0.441s)
[375.257872] [079/132] (646s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[375.369620] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[375.374999] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[375.490806] [080/132] (646s left) gem_ctx_sseu (mmap-args)
[375.546707] Subtest mmap-args: SKIP (0.000s)
[375.613989] [081/132] (646s left) perf_pmu (most-busy-check-all)
[375.657358] Starting subtest: most-busy-check-all
[375.659859] Starting dynamic subtest: rcs0
[377.097560] Dynamic subtest rcs0: SUCCESS (1.439s)
[377.109063] Starting dynamic subtest: bcs0
[379.144979] Dynamic subtest bcs0: SUCCESS (2.041s)
[379.159009] Starting dynamic subtest: vcs0
[381.128640] Dynamic subtest vcs0: SUCCESS (1.978s)
[381.142096] Starting dynamic subtest: vcs1
[383.176673] Dynamic subtest vcs1: SUCCESS (2.043s)
[383.198831] Starting dynamic subtest: vecs0
[385.096626] Dynamic subtest vecs0: SUCCESS (1.917s)
[385.110179] Starting dynamic subtest: ccs0
[387.144860] Dynamic subtest ccs0: SUCCESS (2.045s)
[387.148154] Subtest most-busy-check-all: SUCCESS (11.480s)
[387.277854] [082/132] (634s left) syncobj_timeline (wait-all-interrupted)
[387.345581] Starting subtest: wait-all-interrupted
[387.445970] Subtest wait-all-interrupted: SUCCESS (0.102s)
[387.555663] [083/132] (634s left) kms_frontbuffer_tracking (psr-1p-pri-indfb-multidraw)
[387.663566] Starting subtest: psr-1p-pri-indfb-multidraw
[409.835253] Subtest psr-1p-pri-indfb-multidraw: SUCCESS (22.169s)
[410.007459] [084/132] (611s left) kms_async_flips (async-flip-with-page-flip-events-tiled)
[410.103134] Starting subtest: async-flip-with-page-flip-events-tiled
[410.470068] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs
[413.218927] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.746s)
[413.240843] Starting dynamic subtest: pipe-A-eDP-1-4
[415.405536] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.185s)
[415.418288] Starting dynamic subtest: pipe-A-eDP-1-4
[417.416520] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.009s)
[417.429224] Starting dynamic subtest: pipe-A-eDP-1-x
[419.595968] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.178s)
[419.963612] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs
[422.754146] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.796s)
[422.767138] Starting dynamic subtest: pipe-B-eDP-1-4
[424.941506] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.185s)
[424.952464] Starting dynamic subtest: pipe-B-eDP-1-4
[426.952019] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.008s)
[426.969496] Starting dynamic subtest: pipe-B-eDP-1-x
[429.143391] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.189s)
[429.508349] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs
[432.283917] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.782s)
[432.294365] Starting dynamic subtest: pipe-C-eDP-1-4
[434.460083] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.174s)
[434.470950] Starting dynamic subtest: pipe-C-eDP-1-4
[436.470681] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s)
[436.480969] Starting dynamic subtest: pipe-C-eDP-1-x
[438.661831] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.189s)
[439.025137] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs
[441.828219] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.809s)
[441.838989] Starting dynamic subtest: pipe-D-eDP-1-4
[444.004465] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.174s)
[444.014863] Starting dynamic subtest: pipe-D-eDP-1-4
[446.015193] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s)
[446.027747] Starting dynamic subtest: pipe-D-eDP-1-x
[448.195092] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.179s)
[448.197711] Subtest async-flip-with-page-flip-events-tiled: SUCCESS (38.079s)
[449.436918] [085/132] (572s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[449.542636] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[449.547818] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[449.679098] [086/132] (572s left) gem_eio (in-flight-1us)
[449.886536] Starting subtest: in-flight-1us
[457.981965] Subtest in-flight-1us: SUCCESS (8.099s)
[458.186701] [087/132] (563s left) syncobj_wait (multi-wait-for-submit-submitted-signaled)
[458.260829] Starting subtest: multi-wait-for-submit-submitted-signaled
[458.263624] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.000s)
[458.396124] [088/132] (563s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[463.411742] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[463.416711] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.003s)
[464.288979] [089/132] (557s left) gem_exec_balancer (parallel-ordering)
[464.536960] Starting subtest: parallel-ordering
[465.458111] Subtest parallel-ordering: SUCCESS (0.921s)
[465.614044] [090/132] (556s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[465.703570] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[472.254642] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.554s)
[472.417803] [091/132] (549s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-mc-ccs)
[472.515994] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-mc-ccs
[472.518609] Starting dynamic subtest: pipe-A-eDP-1
[472.543597] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[472.556081] Starting dynamic subtest: pipe-B-eDP-1
[472.583817] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[472.594678] Starting dynamic subtest: pipe-C-eDP-1
[472.620597] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[472.629698] Starting dynamic subtest: pipe-D-eDP-1
[472.652498] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[472.656974] Subtest crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[474.694361] [092/132] (547s left) gem_lmem_swapping (random)
[474.745655] Subtest random: SKIP (0.000s)
[474.795175] [093/132] (547s left) prime_self_import (basic-with_one_bo)
[474.835499] Starting subtest: basic-with_one_bo
[474.857545] Subtest basic-with_one_bo: SUCCESS (0.029s)
[474.986184] [094/132] (547s left) gem_eio (wait-wedge-immediate)
[475.202364] Starting subtest: wait-wedge-immediate
[476.231818] Subtest wait-wedge-immediate: SUCCESS (1.029s)
[476.395170] [095/132] (545s left) perf_pmu (frequency)
[476.434293] Starting subtest: frequency
[476.436512] Starting dynamic subtest: gt0
[478.607572] Dynamic subtest gt0: SUCCESS (2.169s)
[478.619451] Starting dynamic subtest: idle-gt0
[479.112988] Dynamic subtest idle-gt0: SUCCESS (0.505s)
[479.125143] Starting dynamic subtest: gt1
[484.186329] Dynamic subtest gt1: SUCCESS (5.067s)
[484.198699] Starting dynamic subtest: idle-gt1
[484.690211] Dynamic subtest idle-gt1: SUCCESS (0.504s)
[484.693046] Subtest frequency: SUCCESS (8.261s)
[484.815934] [096/132] (537s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-render)
[484.925038] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-render
[484.930630] Subtest fbc-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[485.034835] [097/132] (537s left) gen9_exec_parse (cmd-crossing-page)
[485.086639] Subtest cmd-crossing-page: SKIP (0.000s)
[485.168618] [098/132] (537s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs)
[485.263815] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs
[485.266522] Starting dynamic subtest: pipe-A-eDP-1
[485.401774] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.128s)
[485.414315] Starting dynamic subtest: pipe-B-eDP-1
[485.437272] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[485.447212] Starting dynamic subtest: pipe-C-eDP-1
[485.469817] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.002s)
[485.479641] Starting dynamic subtest: pipe-D-eDP-1
[485.501986] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s)
[485.504185] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SUCCESS (0.137s)
[487.658827] [099/132] (534s left) kms_color (ctm-negative)
[487.744562] Starting subtest: ctm-negative
[487.746618] Starting dynamic subtest: pipe-A-eDP-1
[488.463693] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.719s)
[488.474811] Starting dynamic subtest: pipe-B-eDP-1
[489.864757] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.402s)
[489.876648] Starting dynamic subtest: pipe-C-eDP-1
[491.221083] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.354s)
[491.232461] Starting dynamic subtest: pipe-D-eDP-1
[492.550297] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.328s)
[492.552956] Subtest ctm-negative: SUCCESS (4.806s)
[493.396328] [100/132] (529s left) gem_request_retire (retire-vma-not-inactive)
[493.469164] Starting subtest: retire-vma-not-inactive
[493.529819] Subtest retire-vma-not-inactive: SUCCESS (0.057s)
[493.691206] [101/132] (528s left) kms_plane_scaling (planes-downscale-factor-0-5)
[493.783498] Starting subtest: planes-downscale-factor-0-5
[493.786036] Starting dynamic subtest: pipe-A
[493.801825] Dynamic subtest pipe-A: SKIP (0.016s)
[493.812750] Starting dynamic subtest: pipe-B
[493.834784] Dynamic subtest pipe-B: SKIP (0.028s)
[493.856541] Starting dynamic subtest: pipe-C
[493.866537] Dynamic subtest pipe-C: SKIP (0.028s)
[493.876962] Starting dynamic subtest: pipe-D
[493.890538] Dynamic subtest pipe-D: SKIP (0.028s)
[493.894942] Subtest planes-downscale-factor-0-5: SKIP (0.103s)
[494.028144] [102/132] (528s left) perf (gen12-group-concurrent-oa-buffer-read)
[494.178499] Starting subtest: gen12-group-concurrent-oa-buffer-read
[504.206651] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.028s)
[504.259144] [103/132] (518s left) gem_render_copy (yf-tiled-ccs-to-x-tiled)
[504.318581] Starting subtest: yf-tiled-ccs-to-x-tiled
[504.323826] Subtest yf-tiled-ccs-to-x-tiled: SKIP (0.000s)
[504.529807] [104/132] (518s left) kms_lease (lease-invalid-plane)
[504.633457] Starting subtest: lease-invalid-plane
[504.635978] Starting dynamic subtest: pipe-A-eDP-1
[504.638676] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[504.648794] Starting dynamic subtest: pipe-B-eDP-1
[504.651674] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[504.661602] Starting dynamic subtest: pipe-C-eDP-1
[504.663742] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[504.672807] Starting dynamic subtest: pipe-D-eDP-1
[504.675344] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[504.677593] Subtest lease-invalid-plane: SUCCESS (0.004s)
[504.730175] [105/132] (518s left) kms_busy (extended-modeset-hang-newfb-with-reset)
[504.841648] Starting subtest: extended-modeset-hang-newfb-with-reset
[504.844667] Starting dynamic subtest: pipe-A
[519.855475] Dynamic subtest pipe-A: SUCCESS (15.011s)
[519.865842] Starting dynamic subtest: pipe-D
[534.125421] Dynamic subtest pipe-D: SUCCESS (14.262s)
[534.127849] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (29.276s)
[534.954355] [106/132] (487s left) dmabuf_sync_file (import-basic)
[535.002687] Starting subtest: import-basic
[535.005515] Subtest import-basic: SUCCESS (0.002s)
[535.085076] [107/132] (487s left) kms_pm_dc (dc6-dpms)
[536.182505] Starting subtest: dc6-dpms
[538.212077] Subtest dc6-dpms: SUCCESS (2.029s)
[538.314605] [108/132] (484s left) syncobj_wait (single-wait-signaled)
[538.368228] Starting subtest: single-wait-signaled
[538.370818] Subtest single-wait-signaled: SUCCESS (0.000s)
[538.489580] [109/132] (484s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[538.537191] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[538.595045] [110/132] (484s left) perf (unprivileged-single-ctx-counters)
[538.705818] Starting subtest: unprivileged-single-ctx-counters
[538.712095] Subtest unprivileged-single-ctx-counters: SKIP (0.000s)
[538.752615] [111/132] (484s left) gem_softpin (noreloc-interruptible)
[538.810807] Starting subtest: noreloc-interruptible
[544.215993] Subtest noreloc-interruptible: SUCCESS (5.404s)
[544.460159] [112/132] (478s left) kms_chamelium_hpd (vga-hpd-fast)
[544.846593] Subtest vga-hpd-fast: SKIP (0.000s)
[545.673125] [113/132] (477s left) kms_cursor_legacy (single-move)
[545.799786] Starting subtest: single-move
[545.802190] Starting dynamic subtest: pipe-A
[551.184750] Dynamic subtest pipe-A: SUCCESS (5.380s)
[551.197814] Starting dynamic subtest: pipe-B
[556.568807] Dynamic subtest pipe-B: SUCCESS (5.379s)
[556.580951] Starting dynamic subtest: pipe-C
[561.951802] Dynamic subtest pipe-C: SUCCESS (5.379s)
[561.963999] Starting dynamic subtest: pipe-D
[567.335785] Dynamic subtest pipe-D: SUCCESS (5.380s)
[567.346257] Starting dynamic subtest: all-pipes
[572.725911] Dynamic subtest all-pipes: SUCCESS (5.386s)
[572.728616] Subtest single-move: SUCCESS (26.916s)
[572.896885] [114/132] (450s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf)
[577.882817] Starting subtest: psr2-cursor-plane-move-continuous-exceed-sf
[577.885427] Starting dynamic subtest: pipe-A-eDP-1
[589.319526] Dynamic subtest pipe-A-eDP-1: SUCCESS (11.440s)
[589.331440] Starting dynamic subtest: pipe-B-eDP-1
[600.742758] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.424s)
[600.745835] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SUCCESS (22.867s)
[601.602397] [115/132] (421s left) perf_pmu (idle)
[601.650709] Starting subtest: idle
[601.653139] Starting dynamic subtest: rcs0
[602.194293] Dynamic subtest rcs0: SUCCESS (0.544s)
[602.207591] Starting dynamic subtest: bcs0
[602.722208] Dynamic subtest bcs0: SUCCESS (0.525s)
[602.735426] Starting dynamic subtest: vcs0
[603.245972] Dynamic subtest vcs0: SUCCESS (0.521s)
[603.259205] Starting dynamic subtest: vcs1
[603.774125] Dynamic subtest vcs1: SUCCESS (0.525s)
[603.787492] Starting dynamic subtest: vecs0
[604.306493] Dynamic subtest vecs0: SUCCESS (0.526s)
[604.318434] Starting dynamic subtest: ccs0
[604.830297] Dynamic subtest ccs0: SUCCESS (0.525s)
[604.833248] Subtest idle: SUCCESS (3.182s)
[604.966585] [116/132] (418s left) gem_ctx_param (set-priority-range)
[605.024320] Starting subtest: set-priority-range
[605.037456] Subtest set-priority-range: SUCCESS (0.013s)
[605.191306] [117/132] (418s left) kms_atomic_transition (plane-toggle-modeset-transition)
[605.303235] Starting subtest: plane-toggle-modeset-transition
[605.305517] Starting dynamic subtest: pipe-A-eDP-1
[617.997963] Dynamic subtest pipe-A-eDP-1: SUCCESS (12.696s)
[618.010937] Starting dynamic subtest: pipe-B-eDP-1
[630.411609] Dynamic subtest pipe-B-eDP-1: SUCCESS (12.410s)
[630.414842] Subtest plane-toggle-modeset-transition: SUCCESS (25.113s)
[631.255827] [118/132] (392s left) gem_exec_schedule (deep)
[631.446821] Starting subtest: deep
[631.449812] Starting dynamic subtest: rcs0
[637.460105] Dynamic subtest rcs0: SKIP (6.009s)
[637.473436] Starting dynamic subtest: vcs0
[648.934665] Dynamic subtest vcs0: SUCCESS (11.475s)
[648.950379] Starting dynamic subtest: vcs1
[660.906064] Dynamic subtest vcs1: SUCCESS (11.967s)
[660.919660] Starting dynamic subtest: vecs0
[673.155405] Dynamic subtest vecs0: SUCCESS (12.247s)
[673.175345] Starting dynamic subtest: ccs0
[686.645994] Dynamic subtest ccs0: SUCCESS (13.487s)
[686.648790] Subtest deep: SUCCESS (55.192s)
[688.725166] [119/132] (334s left) gem_compute (compute-square)
[688.789433] Starting subtest: compute-square
[688.798115] Subtest compute-square: SUCCESS (0.012s)
[688.962796] [120/132] (334s left) kms_chamelium_color (ctm-red-to-blue)
[689.066104] Subtest ctm-red-to-blue: SKIP (0.000s)
[689.117157] [121/132] (334s left) api_intel_bb (render)
[689.179729] Starting subtest: render
[689.182190] Starting dynamic subtest: render-none-512
[689.332456] Dynamic subtest render-none-512: SUCCESS (0.154s)
[689.345813] Starting dynamic subtest: render-none-1024
[689.712831] Dynamic subtest render-none-1024: SUCCESS (0.379s)
[689.723825] Starting dynamic subtest: render-x-512
[689.800802] Dynamic subtest render-x-512: SUCCESS (0.088s)
[689.812390] Starting dynamic subtest: render-x-1024
[690.143099] Dynamic subtest render-x-1024: SUCCESS (0.342s)
[690.156021] Starting dynamic subtest: render-y-512
[690.238463] Dynamic subtest render-y-512: SUCCESS (0.094s)
[690.250598] Starting dynamic subtest: render-y-1024
[690.848477] Dynamic subtest render-y-1024: SUCCESS (0.607s)
[690.851396] Subtest render: SUCCESS (1.670s)
[690.962030] [122/132] (332s left) kms_atomic_interruptible (legacy-setmode)
[691.062794] Starting subtest: legacy-setmode
[691.065616] Starting dynamic subtest: pipe-A-eDP-1
[697.962214] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.900s)
[697.964704] Subtest legacy-setmode: SUCCESS (6.902s)
[698.847703] [123/132] (324s left) kms_addfb_basic (bad-pitch-63)
[698.899502] Starting subtest: bad-pitch-63
[698.901577] Subtest bad-pitch-63: SUCCESS (0.000s)
[699.079447] [124/132] (324s left) gem_gpgpu_fill (offset-16x16)
[699.133546] Starting subtest: offset-16x16
[699.140143] Subtest offset-16x16: SUCCESS (0.008s)
[699.295339] [125/132] (324s left) gem_ctx_bad_destroy (invalid-ctx)
[699.352380] Starting subtest: invalid-ctx
[699.355073] Subtest invalid-ctx: SUCCESS (0.000s)
[699.454044] [126/132] (324s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180)
[699.556191] Starting subtest: linear-max-hw-stride-32bpp-rotate-180
[700.712650] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.155s)
[700.881333] [127/132] (322s left) gem_render_linear_blits (basic)
[700.939638] Starting subtest: basic
[700.961129] Subtest basic: SUCCESS (0.024s)
[701.070989] [128/132] (322s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt)
[701.182511] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt
[701.186557] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[701.301207] [129/132] (322s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-pwrite)
[701.396547] Starting subtest: psr-2p-primscrn-cur-indfb-draw-pwrite
[701.401074] Subtest psr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[701.512129] [130/132] (322s left) kms_vblank (ts-continuation-modeset-rpm)
[701.604363] Starting subtest: ts-continuation-modeset-rpm
[701.606376] Starting dynamic subtest: pipe-A-eDP-1
[704.103590] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.500s)
[704.120641] Starting dynamic subtest: pipe-D-eDP-1
[706.370808] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.265s)
[706.373681] Subtest ts-continuation-modeset-rpm: SUCCESS (4.769s)
[707.193215] [131/132] (316s left) gem_vm_create (create-ext)
[707.266161] Starting subtest: create-ext
[707.272167] Subtest create-ext: SUCCESS (0.006s)
[707.431280] [132/132] (316s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[707.536355] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt
[707.541415] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[707.648563] Closing watchdogs
results: parsing output: 0/ for test: kms_ccs
results: parsing output: 1/ for test: sriov_basic
results: parsing output: 2/ for test: gem_spin_batch
results: parsing output: 3/ for test: kms_cursor_crc
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_flip_scaled_crc
results: parsing output: 6/ for test: kms_flip
results: parsing output: 7/ for test: gem_mmap_offset
results: parsing output: 8/ for test: prime_mmap
results: parsing output: 9/ for test: kms_psr
results: parsing output: 10/ for test: fbdev
results: parsing output: 11/ for test: kms_big_fb
results: parsing output: 12/ for test: kms_flip
results: parsing output: 13/ for test: i915_module_load
results: parsing output: 14/ for test: gem_exec_params
results: parsing output: 15/ for test: kms_pm_rpm
results: parsing output: 16/ for test: gem_mmap_wc
results: parsing output: 17/ for test: kms_big_fb
results: parsing output: 18/ for test: kms_cursor_crc
results: parsing output: 19/ for test: gem_ctx_param
results: parsing output: 20/ for test: gem_exec_reloc
results: parsing output: 21/ for test: syncobj_timeline
results: parsing output: 22/ for test: kms_joiner
results: parsing output: 23/ for test: sysfs_preempt_timeout
results: parsing output: 24/ for test: kms_psr2_sf
results: parsing output: 25/ for test: kms_plane_multiple
results: parsing output: 26/ for test: i915_drm_fdinfo
results: parsing output: 27/ for test: gem_mmap_wc
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: kms_big_fb
results: parsing output: 31/ for test: gem_eio
results: parsing output: 32/ for test: gem_userptr_blits
results: parsing output: 33/ for test: kms_rotation_crc
results: parsing output: 34/ for test: syncobj_timeline
results: parsing output: 35/ for test: gem_exec_balancer
results: parsing output: 36/ for test: kms_flip
results: parsing output: 37/ for test: gem_bad_reloc
results: parsing output: 38/ for test: kms_ccs
results: parsing output: 39/ for test: gem_exec_fence
results: parsing output: 40/ for test: kms_big_fb
results: parsing output: 41/ for test: kms_cursor_legacy
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: syncobj_timeline
results: parsing output: 44/ for test: prime_vgem
results: parsing output: 45/ for test: kms_plane_alpha_blend
results: parsing output: 46/ for test: kms_scaling_modes
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: kms_cursor_legacy
results: parsing output: 49/ for test: gem_render_copy
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: gem_exec_schedule
results: parsing output: 52/ for test: kms_flip_scaled_crc
results: parsing output: 53/ for test: kms_cursor_crc
results: parsing output: 54/ for test: i915_pm_rps
results: parsing output: 55/ for test: syncobj_timeline
results: parsing output: 56/ for test: kms_psr
results: parsing output: 57/ for test: kms_cursor_legacy
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: kms_psr
results: parsing output: 60/ for test: kms_atomic_transition
results: parsing output: 61/ for test: gem_exec_reloc
results: parsing output: 62/ for test: i915_pm_rps
results: parsing output: 63/ for test: kms_atomic
results: parsing output: 64/ for test: gem_workarounds
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: gem_ctx_persistence
results: parsing output: 67/ for test: gem_exec_schedule
results: parsing output: 68/ for test: gem_pxp
results: parsing output: 69/ for test: kms_flip
results: parsing output: 70/ for test: kms_cursor_crc
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_big_fb
results: parsing output: 73/ for test: prime_vgem
results: parsing output: 74/ for test: kms_chamelium_frames
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: gem_exec_schedule
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: gem_ctx_sseu
results: parsing output: 80/ for test: perf_pmu
results: parsing output: 81/ for test: syncobj_timeline
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_async_flips
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: gem_eio
results: parsing output: 86/ for test: syncobj_wait
results: parsing output: 87/ for test: kms_psr2_sf
results: parsing output: 88/ for test: gem_exec_balancer
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_ccs
results: parsing output: 91/ for test: gem_lmem_swapping
results: parsing output: 92/ for test: prime_self_import
results: parsing output: 93/ for test: gem_eio
results: parsing output: 94/ for test: perf_pmu
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: gen9_exec_parse
results: parsing output: 97/ for test: kms_ccs
results: parsing output: 98/ for test: kms_color
results: parsing output: 99/ for test: gem_request_retire
results: parsing output: 100/ for test: kms_plane_scaling
results: parsing output: 101/ for test: perf
results: parsing output: 102/ for test: gem_render_copy
results: parsing output: 103/ for test: kms_lease
results: parsing output: 104/ for test: kms_busy
results: parsing output: 105/ for test: dmabuf_sync_file
results: parsing output: 106/ for test: kms_pm_dc
results: parsing output: 107/ for test: syncobj_wait
results: parsing output: 108/ for test: kms_pipe_b_c_ivb
results: parsing output: 109/ for test: perf
results: parsing output: 110/ for test: gem_softpin
results: parsing output: 111/ for test: kms_chamelium_hpd
results: parsing output: 112/ for test: kms_cursor_legacy
results: parsing output: 113/ for test: kms_psr2_sf
results: parsing output: 114/ for test: perf_pmu
results: parsing output: 115/ for test: gem_ctx_param
results: parsing output: 116/ for test: kms_atomic_transition
results: parsing output: 117/ for test: gem_exec_schedule
results: parsing output: 118/ for test: gem_compute
results: parsing output: 119/ for test: kms_chamelium_color
results: parsing output: 120/ for test: api_intel_bb
results: parsing output: 121/ for test: kms_atomic_interruptible
results: parsing output: 122/ for test: kms_addfb_basic
results: parsing output: 123/ for test: gem_gpgpu_fill
results: parsing output: 124/ for test: gem_ctx_bad_destroy
results: parsing output: 125/ for test: kms_big_fb
results: parsing output: 126/ for test: gem_render_linear_blits
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_vblank
results: parsing output: 130/ for test: gem_vm_create
results: parsing output: 131/ for test: kms_frontbuffer_tracking
Done.