[56.965206] Initializing watchdogs [56.965280] /dev/watchdog0 [56.973133] [001/130] (960s left) gem_ctx_persistence (process) [57.031298] Starting subtest: process [57.266727] Subtest process: SUCCESS (0.235s) [57.323732] [002/130] (960s left) kms_chamelium_edid (hdmi-edid-change-during-suspend) [57.725976] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s) [58.512207] [003/130] (958s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling) [58.599121] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling [58.601569] Starting dynamic subtest: pipe-A-default-mode [58.904107] Dynamic subtest pipe-A-default-mode: SKIP (0.302s) [58.908648] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.302s) [59.663661] [004/130] (957s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-blt) [59.777196] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-blt [59.781656] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s) [59.871510] [005/130] (957s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt) [59.983326] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt [59.987604] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [60.072211] [006/130] (957s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip) [60.178431] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip [60.811630] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.636s) [60.984689] [007/130] (956s left) gem_exec_balancer (parallel-ordering) [61.240766] Starting subtest: parallel-ordering [62.057503] Subtest parallel-ordering: SUCCESS (0.815s) [62.189211] [008/130] (955s left) kms_big_fb (4-tiled-8bpp-rotate-180) [62.305699] Starting subtest: 4-tiled-8bpp-rotate-180 [63.308528] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.003s) [63.429256] [009/130] (954s left) kms_lease (master-vs-lease) [63.527875] Starting subtest: master-vs-lease [63.530202] Subtest master-vs-lease: SUCCESS (0.001s) [63.625185] [010/130] (954s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs) [63.717476] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs [63.719532] Starting dynamic subtest: pipe-A-eDP-1 [63.727481] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [63.735278] Starting dynamic subtest: pipe-B-eDP-1 [63.743659] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [63.749776] Starting dynamic subtest: pipe-C-eDP-1 [63.756850] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [63.762409] Starting dynamic subtest: pipe-D-eDP-1 [63.769651] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [63.773063] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.002s) [65.815941] [011/130] (951s left) syncobj_timeline (single-wait-for-submit-available-submitted) [65.873568] Starting subtest: single-wait-for-submit-available-submitted [65.875961] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s) [65.942784] [012/130] (951s left) gem_userptr_blits (dmabuf-unsync) [66.013404] Subtest dmabuf-unsync: SKIP (0.000s) [66.129828] [013/130] (951s left) gem_media_vme [66.233840] [014/130] (951s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-wc) [66.334371] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-wc [71.097144] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (4.764s) [71.489407] [015/130] (946s left) gem_exec_fence (syncobj-unused-fence) [72.288715] Starting subtest: syncobj-unused-fence [72.293880] Subtest syncobj-unused-fence: SUCCESS (0.005s) [74.052751] [016/130] (943s left) gem_mmap_offset (mmap-boundaries) [74.109106] Starting subtest: mmap-boundaries [74.111179] Starting dynamic subtest: smem0 [74.383635] Dynamic subtest smem0: SUCCESS (0.276s) [74.386142] Subtest mmap-boundaries: SUCCESS (0.276s) [74.487975] [017/130] (943s left) gem_exec_schedule (u-semaphore-user) [74.567267] Starting subtest: u-semaphore-user [74.625068] Subtest u-semaphore-user: SUCCESS (0.062s) [75.963812] [018/130] (941s left) gem_softpin (noreloc-interruptible) [76.021336] Starting subtest: noreloc-interruptible [81.423499] Subtest noreloc-interruptible: SUCCESS (5.401s) [81.579519] [019/130] (936s left) gem_linear_blits (basic) [81.953973] Starting subtest: basic [81.967504] Subtest basic: SUCCESS (0.014s) [82.055351] [020/130] (935s left) gem_spin_batch (spin-each) [82.154392] Starting subtest: spin-each [85.437326] Subtest spin-each: SUCCESS (3.277s) [85.995852] [021/130] (931s left) gem_pipe_control_store_loop (fresh-buffer) [86.053083] Starting subtest: fresh-buffer [88.209625] Subtest fresh-buffer: SUCCESS (2.155s) [88.321943] [022/130] (929s left) kms_psr (fbc-pr-primary-blt) [88.436087] Starting subtest: fbc-pr-primary-blt [88.440554] Subtest fbc-pr-primary-blt: SKIP (0.000s) [88.488231] [023/130] (929s left) syncobj_wait (invalid-signal-zero-handles) [88.543813] Starting subtest: invalid-signal-zero-handles [88.546169] Subtest invalid-signal-zero-handles: SUCCESS (0.000s) [88.634854] [024/130] (929s left) kms_psr (fbc-psr2-suspend) [88.734639] Starting subtest: fbc-psr2-suspend [88.736935] Starting dynamic subtest: eDP-1 [88.741251] Dynamic subtest eDP-1: SKIP (0.000s) [88.745613] Subtest fbc-psr2-suspend: SKIP (0.000s) [88.786428] [025/130] (929s left) syncobj_basic (bad-destroy) [88.843679] Starting subtest: bad-destroy [88.846101] Subtest bad-destroy: SUCCESS (0.000s) [88.936028] [026/130] (928s left) kms_frontbuffer_tracking (fbc-tiling-linear) [89.048826] Starting subtest: fbc-tiling-linear [91.725609] Subtest fbc-tiling-linear: SUCCESS (2.680s) [91.832068] [027/130] (926s left) vgem_basic (unload) [91.867322] Starting subtest: unload [121.078832] Subtest unload: SUCCESS (29.209s) [121.153948] [028/130] (896s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-pwrite) [121.260323] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-pwrite [126.336166] Subtest fbc-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (5.080s) [126.439808] [029/130] (891s left) drm_mm (drm_mm) [126.475752] Starting subtest: drm_mm [126.483114] Starting dynamic subtest: drm_test_mm_init [126.603451] Dynamic subtest drm_test_mm_init: SUCCESS (0.120s) [126.612792] Starting dynamic subtest: drm_test_mm_debug [126.684233] Dynamic subtest drm_test_mm_debug: SUCCESS (0.081s) [126.691415] Starting dynamic subtest: drm_test_mm_align32 [126.802396] Dynamic subtest drm_test_mm_align32: SUCCESS (0.118s) [126.817372] Starting dynamic subtest: drm_test_mm_align64 [126.898299] Dynamic subtest drm_test_mm_align64: SUCCESS (0.096s) [126.907021] Starting dynamic subtest: drm_test_mm_lowest [126.992671] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.094s) [126.999998] Starting dynamic subtest: drm_test_mm_highest [127.094271] Dynamic subtest drm_test_mm_highest: SUCCESS (0.100s) [127.096272] Subtest drm_mm: SUCCESS (0.617s) [127.253680] [030/130] (890s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-wc) [127.372419] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-wc [127.376613] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [127.454156] [031/130] (890s left) gem_workarounds (suspend-resume) [127.526523] Starting subtest: suspend-resume [144.213485] Subtest suspend-resume: SUCCESS (1.503s) [144.335040] [032/130] (888s left) gem_pread (self) [144.396926] Subtest self: SKIP (0.000s) [144.442406] [033/130] (888s left) gem_exec_capture (capture) [144.515483] Starting subtest: capture [144.517802] Starting dynamic subtest: rcs0-smem [145.353068] Dynamic subtest rcs0-smem: SUCCESS (0.838s) [145.366416] Starting dynamic subtest: bcs0-smem [146.383785] Dynamic subtest bcs0-smem: SUCCESS (1.028s) [146.393760] Starting dynamic subtest: vcs0-smem [147.199386] Dynamic subtest vcs0-smem: SUCCESS (0.815s) [147.209271] Starting dynamic subtest: vcs1-smem [148.015723] Dynamic subtest vcs1-smem: SUCCESS (0.815s) [148.023788] Starting dynamic subtest: vecs0-smem [149.410175] Dynamic subtest vecs0-smem: FAIL (1.331s) [149.419857] Starting dynamic subtest: ccs0-smem [150.667840] Dynamic subtest ccs0-smem: SUCCESS (1.321s) [150.669967] Subtest capture: FAIL (6.148s) [150.774174] [034/130] (882s left) kms_dither (fb-8bpc-vs-panel-6bpc) [150.871445] Starting subtest: fb-8bpc-vs-panel-6bpc [150.873873] Starting dynamic subtest: pipe-A-eDP-1 [152.245041] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.369s) [152.247436] Subtest fb-8bpc-vs-panel-6bpc: SUCCESS (1.370s) [153.088647] [035/130] (880s left) kms_invalid_mode (bad-vsync-end) [153.184815] Starting subtest: bad-vsync-end [153.187123] Starting dynamic subtest: pipe-A-eDP-1 [153.466378] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.282s) [153.476246] Starting dynamic subtest: pipe-B-eDP-1 [153.478288] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [153.485402] Starting dynamic subtest: pipe-C-eDP-1 [153.487789] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [153.496699] Starting dynamic subtest: pipe-D-eDP-1 [153.499093] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [153.501490] Subtest bad-vsync-end: SUCCESS (0.286s) [154.317230] [036/130] (879s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-fully-sf) [159.296997] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-fully-sf [159.302007] Subtest fbc-pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.002s) [160.122062] [037/130] (873s left) gem_ctx_param (invalid-param-get) [160.182637] Starting subtest: invalid-param-get [160.185005] Subtest invalid-param-get: SUCCESS (0.002s) [160.277899] [038/130] (873s left) syncobj_basic (bad-flags-handle-to-fd) [160.335962] Starting subtest: bad-flags-handle-to-fd [160.337995] Subtest bad-flags-handle-to-fd: SUCCESS (0.000s) [160.410150] [039/130] (872s left) kms_plane_cursor (primary) [160.517614] Starting subtest: primary [160.522300] Starting dynamic subtest: pipe-A-eDP-1-size-64 [163.070204] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.551s) [163.092650] Starting dynamic subtest: pipe-A-eDP-1-size-128 [165.637774] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.549s) [165.661191] Starting dynamic subtest: pipe-A-eDP-1-size-256 [168.205938] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.549s) [168.517860] Starting dynamic subtest: pipe-B-eDP-1-size-64 [171.815606] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.304s) [171.843381] Starting dynamic subtest: pipe-B-eDP-1-size-128 [174.382020] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.549s) [174.406682] Starting dynamic subtest: pipe-B-eDP-1-size-256 [176.928648] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.526s) [177.245719] Starting dynamic subtest: pipe-C-eDP-1-size-64 [180.002826] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.765s) [180.033236] Starting dynamic subtest: pipe-C-eDP-1-size-128 [182.058749] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.035s) [182.090249] Starting dynamic subtest: pipe-C-eDP-1-size-256 [184.114742] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.035s) [184.434902] Starting dynamic subtest: pipe-D-eDP-1-size-64 [187.167859] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.743s) [187.196020] Starting dynamic subtest: pipe-D-eDP-1-size-128 [189.189925] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.002s) [189.215205] Starting dynamic subtest: pipe-D-eDP-1-size-256 [191.246121] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.035s) [191.542018] Subtest primary: SUCCESS (31.014s) [192.327870] [040/130] (841s left) drm_fdinfo (busy-hang) [192.379246] Starting subtest: busy-hang [192.381972] Starting dynamic subtest: rcs0 [192.424542] Dynamic subtest rcs0: SKIP (0.043s) [192.434976] Starting dynamic subtest: bcs0 [192.439069] Dynamic subtest bcs0: SKIP (0.001s) [192.446992] Starting dynamic subtest: vcs0 [192.451412] Dynamic subtest vcs0: SKIP (0.000s) [192.459136] Starting dynamic subtest: vcs1 [192.463279] Dynamic subtest vcs1: SKIP (0.001s) [192.470614] Starting dynamic subtest: vecs0 [192.474712] Dynamic subtest vecs0: SKIP (0.000s) [192.481993] Starting dynamic subtest: ccs0 [192.486112] Dynamic subtest ccs0: SKIP (0.001s) [192.490253] Subtest busy-hang: SKIP (0.050s) [192.504977] [041/130] (840s left) kms_big_fb (linear-64bpp-rotate-180) [192.612335] Starting subtest: linear-64bpp-rotate-180 [194.001616] Subtest linear-64bpp-rotate-180: SUCCESS (1.389s) [194.144474] [042/130] (839s left) kms_chamelium_hpd (vga-hpd-for-each-pipe) [194.527086] Subtest vga-hpd-for-each-pipe: SKIP (0.000s) [195.324074] [043/130] (838s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip) [195.422152] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip [195.426288] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s) [195.510365] [044/130] (837s left) gem_ctx_isolation (preservation) [195.572011] Starting subtest: preservation [195.574443] Starting dynamic subtest: rcs0 [195.696779] Dynamic subtest rcs0: SUCCESS (0.124s) [195.706898] Starting dynamic subtest: bcs0 [195.861348] Dynamic subtest bcs0: SUCCESS (0.164s) [195.871392] Starting dynamic subtest: vcs0 [196.027725] Dynamic subtest vcs0: SUCCESS (0.166s) [196.035779] Starting dynamic subtest: vcs1 [197.234287] Dynamic subtest vcs1: SUCCESS (1.205s) [197.245623] Starting dynamic subtest: vecs0 [199.234005] Dynamic subtest vecs0: SUCCESS (1.998s) [199.245000] Starting dynamic subtest: ccs0 [201.212112] Dynamic subtest ccs0: SUCCESS (1.977s) [201.214476] Subtest preservation: SUCCESS (5.638s) [201.436859] [045/130] (832s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs-cc) [201.547681] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs-cc [201.550048] Starting dynamic subtest: pipe-A-eDP-1 [201.575622] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [201.584309] Starting dynamic subtest: pipe-B-eDP-1 [201.607846] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [201.616137] Starting dynamic subtest: pipe-C-eDP-1 [201.639506] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [201.647621] Starting dynamic subtest: pipe-D-eDP-1 [201.672588] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [201.676749] Subtest random-ccs-data-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s) [203.694349] [046/130] (829s left) syncobj_wait (wait-for-submit-delayed-submit) [203.748204] Starting subtest: wait-for-submit-delayed-submit [203.849331] Subtest wait-for-submit-delayed-submit: SUCCESS (0.102s) [203.912417] [047/130] (829s left) gem_pxp (reject-modify-context-protection-off-3) [204.044397] Starting subtest: reject-modify-context-protection-off-3 [204.046979] Subtest reject-modify-context-protection-off-3: SUCCESS (0.002s) [205.147056] [048/130] (828s left) kms_frontbuffer_tracking (fbcpsr-slowdraw) [205.248647] Starting subtest: fbcpsr-slowdraw [228.235288] Subtest fbcpsr-slowdraw: SUCCESS (22.986s) [228.372604] [049/130] (805s left) gem_exec_params (invalid-ring) [228.450034] Starting subtest: invalid-ring [228.452410] Subtest invalid-ring: SUCCESS (0.000s) [228.551332] [050/130] (805s left) gem_exec_schedule (preempt-engines) [228.625602] Starting subtest: preempt-engines [228.627934] Starting dynamic subtest: rcs0 [230.828976] Dynamic subtest rcs0: SUCCESS (2.208s) [230.839629] Starting dynamic subtest: bcs0 [233.077168] Dynamic subtest bcs0: SUCCESS (2.246s) [233.085255] Starting dynamic subtest: vcs0 [235.300899] Dynamic subtest vcs0: SUCCESS (2.220s) [235.316111] Starting dynamic subtest: vcs1 [237.551217] Dynamic subtest vcs1: SUCCESS (2.249s) [237.560701] Starting dynamic subtest: vecs0 [239.769215] Dynamic subtest vecs0: SUCCESS (2.215s) [239.780224] Starting dynamic subtest: ccs0 [242.097610] Dynamic subtest ccs0: SUCCESS (2.329s) [242.100232] Subtest preempt-engines: SUCCESS (13.476s) [242.382665] [051/130] (791s left) gem_eio (wait-immediate) [242.617136] Starting subtest: wait-immediate [243.002278] Subtest wait-immediate: SUCCESS (0.386s) [243.100039] [052/130] (790s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-gtt) [243.212300] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-gtt [243.216753] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [243.295265] [053/130] (790s left) gem_busy (extended) [243.493102] Starting subtest: extended [243.495478] Starting dynamic subtest: rcs0 [243.588263] Dynamic subtest rcs0: SUCCESS (0.095s) [243.599712] Starting dynamic subtest: bcs0 [243.631830] Dynamic subtest bcs0: SUCCESS (0.042s) [243.641626] Starting dynamic subtest: vcs0 [245.114114] Dynamic subtest vcs0: SUCCESS (1.479s) [245.125836] Starting dynamic subtest: vcs1 [247.097283] Dynamic subtest vcs1: SUCCESS (1.982s) [247.109545] Starting dynamic subtest: vecs0 [249.145780] Dynamic subtest vecs0: SUCCESS (2.047s) [249.157372] Starting dynamic subtest: ccs0 [249.190283] Dynamic subtest ccs0: SUCCESS (0.044s) [249.192877] Subtest extended: SUCCESS (5.700s) [249.425244] [054/130] (784s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt) [249.536046] Starting subtest: psr-rgb101010-draw-mmap-gtt [249.540512] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s) [249.631673] [055/130] (784s left) gem_userptr_blits (readonly-unsync) [249.705419] Subtest readonly-unsync: SKIP (0.000s) [249.813951] [056/130] (783s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs) [249.912764] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs [249.915241] Starting dynamic subtest: pipe-A-eDP-1 [249.936235] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [249.949906] Starting dynamic subtest: pipe-B-eDP-1 [249.970113] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [249.979953] Starting dynamic subtest: pipe-C-eDP-1 [249.999366] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [250.007299] Starting dynamic subtest: pipe-D-eDP-1 [250.026730] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [250.028602] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs: SUCCESS (0.007s) [252.086225] [057/130] (781s left) kms_cursor_crc (cursor-onscreen-512x170) [252.380928] Starting subtest: cursor-onscreen-512x170 [252.385388] Subtest cursor-onscreen-512x170: SKIP (0.001s) [252.513014] [058/130] (781s left) kms_big_fb (4-tiled-32bpp-rotate-90) [252.622740] Starting subtest: 4-tiled-32bpp-rotate-90 [252.644033] Subtest 4-tiled-32bpp-rotate-90: SKIP (0.021s) [252.759994] [059/130] (781s left) kms_flip (plain-flip-ts-check-interruptible) [252.857929] Starting subtest: plain-flip-ts-check-interruptible [252.860300] Starting dynamic subtest: A-eDP1 [261.698616] Dynamic subtest A-eDP1: SUCCESS (8.841s) [261.708062] Starting dynamic subtest: B-eDP1 [270.516626] Dynamic subtest B-eDP1: SUCCESS (8.818s) [270.531227] Starting dynamic subtest: C-eDP1 [279.327172] Dynamic subtest C-eDP1: SUCCESS (8.809s) [279.340589] Starting dynamic subtest: D-eDP1 [288.156673] Dynamic subtest D-eDP1: SUCCESS (8.828s) [288.159196] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.305s) [289.295138] [060/130] (744s left) kms_pm_rpm (pc8-residency) [291.328994] Starting subtest: pc8-residency [291.334626] Subtest pc8-residency: SKIP (0.000s) [291.661345] [061/130] (742s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted) [291.715227] Starting subtest: multi-wait-available-unsubmitted-submitted [291.717259] Subtest multi-wait-available-unsubmitted-submitted: SUCCESS (0.000s) [291.812420] [062/130] (742s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc) [291.918150] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc [291.922158] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [292.006422] [063/130] (741s left) kms_content_protection (atomic) [292.152177] Starting subtest: atomic [295.504020] Subtest atomic: SKIP (3.349s) [296.652223] [064/130] (737s left) gem_exec_schedule (lateslice) [296.719251] Starting subtest: lateslice [296.721481] Starting dynamic subtest: rcs0 [296.733197] Dynamic subtest rcs0: SUCCESS (0.020s) [296.741533] Starting dynamic subtest: bcs0 [296.747444] Dynamic subtest bcs0: SUCCESS (0.017s) [296.755981] Starting dynamic subtest: vcs0 [296.764744] Dynamic subtest vcs0: SUCCESS (0.017s) [296.773056] Starting dynamic subtest: vcs1 [296.783322] Dynamic subtest vcs1: SUCCESS (0.018s) [296.791832] Starting dynamic subtest: vecs0 [296.799847] Dynamic subtest vecs0: SUCCESS (0.016s) [296.808124] Starting dynamic subtest: ccs0 [296.815796] Dynamic subtest ccs0: SUCCESS (0.015s) [296.818215] Subtest lateslice: SUCCESS (0.106s) [298.177035] [065/130] (735s left) gem_exec_whisper (basic-contexts-priority) [298.247287] Starting subtest: basic-contexts-priority [322.324372] Subtest basic-contexts-priority: SUCCESS (24.072s) [322.489585] [066/130] (711s left) sysfs_heartbeat_interval (mixed) [322.547872] Starting subtest: mixed [322.550212] Starting dynamic subtest: vecs0 [327.780380] Dynamic subtest vecs0: SUCCESS (5.231s) [327.792146] Starting dynamic subtest: ccs0 [332.972687] Dynamic subtest ccs0: SUCCESS (5.191s) [332.984228] Starting dynamic subtest: vcs0 [338.169856] Dynamic subtest vcs0: SUCCESS (5.196s) [338.181117] Starting dynamic subtest: bcs0 [343.372576] Dynamic subtest bcs0: SUCCESS (5.200s) [343.385075] Starting dynamic subtest: rcs0 [348.563470] Dynamic subtest rcs0: SUCCESS (5.190s) [348.575117] Starting dynamic subtest: vcs1 [353.821787] Dynamic subtest vcs1: SUCCESS (5.256s) [353.824866] Subtest mixed: SUCCESS (31.272s) [353.881384] [067/130] (680s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip) [353.995223] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip [353.999345] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s) [354.075916] [068/130] (679s left) api_intel_bb (crc32) [354.135150] Starting subtest: crc32 [354.137199] Starting dynamic subtest: rcs0-smem0 [354.421645] Dynamic subtest rcs0-smem0: SUCCESS (0.287s) [354.434006] Starting dynamic subtest: bcs0-smem0 [354.736900] Dynamic subtest bcs0-smem0: SUCCESS (0.312s) [354.749374] Starting dynamic subtest: vcs0-smem0 [355.055327] Dynamic subtest vcs0-smem0: SUCCESS (0.317s) [355.067318] Starting dynamic subtest: vcs1-smem0 [355.387231] Dynamic subtest vcs1-smem0: SUCCESS (0.328s) [355.400438] Starting dynamic subtest: vecs0-smem0 [355.681872] Dynamic subtest vecs0-smem0: SUCCESS (0.293s) [355.691526] Starting dynamic subtest: ccs0-smem0 [356.032010] Dynamic subtest ccs0-smem0: SUCCESS (0.347s) [356.035205] Subtest crc32: SUCCESS (1.898s) [356.163666] [069/130] (677s left) gem_partial_pwrite_pread (reads-display) [356.223654] Subtest reads-display: SKIP (0.000s) [356.293770] [070/130] (677s left) gen9_exec_parse (batch-zero-length) [356.357096] Subtest batch-zero-length: SKIP (0.000s) [356.431097] [071/130] (677s left) kms_vblank (wait-busy) [356.542661] Starting subtest: wait-busy [356.544817] Starting dynamic subtest: pipe-A-eDP-1 [358.420226] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.874s) [358.434281] Starting dynamic subtest: pipe-D-eDP-1 [361.024245] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.601s) [361.026696] Subtest wait-busy: SUCCESS (4.479s) [361.802982] [072/130] (672s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs) [361.899595] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs [361.901791] Starting dynamic subtest: pipe-A-eDP-1 [361.923787] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [361.933447] Starting dynamic subtest: pipe-B-eDP-1 [361.954710] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [361.963354] Starting dynamic subtest: pipe-C-eDP-1 [361.984857] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [361.993710] Starting dynamic subtest: pipe-D-eDP-1 [362.015915] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [362.019977] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.005s) [364.066287] [073/130] (669s left) gem_readwrite (write-bad-handle) [364.133439] Subtest write-bad-handle: SKIP (0.000s) [364.179178] [074/130] (669s left) kms_sequence (get-forked-busy) [364.278690] Starting subtest: get-forked-busy [364.281021] Starting dynamic subtest: pipe-A-eDP-1 [366.188339] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.907s) [366.198331] Starting dynamic subtest: pipe-B-eDP-1 [368.766937] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.578s) [368.776615] Starting dynamic subtest: pipe-C-eDP-1 [371.385053] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.616s) [371.394568] Starting dynamic subtest: pipe-D-eDP-1 [373.900023] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.514s) [373.902396] Subtest get-forked-busy: SUCCESS (9.620s) [374.664366] [075/130] (659s left) gem_lmem_evict (dontneed-evict-race) [374.705506] Subtest dontneed-evict-race: SKIP (0.000s) [374.727303] [076/130] (659s left) gem_set_tiling_vs_pwrite [374.833467] [077/130] (659s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area) [379.818258] Starting subtest: psr2-primary-plane-update-sf-dmg-area [379.820688] Starting dynamic subtest: pipe-A-eDP-1 [386.337292] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.518s) [386.347311] Starting dynamic subtest: pipe-B-eDP-1 [392.860537] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.521s) [392.862961] Subtest psr2-primary-plane-update-sf-dmg-area: SUCCESS (13.043s) [393.623493] [078/130] (640s left) gem_eio (in-flight-10ms) [393.836751] Starting subtest: in-flight-10ms [402.046476] Subtest in-flight-10ms: SUCCESS (8.208s) [402.212429] [079/130] (631s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-blt) [402.316953] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-blt [402.321049] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s) [402.400783] [080/130] (631s left) perf_pmu (busy-no-semaphores) [402.444977] Starting subtest: busy-no-semaphores [402.447412] Starting dynamic subtest: rcs0 [403.025862] Dynamic subtest rcs0: SUCCESS (0.581s) [403.037446] Starting dynamic subtest: bcs0 [403.576085] Dynamic subtest bcs0: SUCCESS (0.547s) [403.588400] Starting dynamic subtest: vcs0 [404.127061] Dynamic subtest vcs0: SUCCESS (0.549s) [404.139490] Starting dynamic subtest: vcs1 [405.629023] Dynamic subtest vcs1: SUCCESS (1.500s) [405.641124] Starting dynamic subtest: vecs0 [407.614839] Dynamic subtest vecs0: SUCCESS (1.983s) [407.627290] Starting dynamic subtest: ccs0 [409.662901] Dynamic subtest ccs0: SUCCESS (2.046s) [409.665808] Subtest busy-no-semaphores: SUCCESS (7.219s) [409.786737] [081/130] (624s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs) [409.856743] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs [409.861421] Subtest y-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s) [410.024132] [082/130] (624s left) kms_plane_scaling (2x-scaler-multi-pipe) [410.126621] Starting subtest: 2x-scaler-multi-pipe [410.131143] Subtest 2x-scaler-multi-pipe: SKIP (0.001s) [410.204032] [083/130] (624s left) kms_cursor_edge_walk (256x256-top-bottom) [410.296665] Starting subtest: 256x256-top-bottom [410.298949] Starting dynamic subtest: pipe-A-eDP-1 [413.692617] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.392s) [413.702664] Starting dynamic subtest: pipe-D-eDP-1 [416.786324] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.094s) [416.788630] Subtest 256x256-top-bottom: SUCCESS (6.488s) [417.596578] [084/130] (616s left) kms_ccs (bad-aux-stride-y-tiled-ccs) [417.700653] Starting subtest: bad-aux-stride-y-tiled-ccs [417.702963] Starting dynamic subtest: pipe-A-eDP-1 [417.725679] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [417.736367] Starting dynamic subtest: pipe-B-eDP-1 [417.757899] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [417.766827] Starting dynamic subtest: pipe-C-eDP-1 [417.789245] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [417.797854] Starting dynamic subtest: pipe-D-eDP-1 [417.819769] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [417.824174] Subtest bad-aux-stride-y-tiled-ccs: SKIP (0.004s) [419.840114] [085/130] (614s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt) [419.948146] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt [419.952170] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [420.049417] [086/130] (614s left) kms_addfb_basic (basic) [420.108430] Starting subtest: basic [420.110832] Subtest basic: SUCCESS (0.000s) [420.238456] [087/130] (614s left) gen3_mixed_blits [420.339539] [088/130] (614s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-pwrite) [420.442120] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-pwrite [420.446424] Subtest psr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [420.514743] [089/130] (613s left) kms_async_flips (invalid-async-flip-atomic) [420.616858] Starting subtest: invalid-async-flip-atomic [420.621159] Subtest invalid-async-flip-atomic: SKIP (0.000s) [421.761217] [090/130] (612s left) kms_chamelium_hpd (dp-hpd) [422.153897] Subtest dp-hpd: SKIP (0.000s) [422.963415] [091/130] (611s left) kms_flip (dpms-vs-vblank-race-interruptible) [423.071934] Starting subtest: dpms-vs-vblank-race-interruptible [423.074205] Starting dynamic subtest: A-eDP1 [427.962452] Dynamic subtest A-eDP1: SUCCESS (4.887s) [427.974627] Starting dynamic subtest: B-eDP1 [432.575342] Dynamic subtest B-eDP1: SUCCESS (4.612s) [432.592765] Starting dynamic subtest: C-eDP1 [436.979611] Dynamic subtest C-eDP1: SUCCESS (4.402s) [436.989582] Starting dynamic subtest: D-eDP1 [441.469544] Dynamic subtest D-eDP1: SUCCESS (4.485s) [441.471701] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (18.396s) [442.322606] [092/130] (592s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats) [442.424371] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats [442.426700] Starting dynamic subtest: pipe-A [442.557019] Dynamic subtest pipe-A: SKIP (0.127s) [442.568930] Starting dynamic subtest: pipe-B [443.714381] Dynamic subtest pipe-B: SKIP (1.155s) [443.724603] Starting dynamic subtest: pipe-C [444.835503] Dynamic subtest pipe-C: SUCCESS (1.127s) [444.845232] Starting dynamic subtest: pipe-D [445.970682] Dynamic subtest pipe-D: SUCCESS (1.134s) [445.973005] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (3.546s) [447.130737] [093/130] (587s left) kms_flip (2x-wf_vblank-ts-check) [447.239532] Starting subtest: 2x-wf_vblank-ts-check [447.251097] Subtest 2x-wf_vblank-ts-check: SKIP (0.011s) [447.310862] [094/130] (587s left) gem_close (many-handles-one-vma) [447.375166] Starting subtest: many-handles-one-vma [447.398973] Subtest many-handles-one-vma: SUCCESS (0.024s) [447.520081] [095/130] (586s left) gem_ctx_param (set-priority-range) [447.573641] Starting subtest: set-priority-range [447.590030] Subtest set-priority-range: SUCCESS (0.017s) [447.672444] [096/130] (586s left) syncobj_eventfd (timeline-wait-before-signal) [447.734305] Starting subtest: timeline-wait-before-signal [447.762292] Subtest timeline-wait-before-signal: SUCCESS (0.031s) [447.819902] [097/130] (586s left) kms_addfb_basic (addfb25-4-tiled) [447.921620] Starting subtest: addfb25-4-tiled [447.923854] Subtest addfb25-4-tiled: SUCCESS (0.000s) [448.023489] [098/130] (586s left) kms_psr (psr-cursor-blt) [448.126459] Starting subtest: psr-cursor-blt [448.128466] Starting dynamic subtest: eDP-1 [449.826804] Dynamic subtest eDP-1: SUCCESS (1.699s) [449.829392] Subtest psr-cursor-blt: SUCCESS (1.700s) [450.678475] [099/130] (583s left) perf_pmu (semaphore-wait) [450.719624] Starting subtest: semaphore-wait [450.721968] Starting dynamic subtest: rcs0 [451.232067] Dynamic subtest rcs0: SUCCESS (0.512s) [451.244478] Starting dynamic subtest: bcs0 [451.744939] Dynamic subtest bcs0: SUCCESS (0.510s) [451.757418] Starting dynamic subtest: vcs0 [452.256924] Dynamic subtest vcs0: SUCCESS (0.510s) [452.268968] Starting dynamic subtest: vcs1 [452.770010] Dynamic subtest vcs1: SUCCESS (0.510s) [452.780623] Starting dynamic subtest: vecs0 [453.284501] Dynamic subtest vecs0: SUCCESS (0.512s) [453.299530] Starting dynamic subtest: ccs0 [453.801132] Dynamic subtest ccs0: SUCCESS (0.514s) [453.804295] Subtest semaphore-wait: SUCCESS (3.082s) [455.086732] [100/130] (579s left) i915_hangman (detector) [455.157612] Starting subtest: detector [455.159929] Starting dynamic subtest: rcs0 [466.072758] Dynamic subtest rcs0: SUCCESS (10.912s) [466.084875] Starting dynamic subtest: bcs0 [478.103004] Dynamic subtest bcs0: SUCCESS (12.028s) [478.115204] Starting dynamic subtest: vcs0 [490.007963] Dynamic subtest vcs0: SUCCESS (11.902s) [490.020770] Starting dynamic subtest: vcs1 [500.055606] Dynamic subtest vcs1: SUCCESS (10.045s) [500.067009] Starting dynamic subtest: vecs0 [512.023182] Dynamic subtest vecs0: SUCCESS (11.965s) [512.034637] Starting dynamic subtest: ccs0 [523.095820] Dynamic subtest ccs0: SUCCESS (11.068s) [523.099008] Subtest detector: SUCCESS (67.933s) [523.159277] [101/130] (511s left) syncobj_timeline (invalid-signal-one-illegal-handle) [523.219795] Starting subtest: invalid-signal-one-illegal-handle [523.221925] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s) [523.314467] [102/130] (511s left) kms_cursor_legacy (cursorb-vs-flipa-varying-size) [523.435637] Starting subtest: cursorB-vs-flipA-varying-size [523.440067] Subtest cursorB-vs-flipA-varying-size: SKIP (0.001s) [523.562106] [103/130] (511s left) i915_pm_rpm (gem-evict-pwrite) [525.294035] Starting subtest: gem-evict-pwrite [525.299526] Subtest gem-evict-pwrite: SKIP (0.000s) [525.805599] [104/130] (508s left) kms_psr (psr-sprite-mmap-cpu) [525.908666] Starting subtest: psr-sprite-mmap-cpu [525.910959] Starting dynamic subtest: eDP-1 [527.616949] Dynamic subtest eDP-1: SUCCESS (1.707s) [527.619322] Subtest psr-sprite-mmap-cpu: SUCCESS (1.708s) [528.445263] [105/130] (506s left) kms_writeback (writeback-fb-id-xrgb2101010) [528.539845] Subtest writeback-fb-id-XRGB2101010: SKIP (0.000s) [528.565075] [106/130] (506s left) kms_psr (pr-primary-mmap-gtt) [528.664641] Starting subtest: pr-primary-mmap-gtt [528.668870] Subtest pr-primary-mmap-gtt: SKIP (0.000s) [528.719331] [107/130] (506s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-gtt) [528.823937] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-gtt [528.827912] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [528.924589] [108/130] (505s left) gem_ctx_shared (q-smoketest-all) [528.981311] Starting subtest: Q-smoketest-all [561.394676] Subtest Q-smoketest-all: SUCCESS (32.361s) [563.156790] [109/130] (471s left) kms_rotation_crc (primary-yf-tiled-reflect-x-90) [563.261419] Starting subtest: primary-yf-tiled-reflect-x-90 [563.266133] Subtest primary-yf-tiled-reflect-x-90: SKIP (0.001s) [563.317230] [110/130] (471s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-upscaling) [563.416801] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-upscaling [563.419136] Starting dynamic subtest: pipe-A-default-mode [566.101613] Dynamic subtest pipe-A-default-mode: SUCCESS (2.683s) [566.104105] Subtest flip-64bpp-xtile-to-32bpp-xtile-upscaling: SUCCESS (2.684s) [566.919631] [111/130] (467s left) kms_frontbuffer_tracking (fbc-stridechange) [567.035313] Starting subtest: fbc-stridechange [569.338083] Subtest fbc-stridechange: SUCCESS (2.307s) [569.490663] [112/130] (465s left) gem_render_copy_redux (flink) [569.547464] Starting subtest: flink [570.492649] Subtest flink: SUCCESS (0.945s) [570.592376] [113/130] (464s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted) [570.645955] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted [570.748244] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.102s) [570.805367] [114/130] (464s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-blt) [570.909894] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-blt [570.914100] Subtest fbc-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [570.999882] [115/130] (463s left) kms_cursor_crc (cursor-sliding-32x32) [571.130192] Starting subtest: cursor-sliding-32x32 [571.167759] Subtest cursor-sliding-32x32: SKIP (0.033s) [571.435972] [116/130] (463s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-25) [571.543794] Starting subtest: planes-unity-scaling-downscale-factor-0-25 [571.546037] Starting dynamic subtest: pipe-A [571.561473] Dynamic subtest pipe-A: SKIP (0.011s) [571.571866] Starting dynamic subtest: pipe-B [571.583995] Dynamic subtest pipe-B: SKIP (0.022s) [571.593163] Starting dynamic subtest: pipe-C [571.605400] Dynamic subtest pipe-C: SKIP (0.021s) [571.616793] Starting dynamic subtest: pipe-D [571.625526] Dynamic subtest pipe-D: SKIP (0.021s) [571.629338] Subtest planes-unity-scaling-downscale-factor-0-25: SKIP (0.077s) [571.721792] [117/130] (463s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-wc) [571.816596] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-wc [574.938389] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (3.124s) [575.044540] [118/130] (459s left) kms_rotation_crc (bad-tiling) [575.143282] Starting subtest: bad-tiling [575.147202] Subtest bad-tiling: SKIP (0.001s) [575.196870] [119/130] (459s left) kms_pm_dc (dc6-psr) [576.305954] Starting subtest: dc6-psr [583.510625] Subtest dc6-psr: FAIL (6.605s) [583.531271] [120/130] (451s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu) [583.635906] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu [583.640196] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [583.725726] [121/130] (451s left) gem_exec_flush (basic-uc-set-default) [583.783538] Starting subtest: basic-uc-set-default [589.266243] Subtest basic-uc-set-default: SUCCESS (5.482s) [589.435430] [122/130] (445s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling) [589.538821] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling [589.541014] Starting dynamic subtest: pipe-A-default-mode [589.828236] Dynamic subtest pipe-A-default-mode: SKIP (0.283s) [589.833073] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.285s) [590.594228] [123/130] (444s left) gen7_exec_parse (batch-without-end) [590.662004] Subtest batch-without-end: SKIP (0.000s) [590.709959] [124/130] (444s left) kms_frontbuffer_tracking (fbcpsr-1p-pri-indfb-multidraw) [590.826179] Starting subtest: fbcpsr-1p-pri-indfb-multidraw [610.464332] Subtest fbcpsr-1p-pri-indfb-multidraw: SUCCESS (19.639s) [610.578202] [125/130] (424s left) gem_ctx_isolation (clean) [610.652535] Starting subtest: clean [610.654595] Starting dynamic subtest: rcs0 [610.698124] Dynamic subtest rcs0: SUCCESS (0.045s) [610.709029] Starting dynamic subtest: bcs0 [610.785013] Dynamic subtest bcs0: SUCCESS (0.084s) [610.794100] Starting dynamic subtest: vcs0 [610.866566] Dynamic subtest vcs0: SUCCESS (0.083s) [610.875688] Starting dynamic subtest: vcs1 [612.117464] Dynamic subtest vcs1: SUCCESS (1.249s) [612.129763] Starting dynamic subtest: vecs0 [614.195317] Dynamic subtest vecs0: SUCCESS (2.077s) [614.207015] Starting dynamic subtest: ccs0 [616.181460] Dynamic subtest ccs0: SUCCESS (1.985s) [616.184317] Subtest clean: SUCCESS (5.528s) [616.425702] [126/130] (418s left) kms_addfb_basic (too-high) [616.535618] Starting subtest: too-high [616.537867] Subtest too-high: SUCCESS (0.000s) [616.610663] [127/130] (418s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted) [616.675702] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted [616.781361] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.106s) [616.837746] [128/130] (418s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip) [616.944963] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip [616.949210] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s) [617.014355] [129/130] (418s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf) [622.006805] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf [622.009217] Starting dynamic subtest: pipe-A-eDP-1 [622.808160] Dynamic subtest pipe-A-eDP-1: SKIP (0.797s) [622.818176] Starting dynamic subtest: pipe-B-eDP-1 [623.940069] Dynamic subtest pipe-B-eDP-1: SKIP (1.129s) [623.944776] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.930s) [625.103807] [130/130] (410s left) api_intel_bb (render) [625.165151] Starting subtest: render [625.166985] Starting dynamic subtest: render-none-512 [625.264506] Dynamic subtest render-none-512: SUCCESS (0.101s) [625.277027] Starting dynamic subtest: render-none-1024 [625.642193] Dynamic subtest render-none-1024: SUCCESS (0.376s) [625.653002] Starting dynamic subtest: render-x-512 [625.728979] Dynamic subtest render-x-512: SUCCESS (0.087s) [625.740773] Starting dynamic subtest: render-x-1024 [626.328511] Dynamic subtest render-x-1024: SUCCESS (0.597s) [626.340129] Starting dynamic subtest: render-y-512 [626.414026] Dynamic subtest render-y-512: SUCCESS (0.086s) [626.425898] Starting dynamic subtest: render-y-1024 [626.769211] Dynamic subtest render-y-1024: SUCCESS (0.337s) [626.773326] Subtest render: SUCCESS (1.589s) [626.850190] Closing watchdogs Done.