[58.508879] Initializing watchdogs
[58.508926]   /dev/watchdog0
[58.523597] [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.528236] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.530522] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.532222] [001/133] (960s left) kms_addfb_basic (basic)
[58.587292] Starting subtest: basic
[58.588233] Subtest basic: SUCCESS (0.000s)
[58.724430] [002/133] (960s left) gem_userptr_blits (unsync-unmap-after-close)
[58.791832] Subtest unsync-unmap-after-close: SKIP (0.000s)
[58.930737] [003/133] (960s left) gem_exec_reloc (basic-cpu-gtt-noreloc)
[58.997499] Subtest basic-cpu-gtt-noreloc: SKIP (0.000s)
[59.070906] [004/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw)
[59.163689] Starting subtest: fbcpsr-2p-pri-indfb-multidraw
[59.165641] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s)
[59.282560] [005/133] (959s left) kms_invalid_mode (bad-hsync-start)
[59.367907] Starting subtest: bad-hsync-start
[59.368811] Starting dynamic subtest: pipe-A-eDP-1
[59.653250] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.286s)
[59.659265] Starting dynamic subtest: pipe-B-eDP-1
[59.660056] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[59.665188] Starting dynamic subtest: pipe-C-eDP-1
[59.665939] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[59.671085] Starting dynamic subtest: pipe-D-eDP-1
[59.671832] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[59.672782] Subtest bad-hsync-start: SUCCESS (0.290s)
[60.516239] [006/133] (958s left) gem_exec_schedule (implicit-read-write)
[60.584791] Starting subtest: implicit-read-write
[60.586098] Starting dynamic subtest: rcs0
[60.699357] Dynamic subtest rcs0: SUCCESS (0.115s)
[60.708112] Starting dynamic subtest: vcs0
[60.786220] Dynamic subtest vcs0: SUCCESS (0.087s)
[60.794924] Starting dynamic subtest: vcs1
[60.861093] Dynamic subtest vcs1: SUCCESS (0.075s)
[60.870611] Starting dynamic subtest: vecs0
[60.932825] Dynamic subtest vecs0: SUCCESS (0.072s)
[60.940915] Starting dynamic subtest: ccs0
[61.012112] Dynamic subtest ccs0: SUCCESS (0.079s)
[61.013465] Subtest implicit-read-write: SUCCESS (0.429s)
[62.026305] [007/133] (957s left) kms_ccs (random-ccs-data-y-tiled-gen12-mc-ccs)
[62.125360] Starting subtest: random-ccs-data-y-tiled-gen12-mc-ccs
[62.126251] Starting dynamic subtest: pipe-A-eDP-1
[62.135380] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[62.142273] Starting dynamic subtest: pipe-B-eDP-1
[62.151194] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[62.156776] Starting dynamic subtest: pipe-C-eDP-1
[62.165339] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[62.170994] Starting dynamic subtest: pipe-D-eDP-1
[62.180351] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[62.182033] Subtest random-ccs-data-y-tiled-gen12-mc-ccs: SKIP (0.003s)
[64.377167] [008/133] (954s left) syncobj_timeline (wait-for-submit-snapshot)
[64.442451] Starting subtest: wait-for-submit-snapshot
[64.525439] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[64.602075] [009/133] (954s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-render)
[64.695956] Starting subtest: psr-1p-primscrn-pri-indfb-draw-render
[72.378761] Subtest psr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.694s)
[72.527170] [010/133] (946s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[72.617426] Starting subtest: psr-dirtyfb-ioctl
[72.618447] Starting dynamic subtest: A-eDP-1
[76.572998] Dynamic subtest A-eDP-1: SUCCESS (3.957s)
[76.573881] Subtest psr-dirtyfb-ioctl: SUCCESS (3.958s)
[77.461101] [011/133] (941s left) gen7_exec_parse (basic-offset)
[77.520955] Subtest basic-offset: SKIP (0.000s)
[77.594607] [012/133] (941s left) kms_psr (pr-cursor-render)
[77.694146] Starting subtest: pr-cursor-render
[77.695986] Subtest pr-cursor-render: SKIP (0.000s)
[77.777131] [013/133] (941s left) kms_psr (psr-primary-render)
[77.879126] Starting subtest: psr-primary-render
[77.879989] Starting dynamic subtest: eDP-1
[79.638596] Dynamic subtest eDP-1: SUCCESS (1.759s)
[79.639534] Subtest psr-primary-render: SUCCESS (1.760s)
[80.515975] [014/133] (938s left) gem_vm_create (isolation)
[80.579554] Starting subtest: isolation
[80.588093] Subtest isolation: SUCCESS (0.008s)
[80.743956] [015/133] (938s left) i915_selftest (live)
[82.552587] Starting subtest: live
[82.553881] Starting dynamic subtest: sanitycheck
[87.039394] Dynamic subtest sanitycheck: SUCCESS (4.486s)
[87.047065] Starting dynamic subtest: uncore
[91.477434] Dynamic subtest uncore: SUCCESS (4.437s)
[91.484974] Starting dynamic subtest: workarounds
[94.762198] Dynamic subtest workarounds: SUCCESS (3.284s)
[94.769624] Starting dynamic subtest: gt_engines
[99.491348] Dynamic subtest gt_engines: SUCCESS (4.729s)
[99.499223] Starting dynamic subtest: gt_timelines
[115.228472] Dynamic subtest gt_timelines: SUCCESS (15.736s)
[115.236067] Starting dynamic subtest: gt_contexts
[119.620839] Dynamic subtest gt_contexts: SUCCESS (4.392s)
[119.626182] Starting dynamic subtest: gt_lrc
[124.072545] Dynamic subtest gt_lrc: SUCCESS (4.450s)
[124.080311] Starting dynamic subtest: gt_mocs
[128.611497] Dynamic subtest gt_mocs: SUCCESS (4.537s)
[128.618741] Starting dynamic subtest: gt_pm
[135.471915] Dynamic subtest gt_pm: SUCCESS (6.859s)
[135.479813] Starting dynamic subtest: gt_heartbeat
[139.968074] Dynamic subtest gt_heartbeat: SUCCESS (4.495s)
[139.975914] Starting dynamic subtest: gt_tlb
[149.513650] Dynamic subtest gt_tlb: SUCCESS (9.542s)
[149.521109] Starting dynamic subtest: requests
[163.186195] Dynamic subtest requests: SUCCESS (13.666s)
[163.193652] Starting dynamic subtest: migrate
[169.295068] Dynamic subtest migrate: SUCCESS (6.105s)
[169.302975] Starting dynamic subtest: active
[173.744247] Dynamic subtest active: SUCCESS (4.448s)
[173.751520] Starting dynamic subtest: objects
[178.578742] Dynamic subtest objects: SUCCESS (4.832s)
[178.584203] Starting dynamic subtest: mman
[183.554987] Dynamic subtest mman: SUCCESS (4.973s)
[183.562803] Starting dynamic subtest: dmabuf
[188.084927] Dynamic subtest dmabuf: SUCCESS (4.529s)
[188.093482] Starting dynamic subtest: vma
[192.601777] Dynamic subtest vma: SUCCESS (4.514s)
[192.609237] Starting dynamic subtest: coherency
[197.691345] Dynamic subtest coherency: SUCCESS (5.087s)
[197.698950] Starting dynamic subtest: gtt
[207.909498] Dynamic subtest gtt: SUCCESS (10.215s)
[207.916404] Starting dynamic subtest: gem
[215.726885] Dynamic subtest gem: SUCCESS (7.815s)
[215.735282] Starting dynamic subtest: evict
[221.222027] Dynamic subtest evict: SUCCESS (5.493s)
[221.229865] Starting dynamic subtest: hugepages
[230.210935] Dynamic subtest hugepages: SUCCESS (8.986s)
[230.218771] Starting dynamic subtest: gem_contexts
[256.598573] Dynamic subtest gem_contexts: SUCCESS (26.383s)
[256.606497] Starting dynamic subtest: client
[261.102359] Dynamic subtest client: SUCCESS (4.505s)
[261.110294] Starting dynamic subtest: gem_migrate
[265.582391] Dynamic subtest gem_migrate: SUCCESS (4.477s)
[265.590552] Starting dynamic subtest: reset
[270.085217] Dynamic subtest reset: SUCCESS (4.501s)
[270.094062] Starting dynamic subtest: memory_region
[274.517970] Dynamic subtest memory_region: SUCCESS (4.431s)
[274.526262] Starting dynamic subtest: hangcheck
[288.193564] Dynamic subtest hangcheck: SUCCESS (13.676s)
[288.201325] Starting dynamic subtest: execlists
[292.666594] Dynamic subtest execlists: SUCCESS (4.471s)
[292.674898] Starting dynamic subtest: ring_submission
[295.484941] Dynamic subtest ring_submission: SUCCESS (2.816s)
[295.493836] Starting dynamic subtest: perf
[298.415047] Dynamic subtest perf: SUCCESS (2.929s)
[298.423063] Starting dynamic subtest: slpc
[312.544693] Dynamic subtest slpc: SUCCESS (14.129s)
[312.551632] Starting dynamic subtest: guc
[316.571652] Dynamic subtest guc: SUCCESS (4.026s)
[316.583334] Starting dynamic subtest: guc_multi_lrc
[319.438775] Dynamic subtest guc_multi_lrc: SUCCESS (2.864s)
[319.446790] Starting dynamic subtest: guc_hang
[322.999668] Dynamic subtest guc_hang: SUCCESS (3.559s)
[323.007273] Starting dynamic subtest: late_gt_pm
[327.471445] Dynamic subtest late_gt_pm: SUCCESS (4.470s)
[327.472485] Subtest live: SUCCESS (244.901s)
[327.491955] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[327.493563] [016/133] (691s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-cpu)
[329.078485] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-cpu
[333.411943] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (4.333s)
[334.621088] [FACT kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-cpu)] new: kernel.kmod_is_loaded.i915: true
[334.623209] [017/133] (684s left) gem_userptr_blits (readonly-unsync)
[334.706872] Subtest readonly-unsync: SKIP (0.000s)
[334.877741] [018/133] (684s left) drm_buddy (drm_buddy)
[334.908159] Starting subtest: drm_buddy
[334.909917] Subtest drm_buddy: SKIP (0.001s)
[334.961474] [019/133] (684s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)
[335.054288] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc
[335.055918] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[335.175294] [020/133] (684s left) fbdev (read)
[335.213966] Starting subtest: read
[335.753397] Subtest read: SUCCESS (0.530s)
[335.810460] [021/133] (683s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[335.909585] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[335.911240] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[336.038980] [022/133] (683s left) kms_vblank (ts-continuation-suspend)
[336.119258] Starting subtest: ts-continuation-suspend
[336.120054] Starting dynamic subtest: pipe-A-eDP-1
[352.924641] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.049s)
[352.933636] Starting dynamic subtest: pipe-D-eDP-1
[370.904732] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.570s)
[370.905587] Subtest ts-continuation-suspend: SUCCESS (4.623s)
[376.760651] [023/133] (647s left) kms_cursor_crc (cursor-random-64x64)
[376.960556] Starting subtest: cursor-random-64x64
[376.962783] Starting dynamic subtest: pipe-A-eDP-1
[380.311171] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.405s)
[380.340637] Starting dynamic subtest: pipe-D-eDP-1
[384.333582] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.042s)
[384.334410] Subtest cursor-random-64x64: SUCCESS (7.473s)
[385.183862] [024/133] (639s left) gem_ctx_engines (independent)
[385.248341] Starting subtest: independent
[385.249367] Starting dynamic subtest: rcs0
[385.399474] Dynamic subtest rcs0: SUCCESS (0.143s)
[385.406239] Starting dynamic subtest: bcs0
[385.514582] Dynamic subtest bcs0: SUCCESS (0.124s)
[385.526026] Starting dynamic subtest: vcs0
[385.628531] Dynamic subtest vcs0: SUCCESS (0.114s)
[385.637103] Starting dynamic subtest: vcs1
[385.759191] Dynamic subtest vcs1: SUCCESS (0.122s)
[385.768178] Starting dynamic subtest: vecs0
[385.867212] Dynamic subtest vecs0: SUCCESS (0.116s)
[385.876337] Starting dynamic subtest: ccs0
[385.998125] Dynamic subtest ccs0: SUCCESS (0.122s)
[386.011385] Starting dynamic subtest: all-engines
[386.429089] Dynamic subtest all-engines: SUCCESS (0.432s)
[386.430927] Subtest independent: SUCCESS (1.181s)
[387.272760] [025/133] (637s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt)
[387.376122] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt
[394.136629] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.786s)
[394.331588] [026/133] (630s left) kms_frontbuffer_tracking (fbc-modesetfrombusy)
[394.432461] Starting subtest: fbc-modesetfrombusy
[398.301691] Subtest fbc-modesetfrombusy: SUCCESS (3.878s)
[399.482524] [027/133] (625s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted)
[399.538187] Starting subtest: etime-single-wait-for-submit-available-unsubmitted
[399.645138] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.107s)
[399.728422] [028/133] (625s left) kms_cursor_edge_walk (256x256-top-edge)
[399.824824] Starting subtest: 256x256-top-edge
[399.825717] Starting dynamic subtest: pipe-A-eDP-1
[403.336134] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.515s)
[403.343719] Starting dynamic subtest: pipe-D-eDP-1
[406.449596] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.111s)
[406.450481] Subtest 256x256-top-edge: SUCCESS (6.628s)
[407.285332] [029/133] (617s left) kms_vrr (seamless-rr-switch-virtual)
[407.386498] Starting subtest: seamless-rr-switch-virtual
[407.388970] Subtest seamless-rr-switch-virtual: SKIP (0.000s)
[407.465793] [030/133] (617s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled)
[407.523563] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled
[407.525435] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[407.725561] [031/133] (617s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move)
[407.826454] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move
[407.828250] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[407.961851] [032/133] (617s left) kms_big_fb (linear-32bpp-rotate-270)
[408.062361] Starting subtest: linear-32bpp-rotate-270
[408.081704] Subtest linear-32bpp-rotate-270: SKIP (0.019s)
[408.236918] [033/133] (616s left) kms_getfb (getfb2-handle-protection)
[408.330737] Starting subtest: getfb2-handle-protection
[408.356207] Subtest getfb2-handle-protection: SUCCESS (0.025s)
[408.498897] [034/133] (616s left) kms_pm_rpm (system-suspend-modeset)
[410.211230] Starting subtest: system-suspend-modeset
[430.051433] Subtest system-suspend-modeset: SUCCESS (4.920s)
[435.513232] [035/133] (594s left) syncobj_timeline (invalid-signal-illegal-handle)
[435.575501] Starting subtest: invalid-signal-illegal-handle
[435.576390] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[435.691187] [036/133] (594s left) kms_chamelium_hpd (common-hpd-after-suspend)
[436.079889] Subtest common-hpd-after-suspend: SKIP (0.000s)
[436.909095] [037/133] (593s left) kms_ccs (crc-primary-suspend-4-tiled-bmg-ccs)
[436.993952] Starting subtest: crc-primary-suspend-4-tiled-bmg-ccs
[436.995886] Subtest crc-primary-suspend-4-tiled-bmg-ccs: SKIP (0.000s)
[438.153376] [038/133] (592s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-pgflip-blt)
[438.239713] Starting subtest: fbcpsr-2p-scndscrn-indfb-pgflip-blt
[438.241513] Subtest fbcpsr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[438.378095] [039/133] (591s left) gem_exec_balancer (smoke)
[438.439370] Starting subtest: smoke
[460.936775] Subtest smoke: SUCCESS (22.562s)
[461.862820] [040/133] (568s left) kms_setmode (basic)
[461.921813] Starting subtest: basic
[462.242040] Starting dynamic subtest: pipe-A-eDP-1
[465.745214] Dynamic subtest pipe-A-eDP-1: FAIL (3.463s)
[466.046340] Starting dynamic subtest: pipe-B-eDP-1
[468.175322] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.127s)
[468.474774] Subtest basic: FAIL (6.557s)
[469.311911] [041/133] (561s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[469.407502] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt
[469.409248] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[469.541320] [042/133] (560s left) kms_color (deep-color)
[469.634103] Starting subtest: deep-color
[470.685355] Starting dynamic subtest: pipe-A-eDP-1-gamma
[471.396844] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.711s)
[471.403909] Starting dynamic subtest: pipe-A-eDP-1-degamma
[472.796769] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.397s)
[472.804355] Starting dynamic subtest: pipe-A-eDP-1-ctm
[474.227459] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.428s)
[475.002089] Starting dynamic subtest: pipe-B-eDP-1-gamma
[475.710802] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.714s)
[475.717955] Starting dynamic subtest: pipe-B-eDP-1-degamma
[477.108307] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.396s)
[477.117928] Starting dynamic subtest: pipe-B-eDP-1-ctm
[478.545651] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.436s)
[479.314423] Starting dynamic subtest: pipe-C-eDP-1-gamma
[479.999712] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.692s)
[480.010290] Starting dynamic subtest: pipe-C-eDP-1-degamma
[481.369707] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.368s)
[481.377101] Starting dynamic subtest: pipe-C-eDP-1-ctm
[482.798492] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.427s)
[483.599256] Starting dynamic subtest: pipe-D-eDP-1-gamma
[484.295862] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.703s)
[484.303113] Starting dynamic subtest: pipe-D-eDP-1-degamma
[485.765557] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.468s)
[485.772959] Starting dynamic subtest: pipe-D-eDP-1-ctm
[487.177546] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.411s)
[487.178472] Subtest deep-color: SUCCESS (17.531s)
[488.038600] [043/133] (542s left) gem_lmem_swapping (parallel-random-verify)
[488.074905] Subtest parallel-random-verify: SKIP (0.000s)
[488.110410] [044/133] (542s left) kms_flip (dpms-vs-vblank-race)
[488.202774] Starting subtest: dpms-vs-vblank-race
[488.204906] Starting dynamic subtest: A-eDP1
[493.152979] Dynamic subtest A-eDP1: SUCCESS (4.946s)
[493.160427] Starting dynamic subtest: B-eDP1
[497.777646] Dynamic subtest B-eDP1: SUCCESS (4.624s)
[497.785628] Starting dynamic subtest: C-eDP1
[502.386136] Dynamic subtest C-eDP1: SUCCESS (4.608s)
[502.393755] Starting dynamic subtest: D-eDP1
[507.009816] Dynamic subtest D-eDP1: SUCCESS (4.624s)
[507.011887] Subtest dpms-vs-vblank-race: SUCCESS (18.811s)
[507.904543] [045/133] (522s left) kms_chamelium_color (degamma)
[508.002698] Subtest degamma: SKIP (0.000s)
[508.042524] [046/133] (522s left) api_intel_bb (add-remove-objects)
[508.091486] Starting subtest: add-remove-objects
[508.103108] Subtest add-remove-objects: SUCCESS (0.013s)
[508.261512] [047/133] (522s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[508.377414] Starting subtest: cursor-vs-flip-atomic
[537.727742] Subtest cursor-vs-flip-atomic: SUCCESS (29.357s)
[538.599988] [048/133] (492s left) gem_userptr_blits (readonly-pwrite-unsync)
[538.650476] Subtest readonly-pwrite-unsync: SKIP (0.000s)
[538.781387] [049/133] (491s left) gem_exec_schedule (wide)
[538.964857] Starting subtest: wide
[538.965786] Starting dynamic subtest: rcs0
[549.374503] Dynamic subtest rcs0: SUCCESS (10.375s)
[549.387978] Starting dynamic subtest: vcs0
[559.761091] Dynamic subtest vcs0: SUCCESS (10.424s)
[559.772038] Starting dynamic subtest: vcs1
[571.098307] Dynamic subtest vcs1: SUCCESS (11.340s)
[571.108663] Starting dynamic subtest: vecs0
[582.706819] Dynamic subtest vecs0: SUCCESS (11.610s)
[582.717233] Starting dynamic subtest: ccs0
[597.802040] Dynamic subtest ccs0: SUCCESS (15.062s)
[597.803622] Subtest wide: SUCCESS (58.817s)
[599.100351] [FACT gem_exec_schedule (wide)] new: kernel.kmod_is_loaded.vgem: true
[599.102187] [050/133] (431s left) kms_force_connector_basic (force-load-detect)
[599.187310] Starting subtest: force-load-detect
[599.189040] Subtest force-load-detect: SKIP (0.000s)
[599.310486] [051/133] (431s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[599.354094] Starting subtest: multi-wait-all-for-submit-submitted
[599.461334] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.107s)
[599.545653] [052/133] (431s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[599.679810] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[616.944695] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (17.269s)
[617.837545] [053/133] (412s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[617.941966] Starting subtest: yf-tiled-8bpp-rotate-270
[617.943810] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[618.064066] [054/133] (412s left) core_auth (getclient-simple)
[618.104868] Starting subtest: getclient-simple
[618.127211] Subtest getclient-simple: SUCCESS (0.023s)
[618.230266] [055/133] (412s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0-hflip)
[618.311919] Starting subtest: linear-max-hw-stride-32bpp-rotate-0-hflip
[618.313871] Subtest linear-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[618.426076] [056/133] (412s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[618.525827] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[618.527694] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[618.674271] [057/133] (412s left) gem_exec_reloc (basic-wc)
[618.728031] Subtest basic-wc: SKIP (0.000s)
[618.795063] [058/133] (412s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc)
[618.890612] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc
[618.892462] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[619.013811] [059/133] (411s left) syncobj_basic (illegal-fd-to-handle)
[619.058956] Starting subtest: illegal-fd-to-handle
[619.059977] Subtest illegal-fd-to-handle: SUCCESS (0.000s)
[619.182442] [060/133] (411s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier)
[619.268202] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier
[619.269749] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier: SKIP (0.000s)
[619.347469] [061/133] (411s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-render)
[619.448215] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-render
[619.450473] Subtest psr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[619.580352] [062/133] (411s left) kms_flip (wf_vblank-ts-check)
[619.701277] Starting subtest: wf_vblank-ts-check
[619.702402] Starting dynamic subtest: A-eDP1
[628.605752] Dynamic subtest A-eDP1: SUCCESS (8.877s)
[628.616106] Starting dynamic subtest: B-eDP1
[637.546280] Dynamic subtest B-eDP1: SUCCESS (8.935s)
[637.555254] Starting dynamic subtest: C-eDP1
[646.483656] Dynamic subtest C-eDP1: SUCCESS (8.922s)
[646.491449] Starting dynamic subtest: D-eDP1
[655.386910] Dynamic subtest D-eDP1: SUCCESS (8.933s)
[655.388308] Subtest wf_vblank-ts-check: SUCCESS (35.678s)
[656.613984] [063/133] (374s left) kms_ccs (missing-ccs-buffer-y-tiled-ccs)
[656.699453] Starting subtest: missing-ccs-buffer-y-tiled-ccs
[656.700466] Starting dynamic subtest: pipe-A-eDP-1
[656.708705] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[656.716787] Starting dynamic subtest: pipe-B-eDP-1
[656.725229] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[656.732840] Starting dynamic subtest: pipe-C-eDP-1
[656.740896] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[656.748376] Starting dynamic subtest: pipe-D-eDP-1
[656.756481] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[656.758013] Subtest missing-ccs-buffer-y-tiled-ccs: SKIP (0.005s)
[658.893010] [064/133] (372s left) kms_psr (fbc-pr-cursor-blt)
[658.985381] Starting subtest: fbc-pr-cursor-blt
[658.987075] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[659.064586] [065/133] (372s left) kms_plane_scaling (plane-downscale-factor-0-5-with-pixel-format)
[659.150260] Starting subtest: plane-downscale-factor-0-5-with-pixel-format
[659.151068] Starting dynamic subtest: pipe-A
[659.167916] Dynamic subtest pipe-A: SKIP (0.016s)
[659.175643] Starting dynamic subtest: pipe-B
[659.198518] Dynamic subtest pipe-B: SKIP (0.029s)
[659.206194] Starting dynamic subtest: pipe-C
[659.230537] Dynamic subtest pipe-C: SKIP (0.031s)
[659.238102] Starting dynamic subtest: pipe-D
[659.259595] Dynamic subtest pipe-D: SKIP (0.030s)
[659.261285] Subtest plane-downscale-factor-0-5-with-pixel-format: SKIP (0.109s)
[659.381975] [066/133] (371s left) sw_sync (alloc_timeline)
[659.409534] Starting subtest: alloc_timeline
[659.410508] Subtest alloc_timeline: SUCCESS (0.000s)
[659.475755] [067/133] (371s left) kms_selftest (drm_format_helper)
[659.508649] Starting subtest: drm_format_helper
[659.545419] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8
[659.704074] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.151s)
[659.713310] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332
[659.857864] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.152s)
[659.866207] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565
[659.999513] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.141s)
[660.008815] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555
[660.162776] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.164s)
[660.170298] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555
[660.304938] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.141s)
[660.314531] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551
[660.455408] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.149s)
[660.465012] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888
[660.575622] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.128s)
[660.584215] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888
[660.723092] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.137s)
[660.732200] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888
[660.859790] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.135s)
[660.868128] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010
[661.007824] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.147s)
[661.016742] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010
[661.145704] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.136s)
[661.153639] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono
[661.286821] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.140s)
[661.295823] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab
[661.427800] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.140s)
[661.435924] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888
[661.570118] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.141s)
[661.579545] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888
[661.716853] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.154s)
[661.725666] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset
[661.866110] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.148s)
[661.874167] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy
[662.013643] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.146s)
[662.014450] Subtest drm_format_helper: SUCCESS (2.503s)
[662.227678] [068/133] (369s left) gem_userptr_blits (sync-unmap-cycles)
[662.295343] Starting subtest: sync-unmap-cycles
[667.670372] Subtest sync-unmap-cycles: SUCCESS (5.376s)
[667.852792] [069/133] (363s left) perf_pmu (rc6)
[667.889578] Starting subtest: rc6
[667.890501] Starting dynamic subtest: gt0
[674.284606] Dynamic subtest gt0: SUCCESS (6.383s)
[674.295903] Starting dynamic subtest: runtime-pm-gt0
[682.058537] Dynamic subtest runtime-pm-gt0: SUCCESS (7.771s)
[682.069018] Starting dynamic subtest: runtime-pm-long-gt0
[694.540112] Dynamic subtest runtime-pm-long-gt0: SUCCESS (12.478s)
[694.551523] Starting dynamic subtest: other-idle-gt0
[700.883980] Dynamic subtest other-idle-gt0: SUCCESS (6.342s)
[700.895337] Starting dynamic subtest: gt1
[707.225019] Dynamic subtest gt1: SUCCESS (6.339s)
[707.235509] Starting dynamic subtest: runtime-pm-gt1
[714.658102] Dynamic subtest runtime-pm-gt1: SUCCESS (7.431s)
[714.668681] Starting dynamic subtest: runtime-pm-long-gt1
[727.160867] Dynamic subtest runtime-pm-long-gt1: SUCCESS (12.503s)
[727.171481] Starting dynamic subtest: other-idle-gt1
[733.504530] Dynamic subtest other-idle-gt1: SUCCESS (6.342s)
[733.505801] Subtest rc6: SUCCESS (65.607s)
[734.128479] [070/133] (297s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[734.221924] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[734.233668] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.011s)
[734.326219] [071/133] (297s left) gem_exec_reloc (basic-cpu)
[734.383135] Subtest basic-cpu: SKIP (0.000s)
[734.468632] [072/133] (296s left) kms_psr (psr2-primary-mmap-cpu)
[734.555596] Starting subtest: psr2-primary-mmap-cpu
[734.556606] Starting dynamic subtest: eDP-1
[736.259407] Dynamic subtest eDP-1: SUCCESS (1.703s)
[736.260347] Subtest psr2-primary-mmap-cpu: SUCCESS (1.704s)
[737.109560] [073/133] (294s left) sriov_basic (enable-vfs-autoprobe-on)
[737.162908] Starting subtest: enable-vfs-autoprobe-on
[737.163884] Starting dynamic subtest: numvfs-1
[737.191656] Dynamic subtest numvfs-1: FAIL (0.005s)
[737.200105] Starting dynamic subtest: numvfs-2
[737.227389] Dynamic subtest numvfs-2: FAIL (0.004s)
[737.235014] Starting dynamic subtest: numvfs-3
[737.262637] Dynamic subtest numvfs-3: FAIL (0.003s)
[737.270846] Starting dynamic subtest: numvfs-4
[737.298376] Dynamic subtest numvfs-4: FAIL (0.003s)
[737.306634] Starting dynamic subtest: numvfs-5
[737.332090] Dynamic subtest numvfs-5: FAIL (0.004s)
[737.340344] Starting dynamic subtest: numvfs-6
[737.368309] Dynamic subtest numvfs-6: FAIL (0.003s)
[737.376660] Starting dynamic subtest: numvfs-7
[737.402565] Dynamic subtest numvfs-7: FAIL (0.004s)
[737.409956] Starting dynamic subtest: numvfs-random
[737.434823] Dynamic subtest numvfs-random: FAIL (0.003s)
[737.442290] Starting dynamic subtest: numvfs-all
[737.467424] Dynamic subtest numvfs-all: FAIL (0.004s)
[737.468242] Subtest enable-vfs-autoprobe-on: FAIL (0.040s)
[737.496441] [074/133] (293s left) i915_pm_freq_api (freq-reset)
[737.543297] Starting subtest: freq-reset
[737.544134] Starting dynamic subtest: gt0
[737.736176] Dynamic subtest gt0: SUCCESS (0.192s)
[737.744155] Starting dynamic subtest: gt1
[737.913717] Dynamic subtest gt1: SUCCESS (0.167s)
[737.915018] Subtest freq-reset: SUCCESS (0.361s)
[737.951433] [075/133] (293s left) gem_exec_nop (basic-parallel)
[738.015305] Starting subtest: basic-parallel
[753.979095] Subtest basic-parallel: SUCCESS (15.958s)
[754.193861] [076/133] (277s left) kms_rotation_crc (primary-y-tiled-reflect-x-180)
[754.291287] Starting subtest: primary-y-tiled-reflect-x-180
[754.351925] Subtest primary-y-tiled-reflect-x-180: SKIP (0.060s)
[754.429465] [077/133] (277s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[754.535280] Starting subtest: fbc-psr2-cursor-plane-update-sf
[754.536023] Starting dynamic subtest: pipe-A-eDP-1
[754.614029] Dynamic subtest pipe-A-eDP-1: SKIP (0.077s)
[754.625180] Starting dynamic subtest: pipe-B-eDP-1
[755.723022] Dynamic subtest pipe-B-eDP-1: SKIP (1.108s)
[755.724807] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (1.188s)
[756.896557] [078/133] (274s left) syncobj_timeline (reset-multiple-signaled)
[756.962571] Starting subtest: reset-multiple-signaled
[756.963514] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[757.046592] [079/133] (274s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[757.140022] Starting subtest: 4-tiled-8bpp-rotate-270
[757.162437] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.020s)
[757.247833] [080/133] (274s left) gem_spin_batch (resubmit-new)
[757.311785] Starting subtest: resubmit-new
[757.312850] Starting dynamic subtest: rcs0
[757.320318] Dynamic subtest rcs0: SUCCESS (0.008s)
[757.330702] Starting dynamic subtest: bcs0
[757.331632] Dynamic subtest bcs0: SUCCESS (0.004s)
[757.342433] Starting dynamic subtest: vcs0
[757.343169] Dynamic subtest vcs0: SUCCESS (0.004s)
[757.351076] Starting dynamic subtest: vcs1
[757.352034] Dynamic subtest vcs1: SUCCESS (0.004s)
[757.359885] Starting dynamic subtest: vecs0
[757.360726] Dynamic subtest vecs0: SUCCESS (0.004s)
[757.368619] Starting dynamic subtest: ccs0
[757.369477] Dynamic subtest ccs0: SUCCESS (0.004s)
[757.370310] Subtest resubmit-new: SUCCESS (0.034s)
[758.982730] [081/133] (272s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[759.087013] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip
[760.109569] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.023s)
[760.230879] [082/133] (271s left) kms_pm_dc (dc3co-vpb-simulation)
[761.332427] Starting subtest: dc3co-vpb-simulation
[769.967287] Subtest dc3co-vpb-simulation: SKIP (8.591s)
[770.050273] [083/133] (261s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt)
[770.148210] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt
[770.150155] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[770.235565] [084/133] (261s left) perf_pmu (init-busy)
[770.271421] Starting subtest: init-busy
[770.272314] Starting dynamic subtest: rcs0
[770.273200] Dynamic subtest rcs0: SUCCESS (0.001s)
[770.283815] Starting dynamic subtest: bcs0
[770.284787] Dynamic subtest bcs0: SUCCESS (0.000s)
[770.293408] Starting dynamic subtest: vcs0
[770.294307] Dynamic subtest vcs0: SUCCESS (0.001s)
[770.302411] Starting dynamic subtest: vcs1
[770.303323] Dynamic subtest vcs1: SUCCESS (0.001s)
[770.311146] Starting dynamic subtest: vecs0
[770.312078] Dynamic subtest vecs0: SUCCESS (0.001s)
[770.319693] Starting dynamic subtest: ccs0
[770.320605] Dynamic subtest ccs0: SUCCESS (0.000s)
[770.321515] Subtest init-busy: SUCCESS (0.007s)
[770.376903] [085/133] (261s left) gem_sync (basic-all)
[770.443796] Starting subtest: basic-all
[774.009809] Subtest basic-all: SUCCESS (3.558s)
[774.158555] [086/133] (257s left) syncobj_wait (single-wait-for-submit-submitted)
[774.215265] Starting subtest: single-wait-for-submit-submitted
[774.317915] Subtest single-wait-for-submit-submitted: SUCCESS (0.101s)
[774.365615] [087/133] (257s left) gem_exec_reloc (basic-active)
[774.421489] Subtest basic-active: SKIP (0.000s)
[774.506625] [088/133] (257s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[774.616958] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[774.617946] Starting dynamic subtest: pipe-A
[774.635511] Dynamic subtest pipe-A: SKIP (0.017s)
[774.643972] Starting dynamic subtest: pipe-B
[774.665873] Dynamic subtest pipe-B: SKIP (0.030s)
[774.674495] Starting dynamic subtest: pipe-C
[774.696534] Dynamic subtest pipe-C: SKIP (0.030s)
[774.704810] Starting dynamic subtest: pipe-D
[774.726964] Dynamic subtest pipe-D: SKIP (0.030s)
[774.728744] Subtest planes-downscale-factor-0-5-unity-scaling: SKIP (0.109s)
[774.814942] [089/133] (257s left) gem_ctx_isolation (nonpriv)
[774.876426] Starting subtest: nonpriv
[774.877367] Starting dynamic subtest: rcs0
[775.111483] Dynamic subtest rcs0: SUCCESS (0.235s)
[775.123677] Starting dynamic subtest: bcs0
[775.385020] Dynamic subtest bcs0: SUCCESS (0.273s)
[775.396117] Starting dynamic subtest: vcs0
[775.662911] Dynamic subtest vcs0: SUCCESS (0.277s)
[775.673509] Starting dynamic subtest: vcs1
[777.268618] Dynamic subtest vcs1: SUCCESS (1.605s)
[777.279332] Starting dynamic subtest: vecs0
[779.251335] Dynamic subtest vecs0: SUCCESS (1.982s)
[779.262389] Starting dynamic subtest: ccs0
[781.236409] Dynamic subtest ccs0: SUCCESS (1.985s)
[781.237460] Subtest nonpriv: SUCCESS (6.361s)
[781.460301] [090/133] (250s left) kms_async_flips (crc)
[781.555218] Starting subtest: crc
[781.929459] Starting dynamic subtest: pipe-A-eDP-1
[784.835431] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.906s)
[785.214325] Starting dynamic subtest: pipe-B-eDP-1
[788.170829] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.965s)
[788.545608] Starting dynamic subtest: pipe-C-eDP-1
[791.468876] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.931s)
[791.830438] Starting dynamic subtest: pipe-D-eDP-1
[794.712652] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.891s)
[794.713558] Subtest crc: SUCCESS (13.160s)
[795.829115] [091/133] (236s left) i915_pm_rps (engine-order)
[795.881972] Starting subtest: engine-order
[801.893265] Subtest engine-order: SUCCESS (6.007s)
[802.006784] [092/133] (230s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-cpu)
[802.108030] Starting subtest: fbc-rgb101010-draw-mmap-cpu
[806.663813] Subtest fbc-rgb101010-draw-mmap-cpu: SUCCESS (4.557s)
[807.747473] [093/133] (224s left) gem_exec_fence (parallel)
[807.932732] Starting subtest: parallel
[807.933836] Starting dynamic subtest: rcs0
[810.077613] Dynamic subtest rcs0: SUCCESS (2.151s)
[810.087635] Starting dynamic subtest: bcs0
[812.229724] Dynamic subtest bcs0: SUCCESS (2.152s)
[812.240622] Starting dynamic subtest: vcs0
[814.383275] Dynamic subtest vcs0: SUCCESS (2.153s)
[814.395067] Starting dynamic subtest: vcs1
[816.535169] Dynamic subtest vcs1: SUCCESS (2.152s)
[816.545395] Starting dynamic subtest: vecs0
[818.693479] Dynamic subtest vecs0: SUCCESS (2.157s)
[818.709205] Starting dynamic subtest: ccs0
[820.843552] Dynamic subtest ccs0: SUCCESS (2.149s)
[820.844417] Subtest parallel: SUCCESS (12.920s)
[822.062360] [094/133] (210s left) syncobj_timeline (wait-all-for-submit-complex)
[822.112785] Starting subtest: wait-all-for-submit-complex
[822.335567] Subtest wait-all-for-submit-complex: SUCCESS (0.213s)
[822.374799] [095/133] (209s left) kms_lease (lease-invalid-connector)
[822.475969] Starting subtest: lease-invalid-connector
[822.476976] Starting dynamic subtest: pipe-A-eDP-1
[822.477879] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[822.487875] Starting dynamic subtest: pipe-B-eDP-1
[822.488776] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[822.496874] Starting dynamic subtest: pipe-C-eDP-1
[822.497670] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[822.505577] Starting dynamic subtest: pipe-D-eDP-1
[822.506415] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[822.507230] Subtest lease-invalid-connector: SUCCESS (0.004s)
[822.535697] [096/133] (209s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled-ccs)
[822.596058] Starting subtest: yf-tiled-ccs-to-yf-tiled-ccs
[822.597948] Subtest yf-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[822.751256] [097/133] (209s left) kms_psr (fbc-psr2-sprite-plane-move)
[822.836088] Starting subtest: fbc-psr2-sprite-plane-move
[822.836979] Starting dynamic subtest: eDP-1
[822.838852] Dynamic subtest eDP-1: SKIP (0.000s)
[822.840786] Subtest fbc-psr2-sprite-plane-move: SKIP (0.001s)
[822.880036] [098/133] (209s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[822.974764] Starting subtest: y-tiled-64bpp-rotate-270
[822.976673] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[823.035754] [099/133] (209s left) gem_exec_schedule (semaphore-noskip)
[823.098765] Starting subtest: semaphore-noskip
[823.521927] Subtest semaphore-noskip: SUCCESS (0.413s)
[823.842805] [100/133] (208s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-pgflip-blt)
[823.944641] Starting subtest: psr-2p-primscrn-indfb-pgflip-blt
[823.946427] Subtest psr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[824.035132] [101/133] (208s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-atomic)
[824.154935] Starting subtest: flip-vs-cursor-busy-crc-atomic
[824.970056] Subtest flip-vs-cursor-busy-crc-atomic: SUCCESS (0.813s)
[825.761864] [102/133] (206s left) gem_exec_flush (basic-uc-pro-default)
[825.828572] Starting subtest: basic-uc-pro-default
[831.284587] Subtest basic-uc-pro-default: SUCCESS (5.456s)
[831.444341] [103/133] (201s left) gem_exec_balancer (bonded-dual)
[831.512732] Starting subtest: bonded-dual
[831.514487] Subtest bonded-dual: SKIP (0.000s)
[831.781928] [104/133] (200s left) kms_psr (fbc-pr-sprite-blt)
[831.878412] Starting subtest: fbc-pr-sprite-blt
[831.880140] Subtest fbc-pr-sprite-blt: SKIP (0.000s)
[831.921919] [105/133] (200s left) gem_gpgpu_fill (offset-16x16)
[831.982201] Starting subtest: offset-16x16
[831.988228] Subtest offset-16x16: SUCCESS (0.007s)
[832.118403] [106/133] (200s left) kms_atomic (plane-primary-overlay-mutable-zpos)
[832.207527] Starting subtest: plane-primary-overlay-mutable-zpos
[835.633838] Subtest plane-primary-overlay-mutable-zpos: SKIP (3.427s)
[836.796549] [107/133] (195s left) gem_pread (snoop)
[836.849025] Subtest snoop: SKIP (0.000s)
[836.905615] [108/133] (195s left) gem_mmap_gtt (hang-busy)
[836.952818] Subtest hang-busy: SKIP (0.000s)
[837.028392] [109/133] (195s left) gem_mmap_wc (fault-concurrent)
[837.080147] Subtest fault-concurrent: SKIP (0.000s)
[837.144344] [110/133] (195s left) kms_content_protection (suspend-resume)
[837.284197] Starting subtest: suspend-resume
[837.286117] Subtest suspend-resume: SKIP (0.000s)
[837.407141] [111/133] (195s left) gem_exec_alignment (forked)
[837.471682] Starting subtest: forked
[876.509196] Subtest forked: SUCCESS (39.035s)
[876.790092] [112/133] (156s left) syncobj_wait (multi-wait-all-submitted-signaled)
[876.892532] Starting subtest: multi-wait-all-submitted-signaled
[876.997507] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.104s)
[877.045984] [113/133] (155s left) gem_exec_params (invalid-bsd2-flag-on-blt)
[877.098774] Starting subtest: invalid-bsd2-flag-on-blt
[877.100344] Subtest invalid-bsd2-flag-on-blt: SUCCESS (0.000s)
[877.187489] [114/133] (155s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-downscaling)
[877.304502] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-downscaling
[877.305515] Starting dynamic subtest: pipe-A-default-mode
[878.464938] Dynamic subtest pipe-A-default-mode: SKIP (1.159s)
[878.466714] Subtest flip-64bpp-4tile-to-32bpp-4tile-downscaling: SKIP (1.161s)
[878.606420] [115/133] (154s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-signaled)
[878.664190] Starting subtest: etime-multi-wait-all-available-unsubmitted-signaled
[878.765847] Subtest etime-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.102s)
[878.816922] [116/133] (154s left) gem_madvise (dontneed-after-mmap)
[878.849030] Starting subtest: dontneed-after-mmap
[878.877495] Subtest dontneed-after-mmap: SUCCESS (0.029s)
[878.962844] [117/133] (153s left) kms_dsc (dsc-fractional-bpp-with-bpc)
[879.057417] Starting subtest: dsc-fractional-bpp-with-bpc
[879.068354] Subtest dsc-fractional-bpp-with-bpc: SKIP (0.001s)
[879.104702] [118/133] (153s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[879.214061] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[883.340502] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (4.132s)
[884.507535] [119/133] (148s left) kms_ccs (bad-rotation-90-yf-tiled-ccs)
[884.606565] Starting subtest: bad-rotation-90-yf-tiled-ccs
[884.607422] Starting dynamic subtest: pipe-A-eDP-1
[884.615310] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[884.624932] Starting dynamic subtest: pipe-B-eDP-1
[884.634449] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[884.643318] Starting dynamic subtest: pipe-C-eDP-1
[884.651236] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[884.659868] Starting dynamic subtest: pipe-D-eDP-1
[884.668195] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[884.669789] Subtest bad-rotation-90-yf-tiled-ccs: SKIP (0.004s)
[886.785499] [120/133] (146s left) gem_mmap_offset (pf-nonblock)
[886.836667] Starting subtest: pf-nonblock
[886.842123] Subtest pf-nonblock: SUCCESS (0.007s)
[886.959525] [121/133] (146s left) kms_cursor_crc (cursor-offscreen-512x170)
[887.245681] Starting subtest: cursor-offscreen-512x170
[887.247276] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[887.391502] [122/133] (145s left) sw_sync (sync_multi_timeline_wait)
[887.421849] Starting subtest: sync_multi_timeline_wait
[887.422709] Subtest sync_multi_timeline_wait: SUCCESS (0.000s)
[887.452662] [123/133] (145s left) gem_ctx_persistence (processes)
[887.517026] Starting subtest: processes
[889.021671] Subtest processes: SUCCESS (1.503s)
[889.070647] [124/133] (144s left) kms_plane_alpha_blend (coverage-7efc)
[889.161764] Starting subtest: coverage-7efc
[889.450485] Starting dynamic subtest: pipe-A-eDP-1
[890.050244] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.598s)
[890.083200] Starting dynamic subtest: pipe-D-eDP-1
[891.349330] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.274s)
[891.350165] Subtest coverage-7efc: SUCCESS (2.187s)
[892.163529] [125/133] (141s left) i915_drm_fdinfo (memory-info-idle)
[892.206733] Starting subtest: memory-info-idle
[892.207596] Starting dynamic subtest: smem0
[892.285440] Dynamic subtest smem0: SUCCESS (0.080s)
[892.286562] Subtest memory-info-idle: SUCCESS (0.081s)
[892.337834] [126/133] (140s left) kms_psr2_sf (fbc-psr2-primary-plane-update-sf-dmg-area)
[892.428224] Starting subtest: fbc-psr2-primary-plane-update-sf-dmg-area
[892.429103] Starting dynamic subtest: pipe-A-eDP-1
[892.527992] Dynamic subtest pipe-A-eDP-1: SKIP (0.099s)
[892.539637] Starting dynamic subtest: pipe-B-eDP-1
[893.652834] Dynamic subtest pipe-B-eDP-1: SKIP (1.123s)
[893.654479] Subtest fbc-psr2-primary-plane-update-sf-dmg-area: SKIP (1.225s)
[894.833597] [127/133] (138s left) vgem_slow (nohang)
[894.876751] Starting subtest: nohang
[905.403771] Subtest nohang: SUCCESS (10.475s)
[905.436674] [128/133] (127s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-upscaling)
[905.534076] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-upscaling
[905.535824] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-upscaling: SKIP (0.000s)
[905.579036] [129/133] (127s left) syncobj_wait (wait-all-delayed-signal)
[905.636332] Starting subtest: wait-all-delayed-signal
[905.739900] Subtest wait-all-delayed-signal: SUCCESS (0.103s)
[905.790472] [130/133] (127s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier)
[905.891366] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier
[905.893235] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier: SKIP (0.000s)
[905.935955] [131/133] (127s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs)
[906.018266] Starting subtest: ccs-on-another-bo-yf-tiled-ccs
[906.019105] Starting dynamic subtest: pipe-A-eDP-1
[906.027614] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[906.036584] Starting dynamic subtest: pipe-B-eDP-1
[906.045077] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[906.056145] Starting dynamic subtest: pipe-C-eDP-1
[906.065017] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[906.074577] Starting dynamic subtest: pipe-D-eDP-1
[906.090499] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[906.092247] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.005s)
[908.213178] [132/133] (125s left) kms_getfb (getfb-handle-closed)
[908.316346] Starting subtest: getfb-handle-closed
[908.317180] Subtest getfb-handle-closed: SUCCESS (0.000s)
[908.393512] [133/133] (125s left) kms_busy (extended-pageflip-modeset-hang-oldfb)
[908.486309] Starting subtest: extended-pageflip-modeset-hang-oldfb
[908.487143] Starting dynamic subtest: pipe-A
[916.410660] Dynamic subtest pipe-A: SUCCESS (7.920s)
[916.420248] Starting dynamic subtest: pipe-D
[925.077036] Dynamic subtest pipe-D: SUCCESS (8.660s)
[925.078163] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (16.585s)
[925.886550] Closing watchdogs
results: parsing output: 0/ for test: kms_addfb_basic
results: parsing output: 1/ for test: gem_userptr_blits
results: parsing output: 2/ for test: gem_exec_reloc
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: kms_invalid_mode
results: parsing output: 5/ for test: gem_exec_schedule
results: parsing output: 6/ for test: kms_ccs
results: parsing output: 7/ for test: syncobj_timeline
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: kms_dirtyfb
results: parsing output: 10/ for test: gen7_exec_parse
results: parsing output: 11/ for test: kms_psr
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: gem_vm_create
results: parsing output: 14/ for test: i915_selftest
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: gem_userptr_blits
results: parsing output: 17/ for test: drm_buddy
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: fbdev
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: kms_vblank
results: parsing output: 22/ for test: kms_cursor_crc
results: parsing output: 23/ for test: gem_ctx_engines
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: syncobj_timeline
results: parsing output: 27/ for test: kms_cursor_edge_walk
results: parsing output: 28/ for test: kms_vrr
results: parsing output: 29/ for test: gem_render_copy
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: kms_getfb
results: parsing output: 33/ for test: kms_pm_rpm
results: parsing output: 34/ for test: syncobj_timeline
results: parsing output: 35/ for test: kms_chamelium_hpd
results: parsing output: 36/ for test: kms_ccs
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: gem_exec_balancer
results: parsing output: 39/ for test: kms_setmode
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_color
results: parsing output: 42/ for test: gem_lmem_swapping
results: parsing output: 43/ for test: kms_flip
results: parsing output: 44/ for test: kms_chamelium_color
results: parsing output: 45/ for test: api_intel_bb
results: parsing output: 46/ for test: kms_cursor_legacy
results: parsing output: 47/ for test: gem_userptr_blits
results: parsing output: 48/ for test: gem_exec_schedule
results: parsing output: 49/ for test: kms_force_connector_basic
results: parsing output: 50/ for test: syncobj_wait
results: parsing output: 51/ for test: kms_cursor_legacy
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: core_auth
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: gem_exec_reloc
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: syncobj_basic
results: parsing output: 59/ for test: kms_plane
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_flip
results: parsing output: 62/ for test: kms_ccs
results: parsing output: 63/ for test: kms_psr
results: parsing output: 64/ for test: kms_plane_scaling
results: parsing output: 65/ for test: sw_sync
results: parsing output: 66/ for test: kms_selftest
results: parsing output: 67/ for test: gem_userptr_blits
results: parsing output: 68/ for test: perf_pmu
results: parsing output: 69/ for test: kms_flip
results: parsing output: 70/ for test: gem_exec_reloc
results: parsing output: 71/ for test: kms_psr
results: parsing output: 72/ for test: sriov_basic
results: parsing output: 73/ for test: i915_pm_freq_api
results: parsing output: 74/ for test: gem_exec_nop
results: parsing output: 75/ for test: kms_rotation_crc
results: parsing output: 76/ for test: kms_psr2_sf
results: parsing output: 77/ for test: syncobj_timeline
results: parsing output: 78/ for test: kms_big_fb
results: parsing output: 79/ for test: gem_spin_batch
results: parsing output: 80/ for test: kms_big_fb
results: parsing output: 81/ for test: kms_pm_dc
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: perf_pmu
results: parsing output: 84/ for test: gem_sync
results: parsing output: 85/ for test: syncobj_wait
results: parsing output: 86/ for test: gem_exec_reloc
results: parsing output: 87/ for test: kms_plane_scaling
results: parsing output: 88/ for test: gem_ctx_isolation
results: parsing output: 89/ for test: kms_async_flips
results: parsing output: 90/ for test: i915_pm_rps
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: gem_exec_fence
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: kms_lease
results: parsing output: 95/ for test: gem_render_copy
results: parsing output: 96/ for test: kms_psr
results: parsing output: 97/ for test: kms_big_fb
results: parsing output: 98/ for test: gem_exec_schedule
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_cursor_legacy
results: parsing output: 101/ for test: gem_exec_flush
results: parsing output: 102/ for test: gem_exec_balancer
results: parsing output: 103/ for test: kms_psr
results: parsing output: 104/ for test: gem_gpgpu_fill
results: parsing output: 105/ for test: kms_atomic
results: parsing output: 106/ for test: gem_pread
results: parsing output: 107/ for test: gem_mmap_gtt
results: parsing output: 108/ for test: gem_mmap_wc
results: parsing output: 109/ for test: kms_content_protection
results: parsing output: 110/ for test: gem_exec_alignment
results: parsing output: 111/ for test: syncobj_wait
results: parsing output: 112/ for test: gem_exec_params
results: parsing output: 113/ for test: kms_flip_scaled_crc
results: parsing output: 114/ for test: syncobj_timeline
results: parsing output: 115/ for test: gem_madvise
results: parsing output: 116/ for test: kms_dsc
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: gem_mmap_offset
results: parsing output: 120/ for test: kms_cursor_crc
results: parsing output: 121/ for test: sw_sync
results: parsing output: 122/ for test: gem_ctx_persistence
results: parsing output: 123/ for test: kms_plane_alpha_blend
results: parsing output: 124/ for test: i915_drm_fdinfo
results: parsing output: 125/ for test: kms_psr2_sf
results: parsing output: 126/ for test: vgem_slow
results: parsing output: 127/ for test: kms_flip_scaled_crc
results: parsing output: 128/ for test: syncobj_wait
results: parsing output: 129/ for test: kms_plane
results: parsing output: 130/ for test: kms_ccs
results: parsing output: 131/ for test: kms_getfb
results: parsing output: 132/ for test: kms_busy
Done.