[59.202367] Initializing watchdogs
[59.202442]   /dev/watchdog0
[59.216782] [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.221237] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.223433] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.226702] [001/130] (960s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[59.358055] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[59.362215] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[59.498205] [002/130] (960s left) kms_atomic (plane-primary-overlay-mutable-zpos)
[59.591325] Starting subtest: plane-primary-overlay-mutable-zpos
[63.034062] Subtest plane-primary-overlay-mutable-zpos: SKIP (3.459s)
[64.231008] [003/130] (955s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-upscaling)
[64.339054] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-upscaling
[64.341431] Starting dynamic subtest: pipe-A-default-mode
[64.632192] Dynamic subtest pipe-A-default-mode: SKIP (0.292s)
[64.637099] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-upscaling: SKIP (0.293s)
[65.448424] [004/130] (954s left) vgem_basic (dmabuf-mmap)
[65.515809] Starting subtest: dmabuf-mmap
[65.520820] Subtest dmabuf-mmap: SUCCESS (0.008s)
[65.590795] [FACT vgem_basic (dmabuf-mmap)] new: kernel.kmod_is_loaded.vgem: true
[65.594289] [005/130] (954s left) kms_invalid_mode (zero-vdisplay)
[65.688519] Starting subtest: zero-vdisplay
[65.690846] Starting dynamic subtest: pipe-A-eDP-1
[65.969669] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[65.977964] Starting dynamic subtest: pipe-B-eDP-1
[65.980193] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[65.986883] Starting dynamic subtest: pipe-C-eDP-1
[65.989149] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[65.995919] Starting dynamic subtest: pipe-D-eDP-1
[65.997936] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[65.999895] Subtest zero-vdisplay: SUCCESS (0.288s)
[66.790853] [006/130] (953s left) gem_spin_batch (engines)
[66.854995] Starting subtest: engines
[66.857333] Starting dynamic subtest: rcs0
[70.086974] Dynamic subtest rcs0: SUCCESS (3.235s)
[70.096364] Starting dynamic subtest: bcs0
[73.320095] Dynamic subtest bcs0: SUCCESS (3.237s)
[73.329599] Starting dynamic subtest: vcs0
[76.552932] Dynamic subtest vcs0: SUCCESS (3.235s)
[76.560027] Starting dynamic subtest: vcs1
[79.789324] Dynamic subtest vcs1: SUCCESS (3.235s)
[79.798605] Starting dynamic subtest: vecs0
[83.023961] Dynamic subtest vecs0: SUCCESS (3.233s)
[83.033342] Starting dynamic subtest: ccs0
[86.263086] Dynamic subtest ccs0: SUCCESS (3.237s)
[86.265802] Subtest engines: SUCCESS (19.418s)
[86.533103] [007/130] (933s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)
[86.603044] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[86.605371] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[86.751729] [008/130] (933s left) kms_pm_backlight (brightness-with-dpms)
[86.847280] Starting subtest: brightness-with-dpms
[86.899981] Starting dynamic subtest: eDP-1
[89.743308] Dynamic subtest eDP-1: SUCCESS (2.840s)
[89.745715] Subtest brightness-with-dpms: SUCCESS (2.895s)
[90.623276] [009/130] (929s left) kms_frontbuffer_tracking (fbcpsr-tiling-linear)
[90.737161] Starting subtest: fbcpsr-tiling-linear
[97.349935] Subtest fbcpsr-tiling-linear: SUCCESS (6.616s)
[97.507983] [010/130] (922s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-msflip-blt)
[97.607246] Starting subtest: fbc-2p-primscrn-shrfb-msflip-blt
[97.611179] Subtest fbc-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[97.726453] [011/130] (922s left) kms_color (ctm-max)
[97.821246] Starting subtest: ctm-max
[97.823605] Starting dynamic subtest: pipe-A-eDP-1
[98.534433] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.714s)
[98.542133] Starting dynamic subtest: pipe-B-eDP-1
[99.978735] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.444s)
[99.987315] Starting dynamic subtest: pipe-C-eDP-1
[101.329690] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.351s)
[101.337036] Starting dynamic subtest: pipe-D-eDP-1
[102.679176] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.347s)
[102.681217] Subtest ctm-max: SUCCESS (4.858s)
[103.502472] [012/130] (916s left) kms_psr (psr2-primary-mmap-gtt)
[103.602461] Starting subtest: psr2-primary-mmap-gtt
[103.604664] Starting dynamic subtest: eDP-1
[105.073089] Dynamic subtest eDP-1: SKIP (1.467s)
[105.077586] Subtest psr2-primary-mmap-gtt: SKIP (1.468s)
[105.248226] [013/130] (914s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary)
[105.351227] Starting subtest: fbcpsr-shrfb-scaledprimary
[111.120854] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (5.772s)
[111.294611] [014/130] (908s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[111.400051] Starting subtest: y-tiled-32bpp-rotate-180
[111.404487] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[111.509856] [015/130] (908s left) perf_pmu (busy-idle)
[111.557902] Starting subtest: busy-idle
[111.560239] Starting dynamic subtest: rcs0
[112.269236] Dynamic subtest rcs0: SUCCESS (0.712s)
[112.280033] Starting dynamic subtest: bcs0
[112.933880] Dynamic subtest bcs0: SUCCESS (0.664s)
[112.944757] Starting dynamic subtest: vcs0
[114.901947] Dynamic subtest vcs0: SUCCESS (1.965s)
[114.915941] Starting dynamic subtest: vcs1
[116.885370] Dynamic subtest vcs1: SUCCESS (1.981s)
[116.895745] Starting dynamic subtest: vecs0
[118.933351] Dynamic subtest vecs0: SUCCESS (2.046s)
[118.944341] Starting dynamic subtest: ccs0
[119.614309] Dynamic subtest ccs0: SUCCESS (0.681s)
[119.616899] Subtest busy-idle: SUCCESS (8.059s)
[119.729441] [016/130] (900s left) gem_madvise (dontneed-before-exec)
[119.763159] Starting subtest: dontneed-before-exec
[119.786346] Subtest dontneed-before-exec: SKIP (0.020s)
[119.854041] [017/130] (900s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[124.803293] Starting subtest: psr2-overlay-plane-update-continuous-sf
[124.805817] Starting dynamic subtest: pipe-A-eDP-1
[126.554565] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.751s)
[126.566233] Starting dynamic subtest: pipe-B-eDP-1
[128.292956] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.734s)
[128.295328] Subtest psr2-overlay-plane-update-continuous-sf: SUCCESS (3.489s)
[129.132949] [018/130] (891s left) kms_flip (absolute-wf_vblank-interruptible)
[129.227580] Starting subtest: absolute-wf_vblank-interruptible
[129.229880] Starting dynamic subtest: A-eDP1
[137.972063] Dynamic subtest A-eDP1: SUCCESS (8.743s)
[137.980049] Starting dynamic subtest: B-eDP1
[146.699419] Dynamic subtest B-eDP1: SUCCESS (8.726s)
[146.709531] Starting dynamic subtest: C-eDP1
[155.425914] Dynamic subtest C-eDP1: SUCCESS (8.725s)
[155.444889] Starting dynamic subtest: D-eDP1
[164.158164] Dynamic subtest D-eDP1: SUCCESS (8.729s)
[164.163030] Subtest absolute-wf_vblank-interruptible: SUCCESS (34.933s)
[165.393654] [019/130] (855s left) gem_exec_big (single)
[165.458941] Starting subtest: single
[167.797845] Subtest single: SUCCESS (2.337s)
[168.045189] [020/130] (852s left) syncobj_timeline (invalid-query-zero-handles)
[168.160200] Starting subtest: invalid-query-zero-handles
[168.162533] Subtest invalid-query-zero-handles: SUCCESS (0.000s)
[168.277183] [021/130] (852s left) kms_prop_blob (blob-prop-lifetime)
[168.329231] Starting subtest: blob-prop-lifetime
[168.331577] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[168.466675] [022/130] (852s left) kms_frontbuffer_tracking (fbc-suspend)
[168.590657] Starting subtest: fbc-suspend
[207.136822] Subtest fbc-suspend: SUCCESS (11.968s)
[211.369972] [023/130] (812s left) kms_getfb (getfb-handle-zero)
[211.493407] Starting subtest: getfb-handle-zero
[211.495599] Subtest getfb-handle-zero: SUCCESS (0.000s)
[211.628578] [024/130] (812s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted)
[211.687977] Starting subtest: etime-single-wait-for-submit-unsubmitted
[211.791301] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.107s)
[211.890699] [025/130] (811s left) sriov_basic (enable-vfs-autoprobe-on)
[211.951799] Starting subtest: enable-vfs-autoprobe-on
[211.954008] Starting dynamic subtest: numvfs-1
[212.033145] Dynamic subtest numvfs-1: FAIL (0.028s)
[212.043242] Starting dynamic subtest: numvfs-2
[212.113981] Dynamic subtest numvfs-2: FAIL (0.004s)
[212.124505] Starting dynamic subtest: numvfs-3
[212.194254] Dynamic subtest numvfs-3: FAIL (0.004s)
[212.203792] Starting dynamic subtest: numvfs-4
[212.273789] Dynamic subtest numvfs-4: FAIL (0.004s)
[212.283970] Starting dynamic subtest: numvfs-5
[212.353883] Dynamic subtest numvfs-5: FAIL (0.003s)
[212.364155] Starting dynamic subtest: numvfs-6
[212.434102] Dynamic subtest numvfs-6: FAIL (0.003s)
[212.443392] Starting dynamic subtest: numvfs-7
[212.512684] Dynamic subtest numvfs-7: FAIL (0.003s)
[212.522643] Starting dynamic subtest: numvfs-random
[212.589245] Dynamic subtest numvfs-random: FAIL (0.004s)
[212.598706] Starting dynamic subtest: numvfs-all
[212.667501] Dynamic subtest numvfs-all: FAIL (0.514s)
[212.669733] Subtest enable-vfs-autoprobe-on: FAIL (0.571s)
[212.706960] [026/130] (811s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-pwrite)
[212.801922] Starting subtest: fbcpsr-rgb565-draw-pwrite
[219.633734] Subtest fbcpsr-rgb565-draw-pwrite: SUCCESS (7.009s)
[219.774028] [027/130] (804s left) i915_pm_rps (waitboost)
[219.830693] Starting subtest: waitboost
[225.907715] Subtest waitboost: SUCCESS (6.141s)
[226.075513] [028/130] (797s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[226.471407] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[227.299811] [029/130] (796s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[227.402034] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[227.406052] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[227.545951] [030/130] (796s left) kms_vblank (ts-continuation-modeset-hang)
[227.646990] Starting subtest: ts-continuation-modeset-hang
[227.649131] Starting dynamic subtest: pipe-A-eDP-1
[254.254325] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.635s)
[254.274969] Starting dynamic subtest: pipe-D-eDP-1
[269.234723] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.981s)
[269.236988] Subtest ts-continuation-modeset-hang: SUCCESS (41.621s)
[270.124261] [031/130] (753s left) i915_drm_fdinfo (busy-idle)
[270.166777] Starting subtest: busy-idle
[270.169085] Starting dynamic subtest: rcs0
[270.192672] Dynamic subtest rcs0: SKIP (0.023s)
[270.203638] Starting dynamic subtest: bcs0
[270.210597] Dynamic subtest bcs0: SKIP (0.016s)
[270.219601] Starting dynamic subtest: vcs0
[270.223725] Dynamic subtest vcs0: SKIP (0.000s)
[270.232662] Starting dynamic subtest: vcs1
[270.237023] Dynamic subtest vcs1: SKIP (0.000s)
[270.245401] Starting dynamic subtest: vecs0
[270.249489] Dynamic subtest vecs0: SKIP (0.000s)
[270.257992] Starting dynamic subtest: ccs0
[270.262170] Dynamic subtest ccs0: SKIP (0.000s)
[270.266358] Subtest busy-idle: SKIP (0.045s)
[270.306142] [032/130] (753s left) gem_partial_pwrite_pread (write-uncached)
[270.379640] Subtest write-uncached: SKIP (0.000s)
[270.459741] [033/130] (753s left) syncobj_timeline (32bits-limit)
[270.511059] Starting subtest: 32bits-limit
[270.513437] Subtest 32bits-limit: SUCCESS (0.001s)
[270.631622] [034/130] (753s left) gem_set_tiling_vs_blt (tiled-to-untiled)
[270.690111] Subtest tiled-to-untiled: SKIP (0.000s)
[270.768449] [035/130] (753s left) gem_exec_params (invalid-fence-in-submit)
[270.828801] Starting subtest: invalid-fence-in-submit
[270.833818] Subtest invalid-fence-in-submit: SUCCESS (0.004s)
[270.968347] [036/130] (753s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[271.030096] Starting subtest: multi-wait-all-for-submit-unsubmitted
[271.135662] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.104s)
[271.234919] [037/130] (752s left) kms_pipe_b_c_ivb (enable-pipe-c-while-b-has-3-lanes)
[271.292709] Subtest enable-pipe-C-while-B-has-3-lanes: SKIP (0.000s)
[271.357560] [038/130] (752s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[271.465040] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[271.470093] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[271.612694] [039/130] (752s left) syncobj_timeline (multi-wait-submitted-signaled)
[271.674960] Starting subtest: multi-wait-submitted-signaled
[271.677145] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[271.804265] [040/130] (752s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[271.914539] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[279.451509] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.542s)
[279.613927] [041/130] (744s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling)
[279.702210] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling
[279.704449] Starting dynamic subtest: pipe-A-default-mode
[279.994786] Dynamic subtest pipe-A-default-mode: SKIP (0.289s)
[279.999104] Subtest flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling: SKIP (0.290s)
[280.890750] [042/130] (743s left) gem_exec_schedule (semaphore-resolve)
[280.981665] Starting subtest: semaphore-resolve
[281.019004] Subtest semaphore-resolve: SUCCESS (0.040s)
[281.423619] [043/130] (743s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[281.519480] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[281.521778] Starting dynamic subtest: pipe-A-eDP-1
[281.543941] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[281.557391] Starting dynamic subtest: pipe-B-eDP-1
[281.577784] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[281.587813] Starting dynamic subtest: pipe-C-eDP-1
[281.609247] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[281.619418] Starting dynamic subtest: pipe-D-eDP-1
[281.641440] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[281.645774] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[283.860340] [044/130] (740s left) dmabuf_sync_file (import-basic)
[283.908619] Starting subtest: import-basic
[283.910847] Subtest import-basic: SUCCESS (0.002s)
[283.993389] [045/130] (740s left) gem_caching (reads)
[284.058765] Subtest reads: SKIP (0.000s)
[284.152095] [046/130] (740s left) gem_lmem_swapping (parallel-random-engines)
[284.201249] Subtest parallel-random-engines: SKIP (0.000s)
[284.256625] [047/130] (740s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-wc)
[284.360128] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-wc
[284.364123] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[284.513592] [048/130] (740s left) gem_wait (wait)
[284.583572] Starting subtest: wait
[284.585985] Starting dynamic subtest: all-engines
[286.506635] Dynamic subtest all-engines: SUCCESS (1.922s)
[286.517180] Starting dynamic subtest: rcs0
[287.554019] Dynamic subtest rcs0: SUCCESS (1.046s)
[287.565730] Starting dynamic subtest: bcs0
[288.600686] Dynamic subtest bcs0: SUCCESS (1.045s)
[288.612320] Starting dynamic subtest: vcs0
[289.647501] Dynamic subtest vcs0: SUCCESS (1.045s)
[289.659441] Starting dynamic subtest: vcs1
[290.693125] Dynamic subtest vcs1: SUCCESS (1.044s)
[290.704582] Starting dynamic subtest: vecs0
[291.737773] Dynamic subtest vecs0: SUCCESS (1.043s)
[291.749463] Starting dynamic subtest: ccs0
[292.786872] Dynamic subtest ccs0: SUCCESS (1.047s)
[292.789474] Subtest wait: SUCCESS (8.207s)
[293.014438] [049/130] (731s left) kms_flip (blocking-absolute-wf_vblank)
[293.124922] Starting subtest: blocking-absolute-wf_vblank
[293.127215] Starting dynamic subtest: A-eDP1
[301.881628] Dynamic subtest A-eDP1: SUCCESS (8.761s)
[301.895587] Starting dynamic subtest: B-eDP1
[310.620366] Dynamic subtest B-eDP1: SUCCESS (8.734s)
[310.629592] Starting dynamic subtest: C-eDP1
[319.339445] Dynamic subtest C-eDP1: SUCCESS (8.717s)
[319.348778] Starting dynamic subtest: D-eDP1
[328.090101] Dynamic subtest D-eDP1: SUCCESS (8.748s)
[328.096259] Subtest blocking-absolute-wf_vblank: SUCCESS (34.972s)
[329.322965] [050/130] (695s left) kms_chamelium_hpd (vga-hpd-with-enabled-mode)
[329.714656] Subtest vga-hpd-with-enabled-mode: SKIP (0.000s)
[330.502699] [051/130] (694s left) kms_psr (fbc-psr2-sprite-blt)
[330.600700] Starting subtest: fbc-psr2-sprite-blt
[330.603199] Starting dynamic subtest: eDP-1
[330.607848] Dynamic subtest eDP-1: SKIP (0.000s)
[330.612387] Subtest fbc-psr2-sprite-blt: SKIP (0.001s)
[330.700541] [052/130] (694s left) gem_exec_params (dr4-dirt)
[330.765477] Starting subtest: DR4-dirt
[330.767861] Subtest DR4-dirt: SUCCESS (0.000s)
[330.920346] [053/130] (693s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions-varying-size)
[331.050595] Starting subtest: short-flip-before-cursor-atomic-transitions-varying-size
[332.029393] Subtest short-flip-before-cursor-atomic-transitions-varying-size: SUCCESS (0.978s)
[332.866796] [054/130] (692s left) gem_partial_pwrite_pread (writes-after-reads-snoop)
[332.934655] Subtest writes-after-reads-snoop: SKIP (0.000s)
[333.010757] [055/130] (691s left) kms_force_connector_basic (force-edid)
[333.097799] Starting subtest: force-edid
[333.465336] Subtest force-edid: SUCCESS (0.367s)
[333.631075] [056/130] (691s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs)
[333.727323] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs
[333.729582] Starting dynamic subtest: pipe-A-eDP-1
[334.472376] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.738s)
[334.482542] Starting dynamic subtest: pipe-B-eDP-1
[336.267433] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.794s)
[336.277962] Starting dynamic subtest: pipe-C-eDP-1
[338.073588] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.805s)
[338.083742] Starting dynamic subtest: pipe-D-eDP-1
[339.866170] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.791s)
[339.868053] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SUCCESS (6.133s)
[341.092890] [057/130] (683s left) kms_ccs (crc-primary-basic-4-tiled-lnl-ccs)
[341.199424] Starting subtest: crc-primary-basic-4-tiled-lnl-ccs
[341.203931] Subtest crc-primary-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[342.387951] [058/130] (682s left) gem_ctx_isolation (dirty-switch)
[342.449873] Starting subtest: dirty-switch
[342.452296] Starting dynamic subtest: rcs0
[342.659049] Dynamic subtest rcs0: SUCCESS (0.209s)
[342.670987] Starting dynamic subtest: bcs0
[342.881566] Dynamic subtest bcs0: SUCCESS (0.222s)
[342.892781] Starting dynamic subtest: vcs0
[343.143795] Dynamic subtest vcs0: SUCCESS (0.261s)
[343.154850] Starting dynamic subtest: vcs1
[344.701393] Dynamic subtest vcs1: SUCCESS (1.557s)
[344.710771] Starting dynamic subtest: vecs0
[346.706757] Dynamic subtest vecs0: SUCCESS (2.004s)
[346.716269] Starting dynamic subtest: ccs0
[348.757544] Dynamic subtest ccs0: SUCCESS (2.050s)
[348.759970] Subtest dirty-switch: SUCCESS (6.309s)
[349.031776] [059/130] (676s left) gem_pwrite (basic-self)
[349.085319] Subtest basic-self: SKIP (0.000s)
[349.156702] [060/130] (676s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area-big-fb)
[354.266514] Starting subtest: psr2-primary-plane-update-sf-dmg-area-big-fb
[354.268764] Starting dynamic subtest: pipe-A-eDP-1
[361.337516] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.072s)
[361.347238] Starting dynamic subtest: pipe-B-eDP-1
[368.368985] Dynamic subtest pipe-B-eDP-1: SUCCESS (7.031s)
[368.371280] Subtest psr2-primary-plane-update-sf-dmg-area-big-fb: SUCCESS (14.107s)
[369.192210] [061/130] (656s left) gem_exec_whisper (basic-queues-priority-all)
[369.268192] Starting subtest: basic-queues-priority-all
[390.713554] Subtest basic-queues-priority-all: SUCCESS (21.447s)
[390.917823] [062/130] (634s left) i915_pm_rpm (gem-execbuf-stress)
[392.659747] Starting subtest: gem-execbuf-stress
[392.661971] Starting dynamic subtest: smem0
[405.493491] Dynamic subtest smem0: SUCCESS (12.839s)
[405.504266] Starting dynamic subtest: extra-wait-smem0
[467.493611] Dynamic subtest extra-wait-smem0: SUCCESS (61.969s)
[467.496363] Subtest gem-execbuf-stress: SUCCESS (74.814s)
[467.904944] [063/130] (557s left) gem_pipe_control_store_loop (reused-buffer)
[467.961208] Starting subtest: reused-buffer
[470.117608] Subtest reused-buffer: SUCCESS (2.154s)
[470.269209] [064/130] (555s left) syncobj_wait (wait-any-complex)
[470.322940] Starting subtest: wait-any-complex
[470.385129] Subtest wait-any-complex: SUCCESS (0.062s)
[470.490555] [065/130] (554s left) kms_draw_crc (draw-method-blt)
[470.584382] Starting subtest: draw-method-blt
[470.586353] Starting dynamic subtest: xrgb8888-untiled
[470.839046] Dynamic subtest xrgb8888-untiled: SUCCESS (0.255s)
[470.848831] Starting dynamic subtest: rgb565-untiled
[471.072561] Dynamic subtest rgb565-untiled: SUCCESS (0.233s)
[471.082493] Starting dynamic subtest: xrgb2101010-untiled
[471.294418] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.221s)
[471.307608] Starting dynamic subtest: xbgr16161616f-untiled
[471.516749] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.221s)
[471.527286] Starting dynamic subtest: xrgb8888-xtiled
[471.627810] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.110s)
[471.637534] Starting dynamic subtest: rgb565-xtiled
[471.739137] Dynamic subtest rgb565-xtiled: SUCCESS (0.110s)
[471.748842] Starting dynamic subtest: xrgb2101010-xtiled
[471.850272] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.110s)
[471.860005] Starting dynamic subtest: xbgr16161616f-xtiled
[471.972558] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.122s)
[471.982828] Starting dynamic subtest: xrgb8888-4tiled
[472.094719] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.122s)
[472.104709] Starting dynamic subtest: rgb565-4tiled
[472.216934] Dynamic subtest rgb565-4tiled: SUCCESS (0.121s)
[472.229107] Starting dynamic subtest: xrgb2101010-4tiled
[472.328111] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.109s)
[472.337737] Starting dynamic subtest: xbgr16161616f-4tiled
[472.472488] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.144s)
[472.474379] Subtest draw-method-blt: SUCCESS (1.889s)
[472.633052] [066/130] (552s left) gem_exec_whisper (basic-contexts)
[472.698515] Starting subtest: basic-contexts
[478.554076] Subtest basic-contexts: SUCCESS (5.851s)
[478.763192] [067/130] (546s left) gem_exec_schedule (preempt-other)
[478.830892] Starting subtest: preempt-other
[478.833091] Starting dynamic subtest: rcs0
[478.949143] Dynamic subtest rcs0: SUCCESS (0.123s)
[478.963109] Starting dynamic subtest: bcs0
[479.067200] Dynamic subtest bcs0: SUCCESS (0.116s)
[479.083280] Starting dynamic subtest: vcs0
[479.180254] Dynamic subtest vcs0: SUCCESS (0.113s)
[479.197034] Starting dynamic subtest: vcs1
[479.294562] Dynamic subtest vcs1: SUCCESS (0.113s)
[479.309455] Starting dynamic subtest: vecs0
[479.411289] Dynamic subtest vecs0: SUCCESS (0.116s)
[479.428457] Starting dynamic subtest: ccs0
[479.529286] Dynamic subtest ccs0: SUCCESS (0.117s)
[479.532312] Subtest preempt-other: SUCCESS (0.704s)
[480.636168] [068/130] (544s left) kms_psr (pr-primary-mmap-gtt)
[480.741513] Starting subtest: pr-primary-mmap-gtt
[480.745835] Subtest pr-primary-mmap-gtt: SKIP (0.000s)
[480.835269] [069/130] (544s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-20x20)
[480.937591] Starting subtest: planes-downscale-factor-0-5-upscale-20x20
[480.940207] Starting dynamic subtest: pipe-A
[480.961925] Dynamic subtest pipe-A: SKIP (0.021s)
[480.972076] Starting dynamic subtest: pipe-B
[480.994261] Dynamic subtest pipe-B: SKIP (0.032s)
[481.004494] Starting dynamic subtest: pipe-C
[481.029768] Dynamic subtest pipe-C: SKIP (0.033s)
[481.039435] Starting dynamic subtest: pipe-D
[481.064241] Dynamic subtest pipe-D: SKIP (0.033s)
[481.068012] Subtest planes-downscale-factor-0-5-upscale-20x20: SKIP (0.124s)
[481.205895] [070/130] (544s left) gem_exec_flush (basic-uc-set-default)
[481.275025] Starting subtest: basic-uc-set-default
[486.727725] Subtest basic-uc-set-default: SUCCESS (5.452s)
[486.964703] [071/130] (538s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-blt)
[487.071873] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-blt
[487.076553] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[487.225301] [072/130] (538s left) gem_tiled_partial_pwrite_pread (reads)
[487.291598] Subtest reads: SKIP (0.000s)
[487.379065] [073/130] (538s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-blt)
[487.474089] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-blt
[487.478152] Subtest psr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[487.601999] [074/130] (538s left) gem_exec_parallel (contexts)
[487.664369] Starting subtest: contexts
[487.666739] Starting dynamic subtest: rcs0
[490.587561] Dynamic subtest rcs0: SUCCESS (2.921s)
[490.599980] Starting dynamic subtest: bcs0
[494.107685] Dynamic subtest bcs0: SUCCESS (3.518s)
[494.122646] Starting dynamic subtest: vcs0
[497.915698] Dynamic subtest vcs0: SUCCESS (3.805s)
[497.925585] Starting dynamic subtest: vcs1
[501.992337] Dynamic subtest vcs1: SUCCESS (4.075s)
[502.002296] Starting dynamic subtest: vecs0
[505.959633] Dynamic subtest vecs0: SUCCESS (3.964s)
[505.972579] Starting dynamic subtest: ccs0
[509.565801] Dynamic subtest ccs0: SUCCESS (3.605s)
[509.568612] Subtest contexts: SUCCESS (21.898s)
[509.778261] [075/130] (516s left) prime_mmap (test_refcounting)
[509.835499] Starting subtest: test_refcounting
[509.837552] Starting dynamic subtest: test_refcounting-smem
[509.865037] Dynamic subtest test_refcounting-smem: SUCCESS (0.031s)
[509.867520] Subtest test_refcounting: SUCCESS (0.031s)
[510.004184] [076/130] (515s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[510.133914] Starting subtest: cursorB-vs-flipB-toggle
[510.138389] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s)
[510.305332] [077/130] (515s left) gem_basic (bad-close)
[510.368028] Starting subtest: bad-close
[510.372488] Subtest bad-close: SUCCESS (0.000s)
[510.497931] [078/130] (515s left) kms_getfb (getfb2-handle-closed)
[510.590344] Starting subtest: getfb2-handle-closed
[510.593560] Subtest getfb2-handle-closed: SUCCESS (0.000s)
[510.716385] [079/130] (515s left) gem_ctx_persistence (legacy-engines-hostile)
[510.781475] Starting subtest: legacy-engines-hostile
[510.783424] Starting dynamic subtest: render
[510.865910] Dynamic subtest render: SUCCESS (0.084s)
[510.880988] Starting dynamic subtest: bsd1
[510.980220] Dynamic subtest bsd1: SUCCESS (0.111s)
[510.995280] Starting dynamic subtest: bsd2
[511.082181] Dynamic subtest bsd2: SUCCESS (0.099s)
[511.097348] Starting dynamic subtest: blt
[511.196408] Dynamic subtest blt: SUCCESS (0.111s)
[511.215513] Starting dynamic subtest: vebox
[511.274812] Dynamic subtest vebox: SUCCESS (0.076s)
[511.276789] Subtest legacy-engines-hostile: SUCCESS (0.495s)
[511.428248] [080/130] (514s left) kms_cursor_crc (cursor-onscreen-128x42)
[511.641480] Starting subtest: cursor-onscreen-128x42
[511.690715] Subtest cursor-onscreen-128x42: SKIP (0.046s)
[511.945893] [081/130] (514s left) perf_pmu (render-node-busy)
[512.031983] Starting subtest: render-node-busy
[512.034349] Starting dynamic subtest: rcs0
[512.618745] Dynamic subtest rcs0: SUCCESS (0.590s)
[512.631105] Starting dynamic subtest: bcs0
[513.187077] Dynamic subtest bcs0: SUCCESS (0.566s)
[513.199719] Starting dynamic subtest: vcs0
[514.474995] Dynamic subtest vcs0: SUCCESS (1.284s)
[514.487619] Starting dynamic subtest: vcs1
[516.459480] Dynamic subtest vcs1: SUCCESS (1.982s)
[516.472335] Starting dynamic subtest: vecs0
[518.506861] Dynamic subtest vecs0: SUCCESS (2.045s)
[518.520135] Starting dynamic subtest: ccs0
[519.079261] Dynamic subtest ccs0: SUCCESS (0.571s)
[519.081712] Subtest render-node-busy: SUCCESS (7.053s)
[519.185951] [082/130] (506s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-onoff)
[519.290122] Starting subtest: fbc-1p-primscrn-cur-indfb-onoff
[523.214878] Subtest fbc-1p-primscrn-cur-indfb-onoff: SUCCESS (3.928s)
[524.393186] [083/130] (501s left) gem_exec_balancer (hang)
[524.661329] Starting subtest: hang
[526.536594] Subtest hang: SUCCESS (1.880s)
[526.692960] [084/130] (499s left) kms_cursor_crc (cursor-random-max-size)
[526.992161] Starting subtest: cursor-random-max-size
[526.998836] Subtest cursor-random-max-size: SKIP (0.000s)
[527.180101] [085/130] (499s left) kms_cursor_edge_walk (64x64-left-edge)
[527.265190] Starting subtest: 64x64-left-edge
[527.267406] Starting dynamic subtest: pipe-A-eDP-1
[530.683402] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.418s)
[530.694046] Starting dynamic subtest: pipe-D-eDP-1
[533.872376] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.186s)
[533.874616] Subtest 64x64-left-edge: SUCCESS (6.607s)
[534.694273] [086/130] (491s left) kms_chamelium_audio (hdmi-audio-edid)
[535.079876] Subtest hdmi-audio-edid: SKIP (0.000s)
[535.938467] [087/130] (490s left) kms_big_fb (x-tiled-8bpp-rotate-180)
[536.047695] Starting subtest: x-tiled-8bpp-rotate-180
[537.259167] Subtest x-tiled-8bpp-rotate-180: SUCCESS (1.213s)
[537.434045] [088/130] (488s left) kms_psr (psr-sprite-plane-move)
[537.543584] Starting subtest: psr-sprite-plane-move
[537.545330] Starting dynamic subtest: eDP-1
[539.359304] Dynamic subtest eDP-1: SUCCESS (1.815s)
[539.361652] Subtest psr-sprite-plane-move: SUCCESS (1.816s)
[540.187859] [089/130] (486s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs-cc)
[540.282449] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs-cc
[540.284751] Starting dynamic subtest: pipe-A-eDP-1
[556.856778] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.810s)
[556.867305] Starting dynamic subtest: pipe-B-eDP-1
[574.839237] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.802s)
[574.850301] Starting dynamic subtest: pipe-C-eDP-1
[592.797030] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.754s)
[592.807065] Starting dynamic subtest: pipe-D-eDP-1
[610.819419] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.721s)
[610.821999] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs-cc: SUCCESS (10.092s)
[621.026966] [090/130] (414s left) kms_cursor_crc (cursor-sliding-256x85)
[621.308178] Starting subtest: cursor-sliding-256x85
[621.360820] Subtest cursor-sliding-256x85: SKIP (0.047s)
[621.568983] [091/130] (413s left) gem_pxp (reject-modify-context-protection-on)
[621.692144] Starting subtest: reject-modify-context-protection-on
[621.694471] Subtest reject-modify-context-protection-on: SUCCESS (0.002s)
[621.831125] [092/130] (413s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant)
[621.934760] Starting subtest: coverage-vs-premult-vs-constant
[622.202612] Starting dynamic subtest: pipe-A-eDP-1
[622.781705] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.598s)
[622.792470] Starting dynamic subtest: pipe-D-eDP-1
[624.044758] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.300s)
[624.047557] Subtest coverage-vs-premult-vs-constant: SUCCESS (2.180s)
[624.867247] [093/130] (410s left) kms_flip (flip-vs-suspend)
[624.958850] Starting subtest: flip-vs-suspend
[624.961207] Starting dynamic subtest: A-eDP1
[659.643206] Dynamic subtest A-eDP1: SUCCESS (4.307s)
[659.656041] Starting dynamic subtest: B-eDP1
[693.662003] Dynamic subtest B-eDP1: SUCCESS (4.213s)
[693.679284] Starting dynamic subtest: C-eDP1
[727.653284] Dynamic subtest C-eDP1: SUCCESS (4.152s)
[727.664556] Starting dynamic subtest: D-eDP1
[761.661898] Dynamic subtest D-eDP1: SUCCESS (4.234s)
[761.667035] Subtest flip-vs-suspend: SUCCESS (16.916s)
[772.881957] [094/130] (272s left) kms_big_fb (4-tiled-addfb-size-offset-overflow)
[773.005962] Starting subtest: 4-tiled-addfb-size-offset-overflow
[773.008050] Subtest 4-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[773.129052] [095/130] (272s left) kms_async_flips (async-flip-hang)
[773.219773] Starting subtest: async-flip-hang
[773.589557] Starting dynamic subtest: pipe-A-eDP-1
[788.376306] Dynamic subtest pipe-A-eDP-1: SUCCESS (14.996s)
[788.757745] Starting dynamic subtest: pipe-B-eDP-1
[804.425681] Dynamic subtest pipe-B-eDP-1: SUCCESS (15.709s)
[804.821284] Starting dynamic subtest: pipe-C-eDP-1
[820.438427] Dynamic subtest pipe-C-eDP-1: SUCCESS (15.618s)
[820.815481] Starting dynamic subtest: pipe-D-eDP-1
[836.433271] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.626s)
[836.436033] Subtest async-flip-hang: SUCCESS (63.470s)
[837.658828] [096/130] (208s left) gem_exec_fence (invalid-fence-array)
[838.153388] Starting subtest: invalid-fence-array
[838.155929] Subtest invalid-fence-array: SUCCESS (0.002s)
[840.069985] [097/130] (205s left) kms_pm_rpm (fences-dpms)
[842.120843] Starting subtest: fences-dpms
[842.126028] Subtest fences-dpms: SKIP (0.000s)
[842.513401] [098/130] (203s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite)
[842.625987] Starting subtest: psr-rgb101010-draw-pwrite
[850.234661] Subtest psr-rgb101010-draw-pwrite: SUCCESS (7.612s)
[850.381982] [099/130] (195s left) kms_setmode (basic-clone-single-crtc)
[850.445460] Starting subtest: basic-clone-single-crtc
[850.451981] Subtest basic-clone-single-crtc: SKIP (0.000s)
[850.591906] [100/130] (195s left) gem_mmap_gtt (fault-concurrent)
[850.651101] Subtest fault-concurrent: SKIP (0.000s)
[850.729047] [101/130] (195s left) kms_sequence (get-forked-busy)
[850.825674] Starting subtest: get-forked-busy
[850.827836] Starting dynamic subtest: pipe-A-eDP-1
[852.774762] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.946s)
[852.786258] Starting dynamic subtest: pipe-B-eDP-1
[855.400232] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.627s)
[855.411457] Starting dynamic subtest: pipe-C-eDP-1
[857.975001] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.571s)
[857.986108] Starting dynamic subtest: pipe-D-eDP-1
[860.587374] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.614s)
[860.590045] Subtest get-forked-busy: SUCCESS (9.764s)
[861.455749] [102/130] (184s left) kms_big_fb (linear-64bpp-rotate-270)
[861.558714] Starting subtest: linear-64bpp-rotate-270
[861.578391] Subtest linear-64bpp-rotate-270: SKIP (0.018s)
[861.718084] [103/130] (184s left) gem_mmap_gtt (hang-busy)
[861.788702] Subtest hang-busy: SKIP (0.000s)
[861.859608] [104/130] (184s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area)
[866.935518] Starting subtest: fbc-pr-primary-plane-update-sf-dmg-area
[866.940043] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.003s)
[867.762942] [105/130] (178s left) syncobj_timeline (single-wait-signaled)
[867.822156] Starting subtest: single-wait-signaled
[867.824457] Subtest single-wait-signaled: SUCCESS (0.000s)
[867.941108] [106/130] (178s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc)
[868.035540] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc
[874.977899] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (6.941s)
[875.127910] [107/130] (171s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs)
[875.187607] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs
[875.191790] Subtest y-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[875.399419] [108/130] (170s left) kms_frontbuffer_tracking (fbc-stridechange)
[875.504856] Starting subtest: fbc-stridechange
[878.829285] Subtest fbc-stridechange: SUCCESS (3.326s)
[879.985017] [109/130] (166s left) fbdev (pan)
[880.023426] Starting subtest: pan
[880.050946] Subtest pan: SUCCESS (0.031s)
[880.150130] [110/130] (166s left) kms_psr (fbc-psr-sprite-plane-onoff)
[880.249280] Starting subtest: fbc-psr-sprite-plane-onoff
[880.251544] Starting dynamic subtest: eDP-1
[880.255662] Dynamic subtest eDP-1: SKIP (0.000s)
[880.259599] Subtest fbc-psr-sprite-plane-onoff: SKIP (0.001s)
[880.352952] [111/130] (166s left) syncobj_wait (multi-wait-all-for-submit-submitted-signaled)
[880.405529] Starting subtest: multi-wait-all-for-submit-submitted-signaled
[880.508821] Subtest multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.102s)
[880.613746] [112/130] (165s left) gem_close_race (basic-process)
[880.684530] Starting subtest: basic-process
[880.743906] Subtest basic-process: SUCCESS (0.060s)
[880.956531] [113/130] (165s left) syncobj_wait (multi-wait-submitted-signaled)
[881.021287] Starting subtest: multi-wait-submitted-signaled
[881.023657] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[881.165504] [114/130] (165s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait)
[881.264621] Starting subtest: plane-primary-toggle-with-vblank-wait
[881.266928] Starting dynamic subtest: pipe-A-eDP-1
[881.443242] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s)
[881.744245] Starting dynamic subtest: pipe-B-eDP-1
[882.600637] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.866s)
[882.902086] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.638s)
[883.748914] [115/130] (162s left) gen7_exec_parse (bitmasks)
[883.821747] Subtest bitmasks: SKIP (0.000s)
[883.908809] [116/130] (162s left) api_intel_allocator (two-level-inception)
[883.959551] Starting subtest: two-level-inception
[889.359862] Subtest two-level-inception: SUCCESS (5.400s)
[889.521471] [117/130] (157s left) kms_plane_alpha_blend (alpha-7efc)
[889.627483] Starting subtest: alpha-7efc
[889.927888] Starting dynamic subtest: pipe-A-eDP-1
[890.551546] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.621s)
[890.590913] Starting dynamic subtest: pipe-D-eDP-1
[891.911540] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.330s)
[891.913976] Subtest alpha-7efc: SUCCESS (2.285s)
[892.755711] [118/130] (153s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc)
[892.863203] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc
[892.865225] Starting dynamic subtest: pipe-A-eDP-1
[893.020431] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.149s)
[893.033915] Starting dynamic subtest: pipe-B-eDP-1
[893.053326] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.010s)
[893.063473] Starting dynamic subtest: pipe-C-eDP-1
[893.082849] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.010s)
[893.092327] Starting dynamic subtest: pipe-D-eDP-1
[893.111649] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.010s)
[893.113525] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.184s)
[895.354611] [119/130] (151s left) api_intel_bb (intel-bb-blit-y)
[895.420422] Starting subtest: intel-bb-blit-y
[899.505171] Subtest intel-bb-blit-y: SUCCESS (4.084s)
[899.671879] [120/130] (147s left) kms_flip (2x-flip-vs-dpms-off-vs-modeset-interruptible)
[899.786460] Starting subtest: 2x-flip-vs-dpms-off-vs-modeset-interruptible
[899.798068] Subtest 2x-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.011s)
[899.951922] [121/130] (146s left) gem_userptr_blits (sync-unmap)
[900.029504] Starting subtest: sync-unmap
[900.045245] Subtest sync-unmap: SUCCESS (0.016s)
[900.213614] [122/130] (146s left) kms_big_fb (yf-tiled-32bpp-rotate-270)
[900.312799] Starting subtest: yf-tiled-32bpp-rotate-270
[900.317255] Subtest yf-tiled-32bpp-rotate-270: SKIP (0.000s)
[900.455332] [123/130] (146s left) gem_ctx_shared (disjoint-timelines)
[900.539278] Starting subtest: disjoint-timelines
[900.560593] Subtest disjoint-timelines: SUCCESS (0.021s)
[900.862418] [124/130] (146s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite)
[900.976905] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite
[900.980923] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[901.091665] [125/130] (145s left) kms_lease (empty-lease)
[901.352723] Starting subtest: empty-lease
[901.355057] Starting dynamic subtest: pipe-A-eDP-1
[901.357437] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[901.367901] Starting dynamic subtest: pipe-B-eDP-1
[901.369853] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[901.379746] Starting dynamic subtest: pipe-C-eDP-1
[901.381663] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[901.391326] Starting dynamic subtest: pipe-D-eDP-1
[901.393346] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s)
[901.395356] Subtest empty-lease: SUCCESS (0.012s)
[901.573446] [126/130] (145s left) gen3_mixed_blits
[901.785860] [127/130] (145s left) gem_cs_tlb (engines)
[901.881066] Starting subtest: engines
[901.883468] Starting dynamic subtest: rcs0
[904.037483] Dynamic subtest rcs0: SUCCESS (2.153s)
[904.053951] Starting dynamic subtest: bcs0
[906.190866] Dynamic subtest bcs0: SUCCESS (2.153s)
[906.202519] Starting dynamic subtest: vcs0
[908.344379] Dynamic subtest vcs0: SUCCESS (2.151s)
[908.356748] Starting dynamic subtest: vcs1
[910.497200] Dynamic subtest vcs1: SUCCESS (2.153s)
[910.510276] Starting dynamic subtest: vecs0
[912.650293] Dynamic subtest vecs0: SUCCESS (2.152s)
[912.660876] Starting dynamic subtest: ccs0
[914.803308] Dynamic subtest ccs0: SUCCESS (2.153s)
[914.805270] Subtest engines: SUCCESS (12.920s)
[915.001045] [128/130] (132s left) gem_mmap_gtt (basic-small-bo-tiledy)
[915.064665] Subtest basic-small-bo-tiledY: SKIP (0.000s)
[915.139065] [129/130] (132s left) gem_mmap (bad-object)
[915.212770] Subtest bad-object: SKIP (0.000s)
[915.286281] [130/130] (132s left) i915_fb_tiling (basic-x-tiling)
[915.352528] Subtest basic-x-tiling: SKIP (0.000s)
[915.413269] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_atomic
results: parsing output: 2/ for test: kms_flip_scaled_crc
results: parsing output: 3/ for test: vgem_basic
results: parsing output: 4/ for test: kms_invalid_mode
results: parsing output: 5/ for test: gem_spin_batch
results: parsing output: 6/ for test: syncobj_wait
results: parsing output: 7/ for test: kms_pm_backlight
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: kms_color
results: parsing output: 11/ for test: kms_psr
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: perf_pmu
results: parsing output: 15/ for test: gem_madvise
results: parsing output: 16/ for test: kms_psr2_sf
results: parsing output: 17/ for test: kms_flip
results: parsing output: 18/ for test: gem_exec_big
results: parsing output: 19/ for test: syncobj_timeline
results: parsing output: 20/ for test: kms_prop_blob
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: kms_getfb
results: parsing output: 23/ for test: syncobj_timeline
results: parsing output: 24/ for test: sriov_basic
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: i915_pm_rps
results: parsing output: 27/ for test: kms_chamelium_edid
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: kms_vblank
results: parsing output: 30/ for test: i915_drm_fdinfo
results: parsing output: 31/ for test: gem_partial_pwrite_pread
results: parsing output: 32/ for test: syncobj_timeline
results: parsing output: 33/ for test: gem_set_tiling_vs_blt
results: parsing output: 34/ for test: gem_exec_params
results: parsing output: 35/ for test: syncobj_wait
results: parsing output: 36/ for test: kms_pipe_b_c_ivb
results: parsing output: 37/ for test: kms_big_fb
results: parsing output: 38/ for test: syncobj_timeline
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_flip_scaled_crc
results: parsing output: 41/ for test: gem_exec_schedule
results: parsing output: 42/ for test: kms_ccs
results: parsing output: 43/ for test: dmabuf_sync_file
results: parsing output: 44/ for test: gem_caching
results: parsing output: 45/ for test: gem_lmem_swapping
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: gem_wait
results: parsing output: 48/ for test: kms_flip
results: parsing output: 49/ for test: kms_chamelium_hpd
results: parsing output: 50/ for test: kms_psr
results: parsing output: 51/ for test: gem_exec_params
results: parsing output: 52/ for test: kms_cursor_legacy
results: parsing output: 53/ for test: gem_partial_pwrite_pread
results: parsing output: 54/ for test: kms_force_connector_basic
results: parsing output: 55/ for test: kms_ccs
results: parsing output: 56/ for test: kms_ccs
results: parsing output: 57/ for test: gem_ctx_isolation
results: parsing output: 58/ for test: gem_pwrite
results: parsing output: 59/ for test: kms_psr2_sf
results: parsing output: 60/ for test: gem_exec_whisper
results: parsing output: 61/ for test: i915_pm_rpm
results: parsing output: 62/ for test: gem_pipe_control_store_loop
results: parsing output: 63/ for test: syncobj_wait
results: parsing output: 64/ for test: kms_draw_crc
results: parsing output: 65/ for test: gem_exec_whisper
results: parsing output: 66/ for test: gem_exec_schedule
results: parsing output: 67/ for test: kms_psr
results: parsing output: 68/ for test: kms_plane_scaling
results: parsing output: 69/ for test: gem_exec_flush
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: gem_exec_parallel
results: parsing output: 74/ for test: prime_mmap
results: parsing output: 75/ for test: kms_cursor_legacy
results: parsing output: 76/ for test: gem_basic
results: parsing output: 77/ for test: kms_getfb
results: parsing output: 78/ for test: gem_ctx_persistence
results: parsing output: 79/ for test: kms_cursor_crc
results: parsing output: 80/ for test: perf_pmu
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: gem_exec_balancer
results: parsing output: 83/ for test: kms_cursor_crc
results: parsing output: 84/ for test: kms_cursor_edge_walk
results: parsing output: 85/ for test: kms_chamelium_audio
results: parsing output: 86/ for test: kms_big_fb
results: parsing output: 87/ for test: kms_psr
results: parsing output: 88/ for test: kms_ccs
results: parsing output: 89/ for test: kms_cursor_crc
results: parsing output: 90/ for test: gem_pxp
results: parsing output: 91/ for test: kms_plane_alpha_blend
results: parsing output: 92/ for test: kms_flip
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: kms_async_flips
results: parsing output: 95/ for test: gem_exec_fence
results: parsing output: 96/ for test: kms_pm_rpm
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_setmode
results: parsing output: 99/ for test: gem_mmap_gtt
results: parsing output: 100/ for test: kms_sequence
results: parsing output: 101/ for test: kms_big_fb
results: parsing output: 102/ for test: gem_mmap_gtt
results: parsing output: 103/ for test: kms_psr2_sf
results: parsing output: 104/ for test: syncobj_timeline
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: gem_render_copy
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: fbdev
results: parsing output: 109/ for test: kms_psr
results: parsing output: 110/ for test: syncobj_wait
results: parsing output: 111/ for test: gem_close_race
results: parsing output: 112/ for test: syncobj_wait
results: parsing output: 113/ for test: kms_atomic_transition
results: parsing output: 114/ for test: gen7_exec_parse
results: parsing output: 115/ for test: api_intel_allocator
results: parsing output: 116/ for test: kms_plane_alpha_blend
results: parsing output: 117/ for test: kms_ccs
results: parsing output: 118/ for test: api_intel_bb
results: parsing output: 119/ for test: kms_flip
results: parsing output: 120/ for test: gem_userptr_blits
results: parsing output: 121/ for test: kms_big_fb
results: parsing output: 122/ for test: gem_ctx_shared
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_lease
results: parsing output: 125/ for test: gen3_mixed_blits
results: parsing output: 126/ for test: gem_cs_tlb
results: parsing output: 127/ for test: gem_mmap_gtt
results: parsing output: 128/ for test: gem_mmap
results: parsing output: 129/ for test: i915_fb_tiling
Done.