[59.620688] Initializing watchdogs
[59.620737]   /dev/watchdog0
[59.634607] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[59.638854] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.641154] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.644356] [001/132] (960s left) kms_lease (lease-revoke)
[59.776166] Starting subtest: lease-revoke
[59.778458] Starting dynamic subtest: pipe-A-eDP-1
[59.813402] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.034s)
[59.827764] Starting dynamic subtest: pipe-B-eDP-1
[59.840427] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.027s)
[59.850001] Starting dynamic subtest: pipe-C-eDP-1
[59.871098] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.029s)
[59.881613] Starting dynamic subtest: pipe-D-eDP-1
[59.899145] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.027s)
[59.901553] Subtest lease-revoke: SUCCESS (0.120s)
[60.003834] [002/132] (960s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs)
[60.102078] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs
[60.104378] Starting dynamic subtest: pipe-A-eDP-1
[60.129953] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[60.140151] Starting dynamic subtest: pipe-B-eDP-1
[60.163453] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[60.170524] Starting dynamic subtest: pipe-C-eDP-1
[60.194304] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[60.202370] Starting dynamic subtest: pipe-D-eDP-1
[60.226303] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[60.230783] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.003s)
[62.423189] [003/132] (957s left) syncobj_eventfd (timeline-wait-before-signal)
[62.479678] Starting subtest: timeline-wait-before-signal
[62.510858] Subtest timeline-wait-before-signal: SUCCESS (0.031s)
[62.581809] [004/132] (957s left) kms_psr (fbc-psr-no-drrs)
[62.673893] Starting subtest: fbc-psr-no-drrs
[62.676294] Starting dynamic subtest: eDP-1
[62.680456] Dynamic subtest eDP-1: SKIP (0.000s)
[62.684659] Subtest fbc-psr-no-drrs: SKIP (0.000s)
[62.751776] [005/132] (957s left) kms_big_fb (linear-16bpp-rotate-270)
[62.851173] Starting subtest: linear-16bpp-rotate-270
[62.873594] Subtest linear-16bpp-rotate-270: SKIP (0.022s)
[63.007857] [006/132] (957s left) gem_pxp (create-valid-protected-context)
[63.131900] Starting subtest: create-valid-protected-context
[63.134496] Subtest create-valid-protected-context: SUCCESS (0.002s)
[63.257926] [007/132] (957s left) syncobj_wait (invalid-multi-wait-unsubmitted)
[63.322556] Starting subtest: invalid-multi-wait-unsubmitted
[63.324468] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[63.423842] [008/132] (956s left) kms_cursor_crc (cursor-alpha-transparent)
[63.512688] Starting subtest: cursor-alpha-transparent
[63.514607] Starting dynamic subtest: pipe-A-eDP-1
[64.150052] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.635s)
[64.159223] Starting dynamic subtest: pipe-D-eDP-1
[65.428632] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.272s)
[65.431001] Subtest cursor-alpha-transparent: SUCCESS (1.910s)
[66.219853] [009/132] (954s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-render)
[66.329848] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-render
[73.137578] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.797s)
[73.297589] [010/132] (947s left) kms_addfb_basic (master-rmfb)
[73.352736] Starting subtest: master-rmfb
[73.354974] Subtest master-rmfb: SUCCESS (0.001s)
[73.486829] [011/132] (947s left) kms_psr (fbc-psr2-no-drrs)
[73.584196] Starting subtest: fbc-psr2-no-drrs
[73.586374] Starting dynamic subtest: eDP-1
[73.590674] Dynamic subtest eDP-1: SKIP (0.000s)
[73.594972] Subtest fbc-psr2-no-drrs: SKIP (0.000s)
[73.650528] [012/132] (946s left) kms_cursor_edge_walk (256x256-left-edge)
[73.741332] Starting subtest: 256x256-left-edge
[73.743680] Starting dynamic subtest: pipe-A-eDP-1
[77.234350] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.489s)
[77.243405] Starting dynamic subtest: pipe-D-eDP-1
[80.355080] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.117s)
[80.357455] Subtest 256x256-left-edge: SUCCESS (6.608s)
[81.186159] [013/132] (939s left) gem_eio (create-ext)
[81.375610] Starting subtest: create-ext
[81.633735] Subtest create-ext: SUCCESS (0.256s)
[81.744324] [014/132] (938s left) gem_mmap_gtt (hang-busy)
[81.800713] Subtest hang-busy: SKIP (0.000s)
[81.859262] [015/132] (938s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[81.951917] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[81.954181] Starting dynamic subtest: pipe-A-eDP-1
[81.963061] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[81.972194] Starting dynamic subtest: pipe-B-eDP-1
[81.980881] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[81.990279] Starting dynamic subtest: pipe-C-eDP-1
[81.997424] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[82.004341] Starting dynamic subtest: pipe-D-eDP-1
[82.012523] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[82.016583] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.006s)
[84.163361] [016/132] (936s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-blt)
[84.256775] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-blt
[91.112360] Subtest psr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (6.854s)
[91.221455] [017/132] (929s left) gem_userptr_blits (invalid-null-pointer)
[91.286142] Starting subtest: invalid-null-pointer
[91.288115] Subtest invalid-null-pointer: SUCCESS (0.001s)
[91.406138] [018/132] (929s left) gem_render_copy (yf-tiled-to-vebox-y-tiled)
[91.464569] Starting subtest: yf-tiled-to-vebox-y-tiled
[91.468804] Subtest yf-tiled-to-vebox-y-tiled: SKIP (0.000s)
[91.643899] [019/132] (929s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[91.739825] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc
[91.744346] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[91.846531] [020/132] (928s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[91.934914] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[91.939364] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.000s)
[92.004634] [021/132] (928s left) kms_vblank (wait-idle-hang)
[92.091090] Starting subtest: wait-idle-hang
[92.093439] Starting dynamic subtest: pipe-A-eDP-1
[118.699470] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.598s)
[118.713121] Starting dynamic subtest: pipe-D-eDP-1
[133.655785] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.952s)
[133.657880] Subtest wait-idle-hang: SUCCESS (41.554s)
[134.456950] [022/132] (886s left) gem_partial_pwrite_pread (writes-after-reads-uncached)
[134.528949] Subtest writes-after-reads-uncached: SKIP (0.000s)
[134.598249] [023/132] (886s left) gem_spin_batch (legacy-resubmit)
[134.650794] Starting subtest: legacy-resubmit
[134.653312] Starting dynamic subtest: default
[134.658435] Dynamic subtest default: SUCCESS (0.005s)
[134.669813] Starting dynamic subtest: render
[134.672290] Dynamic subtest render: SUCCESS (0.001s)
[134.680492] Starting dynamic subtest: bsd
[134.682686] Dynamic subtest bsd: SUCCESS (0.002s)
[134.690158] Starting dynamic subtest: bsd1
[134.692297] Dynamic subtest bsd1: SUCCESS (0.003s)
[134.699963] Starting dynamic subtest: bsd2
[134.702168] Dynamic subtest bsd2: SUCCESS (0.001s)
[134.709283] Starting dynamic subtest: blt
[134.711465] Dynamic subtest blt: SUCCESS (0.005s)
[134.718488] Starting dynamic subtest: vebox
[134.720690] Dynamic subtest vebox: SUCCESS (0.004s)
[134.722936] Subtest legacy-resubmit: SUCCESS (0.028s)
[134.898897] [024/132] (886s left) kms_psr (psr2-dpms)
[134.998108] Starting subtest: psr2-dpms
[135.000439] Starting dynamic subtest: eDP-1
[137.910975] Dynamic subtest eDP-1: SUCCESS (2.913s)
[137.913311] Subtest psr2-dpms: SUCCESS (2.914s)
[138.773277] [025/132] (882s left) syncobj_timeline (etime-multi-wait-for-submit-submitted)
[138.851268] Starting subtest: etime-multi-wait-for-submit-submitted
[138.957154] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.106s)
[139.030264] [026/132] (882s left) core_getstats (basic)
[139.096096] Starting subtest: basic
[139.098539] Subtest basic: SUCCESS (0.000s)
[139.185100] [027/132] (881s left) gem_exec_basic (basic)
[139.251953] Starting subtest: basic
[139.255596] Starting dynamic subtest: rcs0-smem
[139.257922] Dynamic subtest rcs0-smem: SUCCESS (0.004s)
[139.265834] Starting dynamic subtest: bcs0-smem
[139.268097] Dynamic subtest bcs0-smem: SUCCESS (0.002s)
[139.275254] Starting dynamic subtest: vcs0-smem
[139.277154] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[139.284068] Starting dynamic subtest: vcs1-smem
[139.285960] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[139.292772] Starting dynamic subtest: vecs0-smem
[139.294659] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[139.301434] Starting dynamic subtest: ccs0-smem
[139.303254] Dynamic subtest ccs0-smem: SUCCESS (0.002s)
[139.305068] Subtest basic: SUCCESS (0.015s)
[140.918476] [028/132] (880s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[141.034784] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[144.707699] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (3.678s)
[145.878795] [029/132] (875s left) i915_drm_fdinfo (busy-idle)
[145.918646] Starting subtest: busy-idle
[145.920688] Starting dynamic subtest: rcs0
[145.946373] Dynamic subtest rcs0: SKIP (0.028s)
[145.956529] Starting dynamic subtest: bcs0
[145.960603] Dynamic subtest bcs0: SKIP (0.000s)
[145.970800] Starting dynamic subtest: vcs0
[145.975134] Dynamic subtest vcs0: SKIP (0.000s)
[145.982033] Starting dynamic subtest: vcs1
[145.986090] Dynamic subtest vcs1: SKIP (0.000s)
[145.993084] Starting dynamic subtest: vecs0
[145.997257] Dynamic subtest vecs0: SKIP (0.000s)
[146.004478] Starting dynamic subtest: ccs0
[146.008637] Dynamic subtest ccs0: SKIP (0.000s)
[146.012840] Subtest busy-idle: SKIP (0.032s)
[146.046277] [030/132] (875s left) kms_plane (pixel-format-yf-tiled-modifier-source-clamping)
[146.156550] Starting subtest: pixel-format-yf-tiled-modifier-source-clamping
[146.160922] Subtest pixel-format-yf-tiled-modifier-source-clamping: SKIP (0.000s)
[146.230264] [031/132] (875s left) gem_pxp (verify-pxp-key-change-after-suspend-resume)
[146.298678] Starting subtest: verify-pxp-key-change-after-suspend-resume
[153.544201] Subtest verify-pxp-key-change-after-suspend-resume: SUCCESS (7.248s)
[153.689927] [032/132] (867s left) gem_exec_whisper (basic-contexts-priority-all)
[153.782567] Starting subtest: basic-contexts-priority-all
[176.011286] Subtest basic-contexts-priority-all: SUCCESS (22.225s)
[176.192259] [033/132] (845s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-blt)
[176.293987] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-blt
[180.736357] Subtest fbc-1p-primscrn-pri-indfb-draw-blt: SUCCESS (4.445s)
[181.947775] [034/132] (839s left) kms_busy (extended-pageflip-hang-oldfb)
[182.044436] Starting subtest: extended-pageflip-hang-oldfb
[182.046822] Starting dynamic subtest: pipe-A
[182.481075] Dynamic subtest pipe-A: SUCCESS (0.433s)
[182.489954] Starting dynamic subtest: pipe-D
[183.637108] Dynamic subtest pipe-D: SUCCESS (1.155s)
[183.639564] Subtest extended-pageflip-hang-oldfb: SUCCESS (1.592s)
[184.478860] [035/132] (836s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[184.597702] Starting subtest: basic-flip-before-cursor-atomic
[185.514043] Subtest basic-flip-before-cursor-atomic: SUCCESS (0.914s)
[186.311296] [036/132] (835s left) gen9_exec_parse (bb-start-param)
[186.362133] Subtest bb-start-param: SKIP (0.000s)
[186.417961] [037/132] (835s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling)
[186.521773] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling
[186.526100] Subtest flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling: SKIP (0.000s)
[186.591667] [038/132] (834s left) kms_big_fb (x-tiled-addfb-size-offset-overflow)
[186.681585] Starting subtest: x-tiled-addfb-size-offset-overflow
[186.683811] Subtest x-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[186.776289] [039/132] (834s left) gem_mmap_gtt (fault-concurrent-x)
[186.827975] Subtest fault-concurrent-X: SKIP (0.000s)
[186.882466] [040/132] (834s left) gem_ctx_persistence (saturated-hostile-nopreempt)
[186.959852] Starting subtest: saturated-hostile-nopreempt
[186.962261] Starting dynamic subtest: rcs0
[187.044475] Dynamic subtest rcs0: SKIP (0.085s)
[187.055258] Starting dynamic subtest: bcs0
[187.068775] Dynamic subtest bcs0: SKIP (0.023s)
[187.077154] Starting dynamic subtest: vcs0
[187.094513] Dynamic subtest vcs0: SKIP (0.025s)
[187.103452] Starting dynamic subtest: vcs1
[187.109782] Dynamic subtest vcs1: SKIP (0.014s)
[187.118709] Starting dynamic subtest: vecs0
[187.126461] Dynamic subtest vecs0: SKIP (0.016s)
[187.135209] Starting dynamic subtest: ccs0
[187.139211] Dynamic subtest ccs0: SKIP (0.012s)
[187.143312] Subtest saturated-hostile-nopreempt: SKIP (0.180s)
[187.210796] [041/132] (834s left) kms_atomic (plane-primary-legacy)
[187.290675] Starting subtest: plane-primary-legacy
[187.292469] Starting dynamic subtest: pipe-A-eDP-1
[187.739254] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.447s)
[187.741446] Subtest plane-primary-legacy: SUCCESS (0.448s)
[188.553092] [042/132] (833s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[188.680719] Starting subtest: cursorA-vs-flipA-toggle
[199.819702] Subtest cursorA-vs-flipA-toggle: SUCCESS (11.136s)
[200.677371] [043/132] (821s left) kms_vblank (query-busy)
[200.776209] Starting subtest: query-busy
[200.778133] Starting dynamic subtest: pipe-A-eDP-1
[202.661862] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.885s)
[202.676208] Starting dynamic subtest: pipe-D-eDP-1
[205.245966] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.581s)
[205.248072] Subtest query-busy: SUCCESS (4.470s)
[206.038741] [044/132] (815s left) kms_dither (fb-8bpc-vs-panel-6bpc)
[206.138952] Starting subtest: fb-8bpc-vs-panel-6bpc
[206.141126] Starting dynamic subtest: pipe-A-eDP-1
[207.495150] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.354s)
[207.497079] Subtest fb-8bpc-vs-panel-6bpc: SUCCESS (1.355s)
[208.289028] [045/132] (813s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[208.386459] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc
[208.390604] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[208.471983] [046/132] (813s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier)
[208.557286] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier
[208.561352] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier: SKIP (0.000s)
[208.674102] [047/132] (813s left) kms_pipe_crc_basic (read-crc)
[208.782246] Starting subtest: read-crc
[208.784601] Starting dynamic subtest: pipe-A-eDP-1
[209.508758] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.724s)
[209.519916] Starting dynamic subtest: pipe-B-eDP-1
[210.877127] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.365s)
[210.888342] Starting dynamic subtest: pipe-C-eDP-1
[212.167968] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.293s)
[212.178363] Starting dynamic subtest: pipe-D-eDP-1
[213.497414] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.327s)
[213.499858] Subtest read-crc: SUCCESS (4.715s)
[214.321432] [048/132] (807s left) syncobj_timeline (multi-wait-all-for-submit-signaled)
[214.388593] Starting subtest: multi-wait-all-for-submit-signaled
[214.391046] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.001s)
[214.488441] [049/132] (807s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs)
[214.574512] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs
[214.576999] Starting dynamic subtest: pipe-A-eDP-1
[214.603264] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[214.614648] Starting dynamic subtest: pipe-B-eDP-1
[214.638103] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[214.647488] Starting dynamic subtest: pipe-C-eDP-1
[214.670568] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[214.682575] Starting dynamic subtest: pipe-D-eDP-1
[214.707975] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[214.712054] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.004s)
[216.889597] [050/132] (805s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[216.984649] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[216.989087] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[217.078226] [051/132] (804s left) kms_big_fb (x-tiled-8bpp-rotate-90)
[217.170797] Starting subtest: x-tiled-8bpp-rotate-90
[217.191876] Subtest x-tiled-8bpp-rotate-90: SKIP (0.021s)
[217.316931] [052/132] (804s left) gem_exec_fence (syncobj-invalid-wait)
[217.803323] Starting subtest: syncobj-invalid-wait
[217.805706] Subtest syncobj-invalid-wait: SUCCESS (0.001s)
[218.952422] [FACT gem_exec_fence (syncobj-invalid-wait)] new: kernel.kmod_is_loaded.vgem: true
[218.956843] [053/132] (803s left) gem_exec_schedule (u-independent)
[219.038367] Starting subtest: u-independent
[219.040380] Starting dynamic subtest: rcs0
[220.887625] Dynamic subtest rcs0: SUCCESS (1.856s)
[220.902358] Starting dynamic subtest: vcs0
[222.940244] Dynamic subtest vcs0: SUCCESS (2.051s)
[222.952143] Starting dynamic subtest: vcs1
[224.932306] Dynamic subtest vcs1: SUCCESS (1.991s)
[224.944653] Starting dynamic subtest: vecs0
[226.916575] Dynamic subtest vecs0: SUCCESS (1.981s)
[226.929419] Starting dynamic subtest: ccs0
[228.887635] Dynamic subtest ccs0: SUCCESS (1.969s)
[228.890509] Subtest u-independent: SUCCESS (9.857s)
[229.189453] [054/132] (792s left) api_intel_allocator (simple-allocator)
[229.240283] Starting subtest: simple-allocator
[229.242564] Starting dynamic subtest: basic
[229.244890] Dynamic subtest basic: SUCCESS (0.004s)
[229.257664] Starting dynamic subtest: parallel-one
[229.411024] Dynamic subtest parallel-one: SUCCESS (0.167s)
[229.420595] Starting dynamic subtest: print
[229.422785] Dynamic subtest print: SUCCESS (0.000s)
[229.432186] Starting dynamic subtest: reuse
[229.434310] Dynamic subtest reuse: SUCCESS (0.000s)
[229.443240] Starting dynamic subtest: reserve
[229.445430] Dynamic subtest reserve: SUCCESS (0.000s)
[229.454165] Starting dynamic subtest: fork-reopen-allocator
[229.456411] Dynamic subtest fork-reopen-allocator: SUCCESS (0.011s)
[229.458734] Subtest simple-allocator: SUCCESS (0.188s)
[229.563025] [055/132] (792s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0)
[229.670669] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0
[229.675251] Subtest y-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[229.767010] [056/132] (792s left) gem_exec_parallel (contexts)
[229.819168] Starting subtest: contexts
[229.821410] Starting dynamic subtest: rcs0
[232.697396] Dynamic subtest rcs0: SUCCESS (2.876s)
[232.709664] Starting dynamic subtest: bcs0
[236.044063] Dynamic subtest bcs0: SUCCESS (3.344s)
[236.055524] Starting dynamic subtest: vcs0
[240.322474] Dynamic subtest vcs0: SUCCESS (4.277s)
[240.331933] Starting dynamic subtest: vcs1
[244.373612] Dynamic subtest vcs1: SUCCESS (4.050s)
[244.383775] Starting dynamic subtest: vecs0
[248.430465] Dynamic subtest vecs0: SUCCESS (4.055s)
[248.443097] Starting dynamic subtest: ccs0
[252.094926] Dynamic subtest ccs0: SUCCESS (3.662s)
[252.098045] Subtest contexts: SUCCESS (22.273s)
[252.296765] [057/132] (770s left) kms_psr2_su (frontbuffer-xrgb8888)
[252.361780] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[252.418796] [058/132] (769s left) i915_pm_freq_api (freq-suspend)
[252.499376] Starting subtest: freq-suspend
[252.501801] Starting dynamic subtest: gt0
[268.190585] Dynamic subtest gt0: SUCCESS (1.249s)
[268.209166] Starting dynamic subtest: gt1
[284.209920] Dynamic subtest gt1: SUCCESS (1.217s)
[284.212730] Subtest freq-suspend: SUCCESS (2.470s)
[285.319805] [059/132] (738s left) kms_plane_cursor (primary)
[285.419576] Starting subtest: primary
[285.424034] Starting dynamic subtest: pipe-A-eDP-1-size-64
[288.099818] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.601s)
[288.126415] Starting dynamic subtest: pipe-A-eDP-1-size-128
[290.713722] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.539s)
[290.738837] Starting dynamic subtest: pipe-A-eDP-1-size-256
[293.354224] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.583s)
[293.677033] Starting dynamic subtest: pipe-B-eDP-1-size-64
[297.009546] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.313s)
[297.034589] Starting dynamic subtest: pipe-B-eDP-1-size-128
[299.674023] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.627s)
[299.697593] Starting dynamic subtest: pipe-B-eDP-1-size-256
[302.265686] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.561s)
[302.590827] Starting dynamic subtest: pipe-C-eDP-1-size-64
[305.501462] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.917s)
[305.529129] Starting dynamic subtest: pipe-C-eDP-1-size-128
[307.707266] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.181s)
[307.734436] Starting dynamic subtest: pipe-C-eDP-1-size-256
[309.912567] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.181s)
[310.245435] Starting dynamic subtest: pipe-D-eDP-1-size-64
[313.209973] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.973s)
[313.237053] Starting dynamic subtest: pipe-D-eDP-1-size-128
[315.423221] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.192s)
[315.450562] Starting dynamic subtest: pipe-D-eDP-1-size-256
[317.645557] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.203s)
[317.960344] Subtest primary: SUCCESS (32.266s)
[318.814119] [060/132] (704s left) kms_color (ctm-0-50)
[318.910065] Starting subtest: ctm-0-50
[318.912332] Starting dynamic subtest: pipe-A-eDP-1
[322.437621] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.527s)
[322.453405] Starting dynamic subtest: pipe-B-eDP-1
[326.609029] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.167s)
[326.618404] Starting dynamic subtest: pipe-C-eDP-1
[330.664480] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.052s)
[330.674671] Starting dynamic subtest: pipe-D-eDP-1
[334.662170] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.995s)
[334.664460] Subtest ctm-0-50: SUCCESS (15.747s)
[335.482379] [061/132] (688s left) gem_userptr_blits (sync-unmap-cycles)
[335.562898] Starting subtest: sync-unmap-cycles
[340.934942] Subtest sync-unmap-cycles: SUCCESS (5.372s)
[341.050902] [062/132] (682s left) gem_eio (in-flight-contexts-10ms)
[341.277432] Starting subtest: in-flight-contexts-10ms
[355.171771] Subtest in-flight-contexts-10ms: SUCCESS (13.887s)
[355.346160] [063/132] (668s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs)
[355.440267] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs
[355.442459] Starting dynamic subtest: pipe-A-eDP-1
[355.464718] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[355.475179] Starting dynamic subtest: pipe-B-eDP-1
[355.495863] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[355.505378] Starting dynamic subtest: pipe-C-eDP-1
[355.526153] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[355.535654] Starting dynamic subtest: pipe-D-eDP-1
[355.556775] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[355.560675] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[357.768436] [064/132] (665s left) gem_lmem_swapping (basic)
[357.812729] Subtest basic: SKIP (0.000s)
[357.855328] [065/132] (665s left) gem_exec_flush (basic-uc-pro-default)
[357.913581] Starting subtest: basic-uc-pro-default
[363.369560] Subtest basic-uc-pro-default: SUCCESS (5.454s)
[363.569860] [066/132] (660s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-upscaling)
[363.672097] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-upscaling
[363.676173] Subtest flip-64bpp-yftile-to-16bpp-yftile-upscaling: SKIP (0.000s)
[363.744577] [067/132] (660s left) kms_flip (dpms-vs-vblank-race)
[363.842181] Starting subtest: dpms-vs-vblank-race
[363.844348] Starting dynamic subtest: A-eDP1
[367.846837] Dynamic subtest A-eDP1: SUCCESS (4.002s)
[367.857505] Starting dynamic subtest: B-eDP1
[371.360474] Dynamic subtest B-eDP1: SUCCESS (3.512s)
[371.370953] Starting dynamic subtest: C-eDP1
[374.875409] Dynamic subtest C-eDP1: SUCCESS (3.512s)
[374.885449] Starting dynamic subtest: D-eDP1
[378.374769] Dynamic subtest D-eDP1: SUCCESS (3.495s)
[378.377058] Subtest dpms-vs-vblank-race: SUCCESS (14.530s)
[379.237775] [068/132] (644s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions)
[379.365631] Starting subtest: cursorB-vs-flipA-atomic-transitions
[379.370277] Subtest cursorB-vs-flipA-atomic-transitions: SKIP (0.001s)
[379.522963] [069/132] (644s left) gem_exec_schedule (pi-common)
[379.711888] Starting subtest: pi-common
[379.714064] Starting dynamic subtest: rcs0
[379.747400] Dynamic subtest rcs0: SUCCESS (0.038s)
[379.758527] Starting dynamic subtest: bcs0
[379.785175] Dynamic subtest bcs0: SUCCESS (0.036s)
[379.798379] Starting dynamic subtest: vcs0
[379.831084] Dynamic subtest vcs0: SUCCESS (0.043s)
[379.844273] Starting dynamic subtest: vcs1
[379.861056] Dynamic subtest vcs1: SUCCESS (0.029s)
[379.873460] Starting dynamic subtest: vecs0
[379.890185] Dynamic subtest vecs0: SUCCESS (0.028s)
[379.901227] Starting dynamic subtest: ccs0
[379.919649] Dynamic subtest ccs0: SUCCESS (0.029s)
[379.922052] Subtest pi-common: SUCCESS (0.212s)
[380.142737] [070/132] (643s left) gem_reg_read (timestamp-monotonic)
[380.189228] Starting subtest: timestamp-monotonic
[384.649785] Subtest timestamp-monotonic: SUCCESS (4.461s)
[384.741098] [071/132] (639s left) kms_rotation_crc (multiplane-rotation-cropping-bottom)
[384.838993] Starting subtest: multiplane-rotation-cropping-bottom
[402.392656] Subtest multiplane-rotation-cropping-bottom: SUCCESS (17.560s)
[402.525141] [072/132] (621s left) kms_content_protection (content-type-change)
[402.661576] Starting subtest: content-type-change
[402.665564] Subtest content-type-change: SKIP (0.000s)
[402.773185] [073/132] (621s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-move)
[402.870588] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-move
[410.151192] Subtest fbcpsr-1p-primscrn-cur-indfb-move: SUCCESS (7.282s)
[410.311941] [074/132] (613s left) gem_mmap_gtt (coherency)
[410.373853] Subtest coherency: SKIP (0.000s)
[410.426366] [075/132] (613s left) kms_pm_dc (dc9-dpms)
[411.524204] Starting subtest: dc9-dpms
[412.940808] Subtest dc9-dpms: SUCCESS (1.418s)
[413.007605] [076/132] (611s left) perf_pmu (busy-check-all)
[413.048903] Starting subtest: busy-check-all
[413.051197] Starting dynamic subtest: rcs0
[413.608784] Dynamic subtest rcs0: SUCCESS (0.561s)
[413.621942] Starting dynamic subtest: bcs0
[414.160008] Dynamic subtest bcs0: SUCCESS (0.548s)
[414.175641] Starting dynamic subtest: vcs0
[416.141696] Dynamic subtest vcs0: SUCCESS (1.976s)
[416.155300] Starting dynamic subtest: vcs1
[418.126532] Dynamic subtest vcs1: SUCCESS (1.982s)
[418.139866] Starting dynamic subtest: vecs0
[420.174514] Dynamic subtest vecs0: SUCCESS (2.044s)
[420.187273] Starting dynamic subtest: ccs0
[420.730428] Dynamic subtest ccs0: SUCCESS (0.555s)
[420.733032] Subtest busy-check-all: SUCCESS (7.684s)
[420.851133] [077/132] (603s left) kms_addfb_basic (small-bo)
[420.941207] Starting subtest: small-bo
[420.943349] Subtest small-bo: SUCCESS (0.000s)
[421.052520] [078/132] (603s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-sf)
[421.155145] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-sf
[421.157518] Starting dynamic subtest: pipe-A-eDP-1
[421.235370] Dynamic subtest pipe-A-eDP-1: SKIP (0.082s)
[421.248335] Starting dynamic subtest: pipe-B-eDP-1
[422.365213] Dynamic subtest pipe-B-eDP-1: SKIP (1.128s)
[422.369668] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-sf: SKIP (1.213s)
[423.543621] [079/132] (600s left) gem_exec_fence (syncobj-timeline-signal)
[424.084498] Starting subtest: syncobj-timeline-signal
[424.092684] Subtest syncobj-timeline-signal: SUCCESS (0.009s)
[425.248679] [080/132] (599s left) kms_rmfb (rmfb-ioctl)
[425.336444] Starting subtest: rmfb-ioctl
[425.338448] Starting dynamic subtest: pipe-A-eDP-1
[425.440306] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.106s)
[425.452459] Starting dynamic subtest: pipe-B-eDP-1
[426.603907] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.162s)
[426.616248] Starting dynamic subtest: pipe-C-eDP-1
[427.725818] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.121s)
[427.736571] Starting dynamic subtest: pipe-D-eDP-1
[428.855325] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.128s)
[428.857654] Subtest rmfb-ioctl: SUCCESS (3.521s)
[429.990714] [081/132] (594s left) gem_ctx_persistence (engines-hostile)
[430.048504] Starting subtest: engines-hostile
[430.050976] Starting dynamic subtest: rcs0
[430.132174] Dynamic subtest rcs0: SUCCESS (0.083s)
[430.145388] Starting dynamic subtest: bcs0
[430.236223] Dynamic subtest bcs0: SUCCESS (0.102s)
[430.248969] Starting dynamic subtest: vcs0
[430.329820] Dynamic subtest vcs0: SUCCESS (0.092s)
[430.342416] Starting dynamic subtest: vcs1
[430.407710] Dynamic subtest vcs1: SUCCESS (0.076s)
[430.418880] Starting dynamic subtest: vecs0
[430.527151] Dynamic subtest vecs0: SUCCESS (0.117s)
[430.540290] Starting dynamic subtest: ccs0
[430.622152] Dynamic subtest ccs0: SUCCESS (0.093s)
[430.624865] Subtest engines-hostile: SUCCESS (0.575s)
[430.704724] [082/132] (593s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-blt)
[430.799752] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-blt
[430.804202] Subtest psr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[430.907411] [083/132] (593s left) kms_chamelium_color (degamma)
[431.000382] Subtest degamma: SKIP (0.000s)
[431.045224] [084/132] (593s left) kms_flip (blocking-absolute-wf_vblank)
[431.131671] Starting subtest: blocking-absolute-wf_vblank
[431.133569] Starting dynamic subtest: A-eDP1
[439.850025] Dynamic subtest A-eDP1: SUCCESS (8.717s)
[439.869051] Starting dynamic subtest: B-eDP1
[448.590708] Dynamic subtest B-eDP1: SUCCESS (8.735s)
[448.610610] Starting dynamic subtest: C-eDP1
[457.318306] Dynamic subtest C-eDP1: SUCCESS (8.722s)
[457.338068] Starting dynamic subtest: D-eDP1
[466.060366] Dynamic subtest D-eDP1: SUCCESS (8.736s)
[466.066405] Subtest blocking-absolute-wf_vblank: SUCCESS (34.926s)
[467.271248] [085/132] (557s left) gem_userptr_blits (unsync-unmap-cycles)
[467.351171] Subtest unsync-unmap-cycles: SKIP (0.000s)
[467.481245] [086/132] (557s left) gem_tiled_pread_pwrite
[467.599331] [087/132] (556s left) kms_frontbuffer_tracking (fbcpsr-stridechange)
[467.707376] Starting subtest: fbcpsr-stridechange
[473.909069] Subtest fbcpsr-stridechange: SUCCESS (6.203s)
[474.048717] [088/132] (550s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-5)
[474.145089] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-5
[474.147408] Starting dynamic subtest: pipe-A
[474.165179] Dynamic subtest pipe-A: SKIP (0.017s)
[474.175796] Starting dynamic subtest: pipe-B
[474.196498] Dynamic subtest pipe-B: SKIP (0.029s)
[474.206528] Starting dynamic subtest: pipe-C
[474.227017] Dynamic subtest pipe-C: SKIP (0.029s)
[474.236987] Starting dynamic subtest: pipe-D
[474.254809] Dynamic subtest pipe-D: SKIP (0.029s)
[474.259214] Subtest planes-upscale-factor-0-25-downscale-factor-0-5: SKIP (0.107s)
[474.366500] [089/132] (550s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-blt)
[474.456758] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-blt
[474.461085] Subtest psr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[474.542400] [090/132] (550s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-render)
[474.631838] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-render
[474.635953] Subtest fbc-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[474.733587] [091/132] (550s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[474.832663] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[475.489941] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.659s)
[475.656989] [092/132] (549s left) syncobj_timeline (single-wait-signaled)
[475.714392] Starting subtest: single-wait-signaled
[475.716333] Subtest single-wait-signaled: SUCCESS (0.000s)
[475.804495] [093/132] (549s left) kms_fbcon_fbt (psr)
[475.863740] Starting subtest: psr
[483.146764] Subtest psr: SUCCESS (7.277s)
[483.223246] [094/132] (541s left) drm_read (short-buffer-block)
[483.385136] Starting subtest: short-buffer-block
[483.387544] Subtest short-buffer-block: SUCCESS (0.000s)
[483.496471] [095/132] (541s left) dmabuf_sync_file (export-basic)
[483.550433] Starting subtest: export-basic
[483.552664] Subtest export-basic: SUCCESS (0.001s)
[483.618230] [096/132] (541s left) prime_vgem (basic-fence-read)
[483.689714] Starting subtest: basic-fence-read
[483.702401] Subtest basic-fence-read: SKIP (0.010s)
[483.819745] [097/132] (541s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0)
[483.923384] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0
[483.927281] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[484.011683] [098/132] (541s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[484.098040] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[484.101909] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[484.194563] [099/132] (540s left) gem_userptr_blits (coherency-unsync)
[484.263368] Subtest coherency-unsync: SKIP (0.000s)
[484.382089] [100/132] (540s left) kms_frontbuffer_tracking (fbcpsr-1p-shrfb-fliptrack-mmap-gtt)
[484.470909] Starting subtest: fbcpsr-1p-shrfb-fliptrack-mmap-gtt
[484.474261] Subtest fbcpsr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[484.583005] [101/132] (540s left) gem_wait (write-wait)
[484.642499] Starting subtest: write-wait
[484.644522] Starting dynamic subtest: all-engines
[485.744493] Dynamic subtest all-engines: SUCCESS (1.100s)
[485.762253] Starting dynamic subtest: rcs0
[486.799842] Dynamic subtest rcs0: SUCCESS (1.053s)
[486.816492] Starting dynamic subtest: bcs0
[487.864619] Dynamic subtest bcs0: SUCCESS (1.062s)
[487.885758] Starting dynamic subtest: vcs0
[488.922611] Dynamic subtest vcs0: SUCCESS (1.055s)
[488.939273] Starting dynamic subtest: vcs1
[489.975248] Dynamic subtest vcs1: SUCCESS (1.050s)
[489.992423] Starting dynamic subtest: vecs0
[491.029298] Dynamic subtest vecs0: SUCCESS (1.051s)
[491.047609] Starting dynamic subtest: ccs0
[492.087183] Dynamic subtest ccs0: SUCCESS (1.055s)
[492.089770] Subtest write-wait: SUCCESS (7.443s)
[492.290968] [102/132] (532s left) gem_pwrite_snooped
[492.418479] [103/132] (532s left) gem_ctx_engines (independent)
[492.480227] Starting subtest: independent
[492.482496] Starting dynamic subtest: rcs0
[492.727908] Dynamic subtest rcs0: SUCCESS (0.245s)
[492.744774] Starting dynamic subtest: bcs0
[492.967561] Dynamic subtest bcs0: SUCCESS (0.238s)
[492.980172] Starting dynamic subtest: vcs0
[493.201320] Dynamic subtest vcs0: SUCCESS (0.233s)
[493.214178] Starting dynamic subtest: vcs1
[493.422223] Dynamic subtest vcs1: SUCCESS (0.220s)
[493.434545] Starting dynamic subtest: vecs0
[493.701801] Dynamic subtest vecs0: SUCCESS (0.278s)
[493.717506] Starting dynamic subtest: ccs0
[494.001665] Dynamic subtest ccs0: SUCCESS (0.299s)
[494.016627] Starting dynamic subtest: all-engines
[495.266230] Dynamic subtest all-engines: SUCCESS (1.265s)
[495.268532] Subtest independent: SUCCESS (2.785s)
[496.196081] [104/132] (529s left) gem_render_copy_redux (flink)
[496.254618] Starting subtest: flink
[497.466174] Subtest flink: SUCCESS (1.211s)
[497.607097] [105/132] (527s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[497.657417] Starting subtest: multi-wait-all-for-submit-submitted
[497.762121] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.103s)
[497.836407] [106/132] (527s left) gem_ctx_param (invalid-param-get)
[497.883318] Starting subtest: invalid-param-get
[497.885944] Subtest invalid-param-get: SUCCESS (0.001s)
[497.989134] [107/132] (527s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-pwrite)
[498.089501] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-pwrite
[498.093878] Subtest fbc-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[498.189272] [108/132] (527s left) prime_busy (before)
[498.244329] Starting subtest: before
[498.246587] Starting dynamic subtest: rcs0
[498.271947] Dynamic subtest rcs0: SUCCESS (0.027s)
[498.282279] Starting dynamic subtest: bcs0
[498.313472] Dynamic subtest bcs0: SUCCESS (0.039s)
[498.323941] Starting dynamic subtest: vcs0
[498.353082] Dynamic subtest vcs0: SUCCESS (0.041s)
[498.362643] Starting dynamic subtest: vcs1
[498.394756] Dynamic subtest vcs1: SUCCESS (0.041s)
[498.412830] Starting dynamic subtest: vecs0
[498.437149] Dynamic subtest vecs0: SUCCESS (0.041s)
[498.447272] Starting dynamic subtest: ccs0
[498.478007] Dynamic subtest ccs0: SUCCESS (0.040s)
[498.585944] Subtest before: SUCCESS (0.342s)
[498.657783] [109/132] (526s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[498.707590] Starting subtest: framebuffer-vs-set-tiling
[498.711985] Subtest framebuffer-vs-set-tiling: SKIP (0.000s)
[498.855609] [110/132] (526s left) sysfs_preempt_timeout (timeout)
[498.916758] Starting subtest: timeout
[498.919058] Starting dynamic subtest: vecs0
[508.100542] Dynamic subtest vecs0: SUCCESS (9.177s)
[508.113443] Starting dynamic subtest: ccs0
[509.416259] Dynamic subtest ccs0: SUCCESS (1.316s)
[509.427159] Starting dynamic subtest: vcs0
[519.107450] Dynamic subtest vcs0: SUCCESS (9.690s)
[519.120365] Starting dynamic subtest: bcs0
[520.363130] Dynamic subtest bcs0: SUCCESS (1.254s)
[520.375621] Starting dynamic subtest: rcs0
[521.570602] Dynamic subtest rcs0: SUCCESS (1.208s)
[521.583665] Starting dynamic subtest: vcs1
[531.142854] Dynamic subtest vcs1: SUCCESS (9.570s)
[531.145671] Subtest timeout: SUCCESS (32.227s)
[531.229931] [111/132] (494s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[531.328755] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[531.333966] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[531.417084] [112/132] (494s left) kms_psr (pr-sprite-mmap-cpu)
[531.503055] Starting subtest: pr-sprite-mmap-cpu
[531.507321] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[531.578517] [113/132] (494s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[531.636865] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[531.639172] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[531.725171] [114/132] (493s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf)
[531.828397] Starting subtest: psr2-cursor-plane-move-continuous-exceed-sf
[531.830572] Starting dynamic subtest: pipe-A-eDP-1
[542.514900] Dynamic subtest pipe-A-eDP-1: SUCCESS (10.693s)
[542.525203] Starting dynamic subtest: pipe-B-eDP-1
[553.971293] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.455s)
[553.973738] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SUCCESS (22.151s)
[554.842733] [115/132] (470s left) syncobj_timeline (invalid-query-one-illegal-handle)
[554.900796] Starting subtest: invalid-query-one-illegal-handle
[554.902790] Subtest invalid-query-one-illegal-handle: SUCCESS (0.000s)
[555.031199] [116/132] (470s left) gem_exec_reloc (basic-cpu-read-noreloc)
[555.091257] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[555.178659] [117/132] (470s left) perf_pmu (multi-client)
[555.213038] Starting subtest: multi-client
[555.215335] Starting dynamic subtest: rcs0
[556.261200] Dynamic subtest rcs0: SUCCESS (1.049s)
[556.271084] Starting dynamic subtest: bcs0
[557.307416] Dynamic subtest bcs0: SUCCESS (1.047s)
[557.319986] Starting dynamic subtest: vcs0
[558.362454] Dynamic subtest vcs0: SUCCESS (1.051s)
[558.375288] Starting dynamic subtest: vcs1
[560.197251] Dynamic subtest vcs1: SUCCESS (1.832s)
[560.210174] Starting dynamic subtest: vecs0
[562.181345] Dynamic subtest vecs0: SUCCESS (1.982s)
[562.194030] Starting dynamic subtest: ccs0
[564.165260] Dynamic subtest ccs0: SUCCESS (1.981s)
[564.168316] Subtest multi-client: SUCCESS (8.955s)
[564.283025] [118/132] (461s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[564.382776] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[564.384894] Starting dynamic subtest: pipe-A-eDP-1
[564.406291] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[564.418802] Starting dynamic subtest: pipe-B-eDP-1
[564.439309] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[564.448666] Starting dynamic subtest: pipe-C-eDP-1
[564.469766] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[564.478888] Starting dynamic subtest: pipe-D-eDP-1
[564.500752] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[564.504764] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.006s)
[566.688362] [119/132] (459s left) kms_tv_load_detect (load-detect)
[566.742353] Subtest load-detect: SKIP (0.000s)
[566.800339] [120/132] (459s left) gem_bad_reloc (negative-reloc-lut)
[566.851753] Subtest negative-reloc-lut: SKIP (0.000s)
[566.921487] [121/132] (459s left) i915_pm_rpm (gem-idle)
[568.455319] Starting subtest: gem-idle
[574.652726] Subtest gem-idle: SUCCESS (6.201s)
[574.985093] [122/132] (451s left) gem_mmap_wc (close)
[576.050477] Subtest close: SKIP (0.000s)
[576.130532] [123/132] (449s left) kms_draw_crc (draw-method-pwrite)
[576.228179] Starting subtest: draw-method-pwrite
[576.230099] Starting dynamic subtest: xrgb8888-untiled
[576.780950] Dynamic subtest xrgb8888-untiled: SUCCESS (0.555s)
[576.791103] Starting dynamic subtest: rgb565-untiled
[577.237473] Dynamic subtest rgb565-untiled: SUCCESS (0.455s)
[577.247921] Starting dynamic subtest: xrgb2101010-untiled
[577.759056] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.521s)
[577.769198] Starting dynamic subtest: xbgr16161616f-untiled
[578.514565] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.755s)
[578.525185] Starting dynamic subtest: xrgb8888-xtiled
[580.292521] Dynamic subtest xrgb8888-xtiled: SUCCESS (1.776s)
[580.303290] Starting dynamic subtest: rgb565-xtiled
[581.426468] Dynamic subtest rgb565-xtiled: SUCCESS (1.132s)
[581.436482] Starting dynamic subtest: xrgb2101010-xtiled
[583.182556] Dynamic subtest xrgb2101010-xtiled: SUCCESS (1.754s)
[583.192655] Starting dynamic subtest: xbgr16161616f-xtiled
[586.549011] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (3.364s)
[586.566845] Starting dynamic subtest: xrgb8888-4tiled
[587.648893] Dynamic subtest xrgb8888-4tiled: SUCCESS (1.099s)
[587.659208] Starting dynamic subtest: rgb565-4tiled
[588.215400] Dynamic subtest rgb565-4tiled: SUCCESS (0.564s)
[588.227527] Starting dynamic subtest: xrgb2101010-4tiled
[589.315628] Dynamic subtest xrgb2101010-4tiled: SUCCESS (1.099s)
[589.326540] Starting dynamic subtest: xbgr16161616f-4tiled
[592.338253] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (3.022s)
[592.340568] Subtest draw-method-pwrite: SUCCESS (16.111s)
[592.422283] [124/132] (433s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[592.692215] Starting subtest: cursor-rapid-movement-512x512
[592.696713] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[592.885671] [125/132] (433s left) i915_query (engine-info-invalid)
[592.932063] Starting subtest: engine-info-invalid
[592.934016] Subtest engine-info-invalid: SUCCESS (0.000s)
[593.025795] [126/132] (433s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[593.124733] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-wc
[600.062853] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (6.940s)
[600.178887] [127/132] (426s left) gem_ppgtt (flink-and-close-vma-leak)
[600.241767] Starting subtest: flink-and-close-vma-leak
[600.284546] Subtest flink-and-close-vma-leak: SUCCESS (0.043s)
[600.399578] [128/132] (425s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[600.778321] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[601.659478] [129/132] (424s left) gem_exec_reloc (basic-cpu-wc-noreloc)
[601.729511] Subtest basic-cpu-wc-noreloc: SKIP (0.000s)
[601.800116] [130/132] (424s left) kms_invalid_mode (zero-clock)
[601.890251] Starting subtest: zero-clock
[601.892476] Starting dynamic subtest: pipe-A-eDP-1
[602.173159] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[602.183641] Starting dynamic subtest: pipe-B-eDP-1
[602.185917] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[602.196212] Starting dynamic subtest: pipe-C-eDP-1
[602.198177] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[602.208158] Starting dynamic subtest: pipe-D-eDP-1
[602.210144] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[602.212150] Subtest zero-clock: SUCCESS (0.290s)
[602.985294] [131/132] (423s left) gem_exec_balancer (full-pulse)
[603.046480] Starting subtest: full-pulse
[608.067914] Subtest full-pulse: SUCCESS (5.020s)
[608.357615] [132/132] (418s left) gem_basic (create-fd-close)
[608.421420] Starting subtest: create-fd-close
[608.425959] Subtest create-fd-close: SUCCESS (0.000s)
[608.532732] Closing watchdogs
results: parsing output: 0/ for test: kms_lease
results: parsing output: 1/ for test: kms_ccs
results: parsing output: 2/ for test: syncobj_eventfd
results: parsing output: 3/ for test: kms_psr
results: parsing output: 4/ for test: kms_big_fb
results: parsing output: 5/ for test: gem_pxp
results: parsing output: 6/ for test: syncobj_wait
results: parsing output: 7/ for test: kms_cursor_crc
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: kms_addfb_basic
results: parsing output: 10/ for test: kms_psr
results: parsing output: 11/ for test: kms_cursor_edge_walk
results: parsing output: 12/ for test: gem_eio
results: parsing output: 13/ for test: gem_mmap_gtt
results: parsing output: 14/ for test: kms_ccs
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: gem_userptr_blits
results: parsing output: 17/ for test: gem_render_copy
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: kms_flip_scaled_crc
results: parsing output: 20/ for test: kms_vblank
results: parsing output: 21/ for test: gem_partial_pwrite_pread
results: parsing output: 22/ for test: gem_spin_batch
results: parsing output: 23/ for test: kms_psr
results: parsing output: 24/ for test: syncobj_timeline
results: parsing output: 25/ for test: core_getstats
results: parsing output: 26/ for test: gem_exec_basic
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: i915_drm_fdinfo
results: parsing output: 29/ for test: kms_plane
results: parsing output: 30/ for test: gem_pxp
results: parsing output: 31/ for test: gem_exec_whisper
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_busy
results: parsing output: 34/ for test: kms_cursor_legacy
results: parsing output: 35/ for test: gen9_exec_parse
results: parsing output: 36/ for test: kms_flip_scaled_crc
results: parsing output: 37/ for test: kms_big_fb
results: parsing output: 38/ for test: gem_mmap_gtt
results: parsing output: 39/ for test: gem_ctx_persistence
results: parsing output: 40/ for test: kms_atomic
results: parsing output: 41/ for test: kms_cursor_legacy
results: parsing output: 42/ for test: kms_vblank
results: parsing output: 43/ for test: kms_dither
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_plane
results: parsing output: 46/ for test: kms_pipe_crc_basic
results: parsing output: 47/ for test: syncobj_timeline
results: parsing output: 48/ for test: kms_ccs
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_big_fb
results: parsing output: 51/ for test: gem_exec_fence
results: parsing output: 52/ for test: gem_exec_schedule
results: parsing output: 53/ for test: api_intel_allocator
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: gem_exec_parallel
results: parsing output: 56/ for test: kms_psr2_su
results: parsing output: 57/ for test: i915_pm_freq_api
results: parsing output: 58/ for test: kms_plane_cursor
results: parsing output: 59/ for test: kms_color
results: parsing output: 60/ for test: gem_userptr_blits
results: parsing output: 61/ for test: gem_eio
results: parsing output: 62/ for test: kms_ccs
results: parsing output: 63/ for test: gem_lmem_swapping
results: parsing output: 64/ for test: gem_exec_flush
results: parsing output: 65/ for test: kms_flip_scaled_crc
results: parsing output: 66/ for test: kms_flip
results: parsing output: 67/ for test: kms_cursor_legacy
results: parsing output: 68/ for test: gem_exec_schedule
results: parsing output: 69/ for test: gem_reg_read
results: parsing output: 70/ for test: kms_rotation_crc
results: parsing output: 71/ for test: kms_content_protection
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: gem_mmap_gtt
results: parsing output: 74/ for test: kms_pm_dc
results: parsing output: 75/ for test: perf_pmu
results: parsing output: 76/ for test: kms_addfb_basic
results: parsing output: 77/ for test: kms_psr2_sf
results: parsing output: 78/ for test: gem_exec_fence
results: parsing output: 79/ for test: kms_rmfb
results: parsing output: 80/ for test: gem_ctx_persistence
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_chamelium_color
results: parsing output: 83/ for test: kms_flip
results: parsing output: 84/ for test: gem_userptr_blits
results: parsing output: 85/ for test: gem_tiled_pread_pwrite
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_plane_scaling
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_big_fb
results: parsing output: 91/ for test: syncobj_timeline
results: parsing output: 92/ for test: kms_fbcon_fbt
results: parsing output: 93/ for test: drm_read
results: parsing output: 94/ for test: dmabuf_sync_file
results: parsing output: 95/ for test: prime_vgem
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: gem_userptr_blits
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: gem_wait
results: parsing output: 101/ for test: gem_pwrite_snooped
results: parsing output: 102/ for test: gem_ctx_engines
results: parsing output: 103/ for test: gem_render_copy_redux
results: parsing output: 104/ for test: syncobj_wait
results: parsing output: 105/ for test: gem_ctx_param
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: prime_busy
results: parsing output: 108/ for test: kms_addfb_basic
results: parsing output: 109/ for test: sysfs_preempt_timeout
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_psr
results: parsing output: 112/ for test: syncobj_wait
results: parsing output: 113/ for test: kms_psr2_sf
results: parsing output: 114/ for test: syncobj_timeline
results: parsing output: 115/ for test: gem_exec_reloc
results: parsing output: 116/ for test: perf_pmu
results: parsing output: 117/ for test: kms_ccs
results: parsing output: 118/ for test: kms_tv_load_detect
results: parsing output: 119/ for test: gem_bad_reloc
results: parsing output: 120/ for test: i915_pm_rpm
results: parsing output: 121/ for test: gem_mmap_wc
results: parsing output: 122/ for test: kms_draw_crc
results: parsing output: 123/ for test: kms_cursor_crc
results: parsing output: 124/ for test: i915_query
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: gem_ppgtt
results: parsing output: 127/ for test: kms_chamelium_hpd
results: parsing output: 128/ for test: gem_exec_reloc
results: parsing output: 129/ for test: kms_invalid_mode
results: parsing output: 130/ for test: gem_exec_balancer
results: parsing output: 131/ for test: gem_basic
Done.