[56.367750] Initializing watchdogs [56.367801] /dev/watchdog0 [56.381551] [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] [56.385530] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [56.387554] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [56.390806] [001/134] (960s left) kms_getfb (getfb-handle-closed) [56.506878] Starting subtest: getfb-handle-closed [56.509206] Subtest getfb-handle-closed: SUCCESS (0.001s) [56.626510] [002/134] (960s left) gem_close_race (multigpu-basic-threads) [56.680282] Starting subtest: multigpu-basic-threads [56.684828] Subtest multigpu-basic-threads: SKIP (0.000s) [56.934103] [003/134] (960s left) gem_pxp (hw-rejects-pxp-buffer) [57.070562] Starting subtest: hw-rejects-pxp-buffer [57.074586] Subtest hw-rejects-pxp-buffer: SKIP (0.000s) [57.197307] [004/134] (959s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-sf) [62.242143] Starting subtest: fbc-psr2-cursor-plane-move-continuous-sf [62.244632] Starting dynamic subtest: pipe-A-eDP-1 [63.045418] Dynamic subtest pipe-A-eDP-1: SKIP (0.803s) [63.055716] Starting dynamic subtest: pipe-B-eDP-1 [64.183728] Dynamic subtest pipe-B-eDP-1: SKIP (1.138s) [64.188418] Subtest fbc-psr2-cursor-plane-move-continuous-sf: SKIP (1.945s) [65.386294] [005/134] (951s left) gem_exec_flush (basic-batch-kernel-default-wb) [65.459817] Starting subtest: basic-batch-kernel-default-wb [72.664988] Subtest basic-batch-kernel-default-wb: SUCCESS (7.215s) [72.874932] [006/134] (944s left) kms_frontbuffer_tracking (pipe-fbc-rte) [72.973629] Starting subtest: pipe-fbc-rte [72.980705] Starting dynamic subtest: pipe-B-eDP-1 [78.466249] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.498s) [78.473555] Subtest pipe-fbc-rte: SUCCESS (5.500s) [80.809449] [007/134] (936s left) sw_sync (alloc_timeline) [80.842071] Starting subtest: alloc_timeline [80.844308] Subtest alloc_timeline: SUCCESS (0.000s) [80.921086] [008/134] (936s left) gem_exec_params (batch-first) [80.984748] Starting subtest: batch-first [80.989326] Subtest batch-first: SUCCESS (0.005s) [81.122311] [009/134] (936s left) gem_mmap_gtt (basic-small-copy) [81.185692] Subtest basic-small-copy: SKIP (0.000s) [81.249113] [010/134] (935s left) kms_universal_plane (universal-plane-pageflip-windowed) [81.344091] Starting subtest: universal-plane-pageflip-windowed [81.346495] Starting dynamic subtest: pipe-A-eDP-1 [81.931910] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.586s) [81.942609] Starting dynamic subtest: pipe-B-eDP-1 [83.140465] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.206s) [83.149356] Starting dynamic subtest: pipe-C-eDP-1 [84.353113] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.213s) [84.361633] Starting dynamic subtest: pipe-D-eDP-1 [85.580058] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.225s) [85.582481] Subtest universal-plane-pageflip-windowed: SUCCESS (4.234s) [86.433048] [011/134] (930s left) syncobj_eventfd (invalid-illegal-handle) [86.496556] Starting subtest: invalid-illegal-handle [86.498932] Subtest invalid-illegal-handle: SUCCESS (0.000s) [86.635636] [012/134] (930s left) gen9_exec_parse (cmd-crossing-page) [86.705135] Subtest cmd-crossing-page: SKIP (0.000s) [86.780936] [013/134] (930s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite) [86.883526] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite [95.388036] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.508s) [95.530360] [014/134] (921s left) kms_cursor_crc (cursor-sliding-64x21) [95.712663] Starting subtest: cursor-sliding-64x21 [95.768806] Subtest cursor-sliding-64x21: SKIP (0.050s) [96.043718] [015/134] (921s left) kms_psr (pr-cursor-render) [96.140633] Starting subtest: pr-cursor-render [96.144841] Subtest pr-cursor-render: SKIP (0.000s) [96.239889] [016/134] (921s left) kms_flip (nonexisting-fb) [96.340933] Starting subtest: nonexisting-fb [96.345182] Starting dynamic subtest: A-eDP1 [97.571408] Dynamic subtest A-eDP1: SUCCESS (1.227s) [97.581118] Starting dynamic subtest: B-eDP1 [98.699712] Dynamic subtest B-eDP1: SUCCESS (1.128s) [98.709430] Starting dynamic subtest: C-eDP1 [99.835729] Dynamic subtest C-eDP1: SUCCESS (1.135s) [99.847218] Starting dynamic subtest: D-eDP1 [100.966637] Dynamic subtest D-eDP1: SUCCESS (1.129s) [100.968935] Subtest nonexisting-fb: SUCCESS (4.629s) [102.149100] [017/134] (915s left) kms_flip (basic-flip-vs-wf_vblank) [102.241240] Starting subtest: basic-flip-vs-wf_vblank [102.243676] Starting dynamic subtest: A-eDP1 [104.186229] Dynamic subtest A-eDP1: SUCCESS (1.944s) [104.197525] Starting dynamic subtest: B-eDP1 [106.117722] Dynamic subtest B-eDP1: SUCCESS (1.931s) [106.125011] Starting dynamic subtest: C-eDP1 [108.036096] Dynamic subtest C-eDP1: SUCCESS (1.917s) [108.045080] Starting dynamic subtest: D-eDP1 [109.965167] Dynamic subtest D-eDP1: SUCCESS (1.927s) [109.967478] Subtest basic-flip-vs-wf_vblank: SUCCESS (7.727s) [111.199925] [018/134] (906s left) kms_force_connector_basic (prune-stale-modes) [111.290633] Starting subtest: prune-stale-modes [111.733472] Subtest prune-stale-modes: SUCCESS (0.442s) [111.880413] [019/134] (905s left) kms_dirtyfb (default-dirtyfb-ioctl) [111.974855] Starting subtest: default-dirtyfb-ioctl [111.977035] Starting dynamic subtest: A-eDP-1 [113.585488] Dynamic subtest A-eDP-1: SUCCESS (1.611s) [113.587875] Subtest default-dirtyfb-ioctl: SUCCESS (1.611s) [114.435903] [020/134] (903s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-blt) [114.539446] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-blt [114.543820] Subtest fbc-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s) [114.656807] [021/134] (902s left) gem_ctx_exec (basic-nohangcheck) [114.730040] Starting subtest: basic-nohangcheck [114.988396] Subtest basic-nohangcheck: SUCCESS (0.261s) [115.128497] [022/134] (902s left) syncobj_timeline (wait-zero-handles) [115.188826] Starting subtest: wait-zero-handles [115.190740] Subtest wait-zero-handles: SUCCESS (0.000s) [115.315471] [023/134] (902s left) gem_tiled_pread_basic [115.448499] [024/134] (902s left) kms_atomic_transition (modeset-transition-fencing) [115.542833] Starting subtest: modeset-transition-fencing [115.545101] Starting dynamic subtest: 1x-outputs [126.379365] Dynamic subtest 1x-outputs: SUCCESS (10.835s) [126.381998] Subtest modeset-transition-fencing: SUCCESS (10.836s) [127.215013] [025/134] (890s left) kms_big_fb (y-tiled-16bpp-rotate-180) [127.315775] Starting subtest: y-tiled-16bpp-rotate-180 [127.319835] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s) [127.423238] [026/134] (890s left) vgem_basic (sysfs) [127.500643] Starting subtest: sysfs [127.502655] Subtest sysfs: SUCCESS (0.001s) [127.575203] [FACT vgem_basic (sysfs)] new: kernel.kmod_is_loaded.vgem: true [127.578284] [027/134] (890s left) gem_close_race (basic-process) [127.640376] Starting subtest: basic-process [127.709069] Subtest basic-process: SUCCESS (0.068s) [127.901548] [028/134] (889s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-pwrite) [127.999349] Starting subtest: fbc-rgb101010-draw-pwrite [133.306448] Subtest fbc-rgb101010-draw-pwrite: SUCCESS (5.310s) [134.435053] [029/134] (883s left) gem_userptr_blits (unsync-unmap-cycles) [134.517081] Subtest unsync-unmap-cycles: SKIP (0.000s) [134.653871] [030/134] (883s left) gem_exec_schedule (manyslice) [134.720371] Starting subtest: manyslice [134.722345] Starting dynamic subtest: rcs0 [139.832391] Dynamic subtest rcs0: SUCCESS (5.121s) [139.841174] Starting dynamic subtest: bcs0 [146.454546] Dynamic subtest bcs0: SUCCESS (6.620s) [146.465521] Starting dynamic subtest: vcs0 [151.532857] Dynamic subtest vcs0: SUCCESS (5.077s) [151.541914] Starting dynamic subtest: vcs1 [157.110871] Dynamic subtest vcs1: SUCCESS (5.577s) [157.122510] Starting dynamic subtest: vecs0 [163.178527] Dynamic subtest vecs0: SUCCESS (6.066s) [163.189441] Starting dynamic subtest: ccs0 [168.308940] Dynamic subtest ccs0: SUCCESS (5.129s) [168.311790] Subtest manyslice: SUCCESS (33.596s) [168.626947] [031/134] (849s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc) [168.721064] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc [168.723436] Starting dynamic subtest: pipe-A-eDP-1 [168.746460] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [168.755867] Starting dynamic subtest: pipe-B-eDP-1 [168.778311] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [168.784751] Starting dynamic subtest: pipe-C-eDP-1 [168.805524] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [168.812016] Starting dynamic subtest: pipe-D-eDP-1 [168.833733] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [168.838104] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s) [170.915847] [032/134] (847s left) kms_cursor_legacy (cursorb-vs-flipb-legacy) [171.038954] Starting subtest: cursorB-vs-flipB-legacy [171.043286] Subtest cursorB-vs-flipB-legacy: SKIP (0.001s) [171.205305] [033/134] (846s left) gem_exec_params (invalid-bsd2-flag-on-render) [171.272283] Starting subtest: invalid-bsd2-flag-on-render [171.274612] Subtest invalid-bsd2-flag-on-render: SUCCESS (0.000s) [171.397302] [034/134] (846s left) kms_chamelium_edid (dp-edid-resolution-list) [171.789045] Subtest dp-edid-resolution-list: SKIP (0.000s) [172.592791] [035/134] (845s left) gem_spin_batch (spin-all-new) [172.660382] Starting subtest: spin-all-new [172.674288] Subtest spin-all-new: SUCCESS (0.013s) [173.957256] [036/134] (844s left) kms_psr_stress_test (flip-primary-invalidate-overlay) [174.061071] Starting subtest: flip-primary-invalidate-overlay [185.623470] Subtest flip-primary-invalidate-overlay: SUCCESS (11.564s) [185.802071] [037/134] (832s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier-source-clamping) [185.895446] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier-source-clamping [185.922649] Starting dynamic subtest: pipe-A-plane-0 [185.926629] Dynamic subtest pipe-A-plane-0: SKIP (0.000s) [185.939631] Starting dynamic subtest: pipe-A-plane-3 [185.943831] Dynamic subtest pipe-A-plane-3: SKIP (0.000s) [185.952171] Starting dynamic subtest: pipe-A-plane-5 [185.955433] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [187.062281] Starting dynamic subtest: pipe-B-plane-0 [187.066487] Dynamic subtest pipe-B-plane-0: SKIP (0.000s) [187.073398] Starting dynamic subtest: pipe-B-plane-3 [187.077729] Dynamic subtest pipe-B-plane-3: SKIP (0.000s) [187.084827] Starting dynamic subtest: pipe-B-plane-5 [187.089216] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [187.365861] Subtest pixel-format-4-tiled-bmg-ccs-modifier-source-clamping: SKIP (1.468s) [188.211167] [038/134] (830s left) kms_dsc (dsc-fractional-bpp-with-bpc) [188.322035] Starting subtest: dsc-fractional-bpp-with-bpc [188.352019] Subtest dsc-fractional-bpp-with-bpc: SKIP (0.001s) [188.402291] [039/134] (829s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render) [188.507691] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render [188.512176] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s) [188.618055] [040/134] (829s left) i915_hangman (gt-engine-error) [188.690699] Starting subtest: gt-engine-error [188.692867] Starting dynamic subtest: rcs0 [189.875805] Dynamic subtest rcs0: SUCCESS (1.185s) [189.887158] Starting dynamic subtest: bcs0 [191.859355] Dynamic subtest bcs0: SUCCESS (1.981s) [191.869914] Starting dynamic subtest: vcs0 [193.841859] Dynamic subtest vcs0: SUCCESS (1.980s) [193.854487] Starting dynamic subtest: vcs1 [195.891721] Dynamic subtest vcs1: SUCCESS (2.048s) [195.902391] Starting dynamic subtest: vecs0 [197.874709] Dynamic subtest vecs0: SUCCESS (1.981s) [197.885591] Starting dynamic subtest: ccs0 [199.859624] Dynamic subtest ccs0: SUCCESS (1.983s) [199.862343] Subtest gt-engine-error: SUCCESS (11.170s) [199.952451] [041/134] (818s left) gem_exec_fence (submit3) [200.133176] Starting subtest: submit3 [200.137639] Subtest submit3: SKIP (0.000s) [202.006355] [042/134] (816s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt) [202.107378] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt [202.111482] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [202.244393] [043/134] (816s left) kms_plane_cursor (overlay) [202.332838] Starting subtest: overlay [202.337306] Starting dynamic subtest: pipe-A-eDP-1-size-64 [204.959845] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.628s) [205.017745] Starting dynamic subtest: pipe-A-eDP-1-size-128 [207.516967] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.505s) [207.574382] Starting dynamic subtest: pipe-A-eDP-1-size-256 [210.083555] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.516s) [210.431790] Starting dynamic subtest: pipe-B-eDP-1-size-64 [213.741057] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.318s) [213.799498] Starting dynamic subtest: pipe-B-eDP-1-size-128 [216.343343] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.549s) [216.407281] Starting dynamic subtest: pipe-B-eDP-1-size-256 [218.909835] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.515s) [219.258562] Starting dynamic subtest: pipe-C-eDP-1-size-64 [222.161540] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.913s) [222.197500] Starting dynamic subtest: pipe-C-eDP-1-size-128 [224.339357] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.147s) [224.380263] Starting dynamic subtest: pipe-C-eDP-1-size-256 [226.505339] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.135s) [226.829605] Starting dynamic subtest: pipe-D-eDP-1-size-64 [229.768260] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.946s) [229.804467] Starting dynamic subtest: pipe-D-eDP-1-size-128 [231.979171] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.180s) [232.016606] Starting dynamic subtest: pipe-D-eDP-1-size-256 [234.179293] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.169s) [234.499740] Subtest overlay: SUCCESS (32.164s) [235.316039] [044/134] (783s left) kms_cursor_crc (cursor-rapid-movement-256x85) [235.554697] Starting subtest: cursor-rapid-movement-256x85 [235.601187] Subtest cursor-rapid-movement-256x85: SKIP (0.041s) [235.788177] [045/134] (782s left) syncobj_timeline (invalid-transfer-bad-pad) [235.852745] Starting subtest: invalid-transfer-bad-pad [235.855147] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s) [235.964226] [046/134] (782s left) syncobj_timeline (wait-all-for-submit-complex) [236.013240] Starting subtest: wait-all-for-submit-complex [236.226368] Subtest wait-all-for-submit-complex: SUCCESS (0.213s) [236.312519] [047/134] (782s left) gem_partial_pwrite_pread (writes-after-reads) [236.375222] Subtest writes-after-reads: SKIP (0.000s) [236.455419] [048/134] (782s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt) [236.565430] Starting subtest: fbcpsr-rgb565-draw-blt [243.509117] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (6.946s) [243.657120] [049/134] (775s left) gem_blits (basic) [243.727514] Starting subtest: basic [245.045256] Subtest basic: SUCCESS (1.317s) [245.179339] [050/134] (773s left) kms_psr (fbc-psr-primary-mmap-gtt) [245.270054] Starting subtest: fbc-psr-primary-mmap-gtt [245.272342] Starting dynamic subtest: eDP-1 [245.276510] Dynamic subtest eDP-1: SKIP (0.000s) [245.280672] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s) [245.369238] [051/134] (773s left) gem_madvise (dontneed-after-mmap) [245.413459] Starting subtest: dontneed-after-mmap [245.440423] Subtest dontneed-after-mmap: SUCCESS (0.029s) [245.582321] [052/134] (773s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled) [245.641265] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled [245.645966] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s) [245.834949] [053/134] (773s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-pwrite) [245.947883] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-pwrite [252.970212] Subtest fbc-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (7.025s) [254.126550] [054/134] (764s left) api_intel_bb (object-noreloc-keep-cache-simple) [254.185498] Starting subtest: object-noreloc-keep-cache-simple [254.190880] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.005s) [254.319417] [055/134] (764s left) kms_pm_rpm (modeset-non-lpsp-stress) [256.043283] Starting subtest: modeset-non-lpsp-stress [257.199940] Subtest modeset-non-lpsp-stress: SKIP (1.153s) [257.586319] [056/134] (761s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs) [257.683422] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs [257.685813] Starting dynamic subtest: pipe-A-eDP-1 [257.709131] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [257.721986] Starting dynamic subtest: pipe-B-eDP-1 [257.744247] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [257.752335] Starting dynamic subtest: pipe-C-eDP-1 [257.772690] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [257.782300] Starting dynamic subtest: pipe-D-eDP-1 [257.803064] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [257.807272] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs: SKIP (0.004s) [259.905618] [057/134] (759s left) gem_mmap_gtt (cpuset-medium-copy) [259.960744] Subtest cpuset-medium-copy: SKIP (0.000s) [260.025307] [058/134] (759s left) dmabuf_sync_file (export-basic) [260.071929] Starting subtest: export-basic [260.074290] Subtest export-basic: SUCCESS (0.001s) [260.138710] [059/134] (758s left) gem_eio (context-create) [260.380806] Starting subtest: context-create [260.722476] Subtest context-create: SUCCESS (0.340s) [260.888432] [060/134] (758s left) kms_psr (psr2-sprite-mmap-gtt) [260.984235] Starting subtest: psr2-sprite-mmap-gtt [260.985978] Starting dynamic subtest: eDP-1 [262.376889] Dynamic subtest eDP-1: SKIP (1.389s) [262.381456] Subtest psr2-sprite-mmap-gtt: SKIP (1.391s) [262.568362] [061/134] (756s left) kms_big_fb (yf-tiled-32bpp-rotate-90) [262.666087] Starting subtest: yf-tiled-32bpp-rotate-90 [262.670314] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s) [262.794105] [062/134] (756s left) kms_3d (basic) [262.855274] Starting subtest: basic [264.807712] Subtest basic: SUCCESS (1.955s) [265.312779] [063/134] (753s left) gem_exec_schedule (promotion) [265.384545] Starting subtest: promotion [265.386861] Starting dynamic subtest: rcs0 [265.468579] Dynamic subtest rcs0: SUCCESS (0.092s) [265.478937] Starting dynamic subtest: vcs0 [265.554194] Dynamic subtest vcs0: SUCCESS (0.085s) [265.566542] Starting dynamic subtest: vcs1 [265.637060] Dynamic subtest vcs1: SUCCESS (0.083s) [265.647795] Starting dynamic subtest: vecs0 [265.726423] Dynamic subtest vecs0: SUCCESS (0.087s) [265.737419] Starting dynamic subtest: ccs0 [265.812851] Dynamic subtest ccs0: SUCCESS (0.085s) [265.815515] Subtest promotion: SUCCESS (0.437s) [267.028848] [064/134] (752s left) perf (gen8-unprivileged-single-ctx-counters) [267.148284] Starting subtest: gen8-unprivileged-single-ctx-counters [267.152131] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s) [267.188578] [065/134] (752s left) kms_cursor_crc (cursor-onscreen-64x64) [267.345665] Starting subtest: cursor-onscreen-64x64 [267.347782] Starting dynamic subtest: pipe-A-eDP-1 [269.458285] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.111s) [269.486574] Starting dynamic subtest: pipe-D-eDP-1 [272.288706] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.807s) [272.290894] Subtest cursor-onscreen-64x64: SUCCESS (4.944s) [273.139355] [066/134] (746s left) gem_exec_reloc (basic-gtt-read-noreloc) [273.213158] Subtest basic-gtt-read-noreloc: SKIP (0.000s) [273.297970] [067/134] (746s left) kms_rotation_crc (primary-y-tiled-reflect-x-90) [273.393813] Starting subtest: primary-y-tiled-reflect-x-90 [273.398098] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s) [273.478946] [068/134] (745s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc) [273.579612] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc [273.581871] Starting dynamic subtest: pipe-A-eDP-1 [274.309142] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.720s) [274.316392] Starting dynamic subtest: pipe-B-eDP-1 [276.173858] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.861s) [276.181733] Starting dynamic subtest: pipe-C-eDP-1 [277.975082] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.800s) [277.983236] Starting dynamic subtest: pipe-D-eDP-1 [279.777738] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.802s) [279.780206] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (6.191s) [280.919953] [069/134] (738s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf) [285.975527] Starting subtest: pr-overlay-plane-move-continuous-sf [285.979680] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.002s) [286.806881] [070/134] (732s left) kms_rotation_crc (primary-rotation-270) [286.900066] Starting subtest: primary-rotation-270 [286.904178] Subtest primary-rotation-270: SKIP (0.001s) [286.998267] [071/134] (732s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area) [291.994065] Starting subtest: psr2-overlay-plane-update-sf-dmg-area [291.996333] Starting dynamic subtest: pipe-A-eDP-1 [298.462149] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.465s) [298.470600] Starting dynamic subtest: pipe-B-eDP-1 [304.942324] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.480s) [304.944773] Subtest psr2-overlay-plane-update-sf-dmg-area: SUCCESS (12.949s) [305.808968] [072/134] (713s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move) [305.912064] Starting subtest: psr-1p-primscrn-cur-indfb-move [313.182977] Subtest psr-1p-primscrn-cur-indfb-move: SUCCESS (7.274s) [313.341881] [073/134] (706s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt) [313.442384] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt [313.446738] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s) [313.572363] [074/134] (706s left) kms_invalid_mode (bad-vsync-end) [313.672442] Starting subtest: bad-vsync-end [313.674695] Starting dynamic subtest: pipe-A-eDP-1 [313.954480] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.283s) [313.963105] Starting dynamic subtest: pipe-B-eDP-1 [313.965250] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [313.972921] Starting dynamic subtest: pipe-C-eDP-1 [313.975130] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [313.982853] Starting dynamic subtest: pipe-D-eDP-1 [313.984780] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [313.986670] Subtest bad-vsync-end: SUCCESS (0.289s) [314.795575] [075/134] (704s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa [314.866533] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled [314.868838] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.000s) [314.992524] [076/134] (704s left) gem_mmap_offset (pf-nonblock) [315.053301] Starting subtest: pf-nonblock [315.058067] Subtest pf-nonblock: SUCCESS (0.006s) [315.210701] [077/134] (704s left) gem_wait (write-wait) [315.270980] Starting subtest: write-wait [315.273308] Starting dynamic subtest: all-engines [316.372070] Dynamic subtest all-engines: SUCCESS (1.100s) [316.387469] Starting dynamic subtest: rcs0 [317.437746] Dynamic subtest rcs0: SUCCESS (1.063s) [317.453311] Starting dynamic subtest: bcs0 [318.497680] Dynamic subtest bcs0: SUCCESS (1.058s) [318.513179] Starting dynamic subtest: vcs0 [319.552803] Dynamic subtest vcs0: SUCCESS (1.052s) [319.567502] Starting dynamic subtest: vcs1 [320.606397] Dynamic subtest vcs1: SUCCESS (1.052s) [320.621550] Starting dynamic subtest: vecs0 [321.660629] Dynamic subtest vecs0: SUCCESS (1.052s) [321.675445] Starting dynamic subtest: ccs0 [322.718378] Dynamic subtest ccs0: SUCCESS (1.056s) [322.721104] Subtest write-wait: SUCCESS (7.448s) [322.925508] [078/134] (696s left) perf_pmu (gt-awake) [322.963043] Starting subtest: gt-awake [331.926610] Subtest gt-awake: SUCCESS (8.966s) [332.066345] [079/134] (687s left) kms_content_protection (suspend-resume) [332.213577] Starting subtest: suspend-resume [332.218066] Subtest suspend-resume: SKIP (0.000s) [332.391457] [080/134] (687s left) api_intel_allocator (simple-allocator) [332.450404] Starting subtest: simple-allocator [332.452718] Starting dynamic subtest: basic [332.455018] Dynamic subtest basic: SUCCESS (0.003s) [332.468950] Starting dynamic subtest: parallel-one [332.649916] Dynamic subtest parallel-one: SUCCESS (0.197s) [332.661045] Starting dynamic subtest: print [332.663177] Dynamic subtest print: SUCCESS (0.000s) [332.671182] Starting dynamic subtest: reuse [332.672989] Dynamic subtest reuse: SUCCESS (0.000s) [332.680642] Starting dynamic subtest: reserve [332.682535] Dynamic subtest reserve: SUCCESS (0.000s) [332.690853] Starting dynamic subtest: fork-reopen-allocator [332.692674] Dynamic subtest fork-reopen-allocator: SUCCESS (0.010s) [332.694602] Subtest simple-allocator: SUCCESS (0.217s) [332.815186] [081/134] (687s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render) [332.914252] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render [332.918175] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s) [333.042112] [082/134] (686s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip) [333.137865] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip [333.142298] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s) [333.272259] [083/134] (686s left) prime_mmap (test_correct) [333.329594] Starting subtest: test_correct [333.331619] Starting dynamic subtest: test_correct-smem [333.376133] Dynamic subtest test_correct-smem: SUCCESS (0.049s) [333.378498] Subtest test_correct: SUCCESS (0.050s) [333.528385] [084/134] (686s left) syncobj_wait (multi-wait-all-for-submit-signaled) [333.594595] Starting subtest: multi-wait-all-for-submit-signaled [333.596542] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.000s) [333.710483] [085/134] (686s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt) [333.792951] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt [338.239776] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.449s) [339.425495] [086/134] (680s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling) [339.535083] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling [339.539432] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s) [339.620066] [087/134] (680s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling) [339.715792] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling [339.719609] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.000s) [339.799270] [088/134] (680s left) kms_flip (plain-flip-ts-check-interruptible) [339.908899] Starting subtest: plain-flip-ts-check-interruptible [339.911084] Starting dynamic subtest: A-eDP1 [348.755134] Dynamic subtest A-eDP1: SUCCESS (8.846s) [348.765654] Starting dynamic subtest: B-eDP1 [357.553491] Dynamic subtest B-eDP1: SUCCESS (8.797s) [357.568593] Starting dynamic subtest: C-eDP1 [366.429672] Dynamic subtest C-eDP1: SUCCESS (8.874s) [366.438245] Starting dynamic subtest: D-eDP1 [375.238793] Dynamic subtest D-eDP1: SUCCESS (8.807s) [375.241222] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.333s) [376.410717] [089/134] (643s left) gem_mmap_offset (partial-remap) [376.472408] Starting subtest: partial-remap [376.474554] Starting dynamic subtest: smem0 [376.483071] Dynamic subtest smem0: SUCCESS (0.003s) [376.484982] Subtest partial-remap: SUCCESS (0.004s) [376.624552] [090/134] (643s left) perf (sysctl-defaults) [376.703654] Starting subtest: sysctl-defaults [376.706093] Subtest sysctl-defaults: SUCCESS (0.000s) [376.767125] [091/134] (643s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt) [376.862323] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt [381.269204] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (4.410s) [382.401283] [092/134] (638s left) kms_pm_rpm (basic-rte) [382.439429] Starting subtest: basic-rte [385.482017] Subtest basic-rte: SUCCESS (3.043s) [386.994339] [093/134] (633s left) kms_ccs (crc-sprite-planes-basic-yf-tiled-ccs) [387.088339] Starting subtest: crc-sprite-planes-basic-yf-tiled-ccs [387.090757] Starting dynamic subtest: pipe-A-eDP-1 [387.150644] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [387.164573] Starting dynamic subtest: pipe-B-eDP-1 [387.225917] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [387.235746] Starting dynamic subtest: pipe-C-eDP-1 [387.294480] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [387.304125] Starting dynamic subtest: pipe-D-eDP-1 [387.360021] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [387.364431] Subtest crc-sprite-planes-basic-yf-tiled-ccs: SKIP (0.008s) [389.303542] [094/134] (631s left) kms_lease (implicit-plane-lease) [389.400432] Starting subtest: implicit-plane-lease [389.402624] Subtest implicit-plane-lease: SUCCESS (0.003s) [389.521359] [095/134] (631s left) gem_exec_gttfill (engines) [389.583251] Starting subtest: engines [389.585509] Starting dynamic subtest: rcs0 [412.464069] Dynamic subtest rcs0: SUCCESS (22.879s) [412.475238] Starting dynamic subtest: bcs0 [435.760880] Dynamic subtest bcs0: SUCCESS (23.294s) [435.770438] Starting dynamic subtest: vcs0 [459.075826] Dynamic subtest vcs0: SUCCESS (23.311s) [459.084153] Starting dynamic subtest: vcs1 [482.393913] Dynamic subtest vcs1: SUCCESS (23.315s) [482.404837] Starting dynamic subtest: vecs0 [505.679262] Dynamic subtest vecs0: SUCCESS (23.282s) [505.688806] Starting dynamic subtest: ccs0 [528.984939] Dynamic subtest ccs0: SUCCESS (23.302s) [528.987720] Subtest engines: SUCCESS (139.399s) [529.199182] [096/134] (491s left) gem_exec_store (cachelines) [529.297236] Starting subtest: cachelines [529.299572] Starting dynamic subtest: rcs0 [529.416247] Dynamic subtest rcs0: SUCCESS (0.120s) [529.427512] Starting dynamic subtest: bcs0 [529.482501] Dynamic subtest bcs0: SUCCESS (0.065s) [529.492759] Starting dynamic subtest: vcs0 [529.542904] Dynamic subtest vcs0: SUCCESS (0.059s) [529.553921] Starting dynamic subtest: vcs1 [529.604491] Dynamic subtest vcs1: SUCCESS (0.059s) [529.615054] Starting dynamic subtest: vecs0 [529.672051] Dynamic subtest vecs0: SUCCESS (0.065s) [529.685434] Starting dynamic subtest: ccs0 [529.734627] Dynamic subtest ccs0: SUCCESS (0.060s) [529.737052] Subtest cachelines: SUCCESS (0.441s) [529.947659] [097/134] (490s left) kms_big_fb (x-tiled-addfb-size-overflow) [530.052413] Starting subtest: x-tiled-addfb-size-overflow [530.054652] Subtest x-tiled-addfb-size-overflow: SUCCESS (0.000s) [530.176225] [098/134] (490s left) syncobj_timeline (etime-single-wait-available-unsubmitted) [530.229799] Starting subtest: etime-single-wait-available-unsubmitted [530.336956] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.105s) [530.422890] [099/134] (490s left) gem_exec_reloc (basic-softpin) [530.486863] Subtest basic-softpin: SKIP (0.000s) [530.565262] [100/134] (490s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation) [530.667135] Starting subtest: plane-scaler-with-clipping-clamping-rotation [530.669411] Starting dynamic subtest: pipe-A [530.920606] Dynamic subtest pipe-A: SUCCESS (0.255s) [530.929596] Starting dynamic subtest: pipe-B [532.225190] Dynamic subtest pipe-B: SUCCESS (1.303s) [532.240451] Starting dynamic subtest: pipe-C [533.533418] Dynamic subtest pipe-C: SUCCESS (1.307s) [533.542555] Starting dynamic subtest: pipe-D [534.821838] Dynamic subtest pipe-D: SUCCESS (1.288s) [534.824191] Subtest plane-scaler-with-clipping-clamping-rotation: SUCCESS (4.157s) [535.983812] [101/134] (484s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt) [536.087886] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt [543.386267] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.301s) [543.556742] [102/134] (477s left) gem_ctx_persistence (heartbeat-many) [543.621576] Starting subtest: heartbeat-many [543.626228] Subtest heartbeat-many: SKIP (0.000s) [543.737287] [103/134] (477s left) i915_query (query-topology-garbage-items) [543.803365] Starting subtest: query-topology-garbage-items [543.805533] Subtest query-topology-garbage-items: SUCCESS (0.000s) [543.933856] [104/134] (476s left) prime_vgem (sync) [544.019378] Starting subtest: sync [544.021306] Starting dynamic subtest: rcs0 [544.077024] Dynamic subtest rcs0: SUCCESS (0.058s) [544.085118] Starting dynamic subtest: bcs0 [544.152489] Dynamic subtest bcs0: SUCCESS (0.074s) [544.161221] Starting dynamic subtest: vcs0 [544.199115] Dynamic subtest vcs0: SUCCESS (0.046s) [544.207674] Starting dynamic subtest: vcs1 [544.246135] Dynamic subtest vcs1: SUCCESS (0.046s) [544.254679] Starting dynamic subtest: vecs0 [544.291780] Dynamic subtest vecs0: SUCCESS (0.045s) [544.299829] Starting dynamic subtest: ccs0 [544.337095] Dynamic subtest ccs0: SUCCESS (0.045s) [544.338844] Subtest sync: SUCCESS (0.319s) [544.479103] [105/134] (476s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers) [544.575992] Starting subtest: plane-upscale-factor-0-25-with-modifiers [544.577864] Starting dynamic subtest: pipe-A [544.912320] Dynamic subtest pipe-A: SUCCESS (0.338s) [544.922298] Starting dynamic subtest: pipe-B [546.330968] Dynamic subtest pipe-B: SUCCESS (1.417s) [546.339715] Starting dynamic subtest: pipe-C [547.729547] Dynamic subtest pipe-C: SUCCESS (1.398s) [547.737837] Starting dynamic subtest: pipe-D [549.138883] Dynamic subtest pipe-D: SUCCESS (1.408s) [549.141242] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.565s) [550.379108] [106/134] (470s left) kms_frontbuffer_tracking (fbc-abgr161616f-draw-mmap-cpu) [550.493667] Starting subtest: fbc-abgr161616f-draw-mmap-cpu [550.498078] Subtest fbc-abgr161616f-draw-mmap-cpu: SKIP (0.000s) [550.597389] [107/134] (470s left) gem_exec_balancer (persistence) [550.861694] Starting subtest: persistence [551.709968] Subtest persistence: SUCCESS (0.848s) [551.850397] [108/134] (469s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw) [551.953887] Starting subtest: fbc-2p-pri-indfb-multidraw [551.958204] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s) [552.052570] [109/134] (469s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move) [552.152326] Starting subtest: psr-2p-primscrn-cur-indfb-move [552.156492] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s) [552.274232] [110/134] (468s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render) [552.368249] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render [552.372378] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s) [552.503148] [111/134] (468s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [552.608052] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip [553.443262] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.837s) [553.650735] [112/134] (467s left) gem_create (create-valid-nonaligned) [553.719750] Starting subtest: create-valid-nonaligned [553.722029] Subtest create-valid-nonaligned: SUCCESS (0.000s) [553.919193] [113/134] (467s left) i915_drm_fdinfo (busy-idle) [553.961665] Starting subtest: busy-idle [553.963861] Starting dynamic subtest: rcs0 [554.002324] Dynamic subtest rcs0: SKIP (0.040s) [554.013402] Starting dynamic subtest: bcs0 [554.018335] Dynamic subtest bcs0: SKIP (0.000s) [554.036783] Starting dynamic subtest: vcs0 [554.041833] Dynamic subtest vcs0: SKIP (0.000s) [554.060548] Starting dynamic subtest: vcs1 [554.065778] Dynamic subtest vcs1: SKIP (0.000s) [554.076587] Starting dynamic subtest: vecs0 [554.080808] Dynamic subtest vecs0: SKIP (0.000s) [554.089091] Starting dynamic subtest: ccs0 [554.093164] Dynamic subtest ccs0: SKIP (0.000s) [554.097204] Subtest busy-idle: SKIP (0.046s) [554.132490] [114/134] (467s left) kms_cursor_legacy (cursorb-vs-flipa-atomic) [554.273488] Starting subtest: cursorB-vs-flipA-atomic [554.278051] Subtest cursorB-vs-flipA-atomic: SKIP (0.001s) [554.428465] [115/134] (466s left) gem_softpin (softpin) [554.499854] Starting subtest: softpin [586.792988] Subtest softpin: SUCCESS (32.286s) [586.933940] [116/134] (434s left) gem_set_tiling_vs_blt (tiled-to-untiled) [587.003259] Subtest tiled-to-untiled: SKIP (0.000s) [587.067284] [117/134] (434s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier) [587.161962] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier [587.187574] Starting dynamic subtest: pipe-A-plane-0 [587.192098] Dynamic subtest pipe-A-plane-0: SKIP (0.000s) [587.202169] Starting dynamic subtest: pipe-A-plane-3 [587.206607] Dynamic subtest pipe-A-plane-3: SKIP (0.000s) [587.214496] Starting dynamic subtest: pipe-A-plane-5 [587.219055] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [588.333488] Starting dynamic subtest: pipe-B-plane-0 [588.338281] Dynamic subtest pipe-B-plane-0: SKIP (0.000s) [588.348514] Starting dynamic subtest: pipe-B-plane-3 [588.352806] Dynamic subtest pipe-B-plane-3: SKIP (0.000s) [588.360616] Starting dynamic subtest: pipe-B-plane-5 [588.364665] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [588.630042] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier: SKIP (1.467s) [589.491829] [118/134] (431s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt) [589.597556] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt [589.601914] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s) [589.696295] [119/134] (431s left) kms_big_fb (4-tiled-8bpp-rotate-90) [589.790134] Starting subtest: 4-tiled-8bpp-rotate-90 [589.811484] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.021s) [589.962593] [120/134] (431s left) kms_color (invalid-ctm-matrix-sizes) [590.065362] Starting subtest: invalid-ctm-matrix-sizes [590.067691] Starting dynamic subtest: pipe-A [590.070066] Dynamic subtest pipe-A: SUCCESS (0.002s) [590.079647] Starting dynamic subtest: pipe-B [590.081875] Dynamic subtest pipe-B: SUCCESS (0.003s) [590.090373] Starting dynamic subtest: pipe-C [590.092648] Dynamic subtest pipe-C: SUCCESS (0.003s) [590.100665] Starting dynamic subtest: pipe-D [590.102978] Dynamic subtest pipe-D: SUCCESS (0.004s) [590.105172] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.014s) [590.162158] [121/134] (431s left) kms_chamelium_hpd (dp-hpd-after-suspend) [590.544318] Subtest dp-hpd-after-suspend: SKIP (0.000s) [591.341594] [122/134] (430s left) kms_rmfb (close-fd) [591.443083] Starting subtest: close-fd [591.445381] Starting dynamic subtest: pipe-A-eDP-1 [591.550691] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.108s) [591.561512] Starting dynamic subtest: pipe-B-eDP-1 [592.699421] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.144s) [592.709601] Starting dynamic subtest: pipe-C-eDP-1 [593.887083] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.186s) [593.896321] Starting dynamic subtest: pipe-D-eDP-1 [595.082993] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.196s) [595.085304] Subtest close-fd: SUCCESS (3.640s) [596.276839] [123/134] (425s left) kms_busy (extended-modeset-hang-newfb-with-reset) [596.372182] Starting subtest: extended-modeset-hang-newfb-with-reset [596.374564] Starting dynamic subtest: pipe-A [611.788636] Dynamic subtest pipe-A: SUCCESS (15.416s) [611.798209] Starting dynamic subtest: pipe-D [626.899434] Dynamic subtest pipe-D: SUCCESS (15.105s) [626.901629] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (30.525s) [627.795925] [124/134] (393s left) perf_pmu (busy-accuracy-50) [627.838165] Starting subtest: busy-accuracy-50 [627.840588] Starting dynamic subtest: rcs0 [629.369829] Dynamic subtest rcs0: SUCCESS (1.529s) [629.381596] Starting dynamic subtest: bcs0 [630.906876] Dynamic subtest bcs0: SUCCESS (1.534s) [630.915462] Starting dynamic subtest: vcs0 [632.451113] Dynamic subtest vcs0: SUCCESS (1.542s) [632.461482] Starting dynamic subtest: vcs1 [633.993256] Dynamic subtest vcs1: SUCCESS (1.539s) [634.003656] Starting dynamic subtest: vecs0 [635.535539] Dynamic subtest vecs0: SUCCESS (1.540s) [635.546306] Starting dynamic subtest: ccs0 [637.081774] Dynamic subtest ccs0: SUCCESS (1.544s) [637.084322] Subtest busy-accuracy-50: SUCCESS (9.243s) [637.241747] [125/134] (384s left) gem_lmem_evict (dontneed-evict-race) [637.281166] Subtest dontneed-evict-race: SKIP (0.000s) [637.325843] [126/134] (384s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs) [637.428039] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs [637.430315] Starting dynamic subtest: pipe-A-eDP-1 [637.439311] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [637.449069] Starting dynamic subtest: pipe-B-eDP-1 [637.458033] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [637.467834] Starting dynamic subtest: pipe-C-eDP-1 [637.476482] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [637.484683] Starting dynamic subtest: pipe-D-eDP-1 [637.493279] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [637.497667] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.004s) [639.707649] [127/134] (382s left) i915_pm_rpm (system-suspend-devices) [641.240547] Starting subtest: system-suspend-devices [649.013335] Subtest system-suspend-devices: SUCCESS (7.775s) [649.399415] [128/134] (372s left) syncobj_wait (wait-any-complex) [649.479717] Starting subtest: wait-any-complex [649.540427] Subtest wait-any-complex: SUCCESS (0.061s) [649.628720] [129/134] (372s left) kms_vblank (wait-forked) [649.730791] Starting subtest: wait-forked [649.732609] Starting dynamic subtest: pipe-A-eDP-1 [651.528518] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.799s) [651.543387] Starting dynamic subtest: pipe-D-eDP-1 [654.014681] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.483s) [654.016884] Subtest wait-forked: SUCCESS (4.286s) [654.883818] [130/134] (367s left) gem_exec_balancer (noheartbeat) [655.141982] Starting subtest: noheartbeat [655.146672] Subtest noheartbeat: SKIP (0.000s) [655.264385] [131/134] (366s left) kms_psr (fbc-psr2-cursor-mmap-cpu) [655.349936] Starting subtest: fbc-psr2-cursor-mmap-cpu [655.352237] Starting dynamic subtest: eDP-1 [655.356503] Dynamic subtest eDP-1: SKIP (0.000s) [655.360781] Subtest fbc-psr2-cursor-mmap-cpu: SKIP (0.002s) [655.435825] [132/134] (366s left) kms_getfb (getfb2-handle-not-fb) [655.532705] Starting subtest: getfb2-handle-not-fb [655.534804] Subtest getfb2-handle-not-fb: SUCCESS (0.000s) [655.665057] [133/134] (366s left) syncobj_wait (wait-for-submit-snapshot) [655.734623] Starting subtest: wait-for-submit-snapshot [655.813775] Subtest wait-for-submit-snapshot: SUCCESS (0.081s) [655.928454] [134/134] (366s left) kms_addfb_basic (size-max) [656.018768] Starting subtest: size-max [656.020903] Subtest size-max: SUCCESS (0.000s) [656.127266] Closing watchdogs results: parsing output: 0/ for test: kms_getfb results: parsing output: 1/ for test: gem_close_race results: parsing output: 2/ for test: gem_pxp results: parsing output: 3/ for test: kms_psr2_sf results: parsing output: 4/ for test: gem_exec_flush results: parsing output: 5/ for test: kms_frontbuffer_tracking results: parsing output: 6/ for test: sw_sync results: parsing output: 7/ for test: gem_exec_params results: parsing output: 8/ for test: gem_mmap_gtt results: parsing output: 9/ for test: kms_universal_plane results: parsing output: 10/ for test: syncobj_eventfd results: parsing output: 11/ for test: gen9_exec_parse results: parsing output: 12/ for test: kms_frontbuffer_tracking results: parsing output: 13/ for test: kms_cursor_crc results: parsing output: 14/ for test: kms_psr results: parsing output: 15/ for test: kms_flip results: parsing output: 16/ for test: kms_flip results: parsing output: 17/ for test: kms_force_connector_basic results: parsing output: 18/ for test: kms_dirtyfb results: parsing output: 19/ for test: kms_frontbuffer_tracking results: parsing output: 20/ for test: gem_ctx_exec results: parsing output: 21/ for test: syncobj_timeline results: parsing output: 22/ for test: gem_tiled_pread_basic results: parsing output: 23/ for test: kms_atomic_transition results: parsing output: 24/ for test: kms_big_fb results: parsing output: 25/ for test: vgem_basic results: parsing output: 26/ for test: gem_close_race results: parsing output: 27/ for test: kms_frontbuffer_tracking results: parsing output: 28/ for test: gem_userptr_blits results: parsing output: 29/ for test: gem_exec_schedule results: parsing output: 30/ for test: kms_ccs results: parsing output: 31/ for test: kms_cursor_legacy results: parsing output: 32/ for test: gem_exec_params results: parsing output: 33/ for test: kms_chamelium_edid results: parsing output: 34/ for test: gem_spin_batch results: parsing output: 35/ for test: kms_psr_stress_test results: parsing output: 36/ for test: kms_plane results: parsing output: 37/ for test: kms_dsc results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: i915_hangman results: parsing output: 40/ for test: gem_exec_fence results: parsing output: 41/ for test: kms_frontbuffer_tracking results: parsing output: 42/ for test: kms_plane_cursor results: parsing output: 43/ for test: kms_cursor_crc results: parsing output: 44/ for test: syncobj_timeline results: parsing output: 45/ for test: syncobj_timeline results: parsing output: 46/ for test: gem_partial_pwrite_pread results: parsing output: 47/ for test: kms_frontbuffer_tracking results: parsing output: 48/ for test: gem_blits results: parsing output: 49/ for test: kms_psr results: parsing output: 50/ for test: gem_madvise results: parsing output: 51/ for test: gem_render_copy results: parsing output: 52/ for test: kms_frontbuffer_tracking results: parsing output: 53/ for test: api_intel_bb results: parsing output: 54/ for test: kms_pm_rpm results: parsing output: 55/ for test: kms_ccs results: parsing output: 56/ for test: gem_mmap_gtt results: parsing output: 57/ for test: dmabuf_sync_file results: parsing output: 58/ for test: gem_eio results: parsing output: 59/ for test: kms_psr results: parsing output: 60/ for test: kms_big_fb results: parsing output: 61/ for test: kms_3d results: parsing output: 62/ for test: gem_exec_schedule results: parsing output: 63/ for test: perf results: parsing output: 64/ for test: kms_cursor_crc results: parsing output: 65/ for test: gem_exec_reloc results: parsing output: 66/ for test: kms_rotation_crc results: parsing output: 67/ for test: kms_ccs results: parsing output: 68/ for test: kms_psr2_sf results: parsing output: 69/ for test: kms_rotation_crc results: parsing output: 70/ for test: kms_psr2_sf results: parsing output: 71/ for test: kms_frontbuffer_tracking results: parsing output: 72/ for test: kms_frontbuffer_tracking results: parsing output: 73/ for test: kms_invalid_mode results: parsing output: 74/ for test: syncobj_timeline results: parsing output: 75/ for test: gem_mmap_offset results: parsing output: 76/ for test: gem_wait results: parsing output: 77/ for test: perf_pmu results: parsing output: 78/ for test: kms_content_protection results: parsing output: 79/ for test: api_intel_allocator results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: kms_big_fb results: parsing output: 82/ for test: prime_mmap results: parsing output: 83/ for test: syncobj_wait results: parsing output: 84/ for test: kms_frontbuffer_tracking results: parsing output: 85/ for test: kms_flip_scaled_crc results: parsing output: 86/ for test: kms_flip_scaled_crc results: parsing output: 87/ for test: kms_flip results: parsing output: 88/ for test: gem_mmap_offset results: parsing output: 89/ for test: perf results: parsing output: 90/ for test: kms_frontbuffer_tracking results: parsing output: 91/ for test: kms_pm_rpm results: parsing output: 92/ for test: kms_ccs results: parsing output: 93/ for test: kms_lease results: parsing output: 94/ for test: gem_exec_gttfill results: parsing output: 95/ for test: gem_exec_store results: parsing output: 96/ for test: kms_big_fb results: parsing output: 97/ for test: syncobj_timeline results: parsing output: 98/ for test: gem_exec_reloc results: parsing output: 99/ for test: kms_plane_scaling results: parsing output: 100/ for test: kms_frontbuffer_tracking results: parsing output: 101/ for test: gem_ctx_persistence results: parsing output: 102/ for test: i915_query results: parsing output: 103/ for test: prime_vgem results: parsing output: 104/ for test: kms_plane_scaling results: parsing output: 105/ for test: kms_frontbuffer_tracking results: parsing output: 106/ for test: gem_exec_balancer results: parsing output: 107/ for test: kms_frontbuffer_tracking results: parsing output: 108/ for test: kms_frontbuffer_tracking results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: kms_big_fb results: parsing output: 111/ for test: gem_create results: parsing output: 112/ for test: i915_drm_fdinfo results: parsing output: 113/ for test: kms_cursor_legacy results: parsing output: 114/ for test: gem_softpin results: parsing output: 115/ for test: gem_set_tiling_vs_blt results: parsing output: 116/ for test: kms_plane results: parsing output: 117/ for test: kms_frontbuffer_tracking results: parsing output: 118/ for test: kms_big_fb results: parsing output: 119/ for test: kms_color results: parsing output: 120/ for test: kms_chamelium_hpd results: parsing output: 121/ for test: kms_rmfb results: parsing output: 122/ for test: kms_busy results: parsing output: 123/ for test: perf_pmu results: parsing output: 124/ for test: gem_lmem_evict results: parsing output: 125/ for test: kms_ccs results: parsing output: 126/ for test: i915_pm_rpm results: parsing output: 127/ for test: syncobj_wait results: parsing output: 128/ for test: kms_vblank results: parsing output: 129/ for test: gem_exec_balancer results: parsing output: 130/ for test: kms_psr results: parsing output: 131/ for test: kms_getfb results: parsing output: 132/ for test: syncobj_wait results: parsing output: 133/ for test: kms_addfb_basic Done.