[61.085891] Initializing watchdogs [61.085956] /dev/watchdog0 [61.099660] [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] [61.103804] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [61.105964] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [61.109523] [001/134] (960s left) kms_getfb (getfb-handle-closed) [61.235868] Starting subtest: getfb-handle-closed [61.238155] Subtest getfb-handle-closed: SUCCESS (0.002s) [61.357391] [002/134] (960s left) gem_close_race (multigpu-basic-threads) [61.422044] Starting subtest: multigpu-basic-threads [61.426634] Subtest multigpu-basic-threads: SKIP (0.000s) [61.669585] [003/134] (960s left) gem_pxp (hw-rejects-pxp-buffer) [61.799385] Starting subtest: hw-rejects-pxp-buffer [61.803621] Subtest hw-rejects-pxp-buffer: SKIP (0.000s) [61.914213] [004/134] (959s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-sf) [66.976152] Starting subtest: fbc-psr2-cursor-plane-move-continuous-sf [66.982070] Starting dynamic subtest: pipe-A-eDP-1 [67.748633] Dynamic subtest pipe-A-eDP-1: SKIP (0.766s) [67.757615] Starting dynamic subtest: pipe-B-eDP-1 [68.875673] Dynamic subtest pipe-B-eDP-1: SKIP (1.126s) [68.879903] Subtest fbc-psr2-cursor-plane-move-continuous-sf: SKIP (1.898s) [70.063766] [005/134] (951s left) gem_exec_flush (basic-batch-kernel-default-wb) [70.136369] Starting subtest: basic-batch-kernel-default-wb [77.294545] Subtest basic-batch-kernel-default-wb: SUCCESS (7.159s) [77.502695] [006/134] (944s left) kms_frontbuffer_tracking (pipe-fbc-rte) [77.608668] Starting subtest: pipe-fbc-rte [77.615711] Starting dynamic subtest: pipe-B-eDP-1 [83.062201] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.457s) [83.070064] Subtest pipe-fbc-rte: SUCCESS (5.459s) [85.403139] [007/134] (936s left) sw_sync (alloc_timeline) [85.439367] Starting subtest: alloc_timeline [85.441756] Subtest alloc_timeline: SUCCESS (0.000s) [85.519438] [008/134] (936s left) gem_exec_params (batch-first) [85.578101] Starting subtest: batch-first [85.581168] Subtest batch-first: SUCCESS (0.005s) [85.721477] [009/134] (936s left) gem_mmap_gtt (basic-small-copy) [85.775715] Subtest basic-small-copy: SKIP (0.000s) [85.835886] [010/134] (936s left) kms_universal_plane (universal-plane-pageflip-windowed) [85.943113] Starting subtest: universal-plane-pageflip-windowed [85.945557] Starting dynamic subtest: pipe-A-eDP-1 [86.539551] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.597s) [86.548816] Starting dynamic subtest: pipe-B-eDP-1 [87.729644] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.191s) [87.738174] Starting dynamic subtest: pipe-C-eDP-1 [88.961214] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.229s) [88.969753] Starting dynamic subtest: pipe-D-eDP-1 [90.175683] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.213s) [90.178123] Subtest universal-plane-pageflip-windowed: SUCCESS (4.234s) [91.036044] [011/134] (930s left) syncobj_eventfd (invalid-illegal-handle) [91.101150] Starting subtest: invalid-illegal-handle [91.103569] Subtest invalid-illegal-handle: SUCCESS (0.000s) [91.239907] [012/134] (930s left) gen9_exec_parse (cmd-crossing-page) [91.310260] Subtest cmd-crossing-page: SKIP (0.000s) [91.400662] [013/134] (930s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite) [91.514442] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite [99.945087] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.434s) [100.090679] [014/134] (922s left) kms_cursor_crc (cursor-sliding-64x21) [100.278292] Starting subtest: cursor-sliding-64x21 [100.324706] Subtest cursor-sliding-64x21: SKIP (0.041s) [100.582765] [015/134] (921s left) kms_psr (pr-cursor-render) [100.668780] Starting subtest: pr-cursor-render [100.673161] Subtest pr-cursor-render: SKIP (0.000s) [100.767755] [016/134] (921s left) kms_flip (nonexisting-fb) [100.863364] Starting subtest: nonexisting-fb [100.865634] Starting dynamic subtest: A-eDP1 [102.045313] Dynamic subtest A-eDP1: SUCCESS (1.184s) [102.054385] Starting dynamic subtest: B-eDP1 [103.177742] Dynamic subtest B-eDP1: SUCCESS (1.132s) [103.186545] Starting dynamic subtest: C-eDP1 [104.308360] Dynamic subtest C-eDP1: SUCCESS (1.130s) [104.317413] Starting dynamic subtest: D-eDP1 [105.440580] Dynamic subtest D-eDP1: SUCCESS (1.132s) [105.445311] Subtest nonexisting-fb: SUCCESS (4.586s) [106.631187] [017/134] (915s left) kms_flip (basic-flip-vs-wf_vblank) [106.719253] Starting subtest: basic-flip-vs-wf_vblank [106.721531] Starting dynamic subtest: A-eDP1 [108.645313] Dynamic subtest A-eDP1: SUCCESS (1.926s) [108.654775] Starting dynamic subtest: B-eDP1 [110.575819] Dynamic subtest B-eDP1: SUCCESS (1.930s) [110.585352] Starting dynamic subtest: C-eDP1 [112.495329] Dynamic subtest C-eDP1: SUCCESS (1.919s) [112.503430] Starting dynamic subtest: D-eDP1 [114.435706] Dynamic subtest D-eDP1: SUCCESS (1.939s) [114.440800] Subtest basic-flip-vs-wf_vblank: SUCCESS (7.723s) [115.666367] [018/134] (906s left) kms_force_connector_basic (prune-stale-modes) [115.752837] Starting subtest: prune-stale-modes [116.217738] Subtest prune-stale-modes: SUCCESS (0.465s) [116.375157] [019/134] (905s left) kms_dirtyfb (default-dirtyfb-ioctl) [116.466237] Starting subtest: default-dirtyfb-ioctl [116.468450] Starting dynamic subtest: A-eDP-1 [118.047609] Dynamic subtest A-eDP-1: SUCCESS (1.579s) [118.049539] Subtest default-dirtyfb-ioctl: SUCCESS (1.580s) [118.888130] [020/134] (903s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-blt) [119.005719] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-blt [119.009760] Subtest fbc-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s) [119.132887] [021/134] (903s left) gem_ctx_exec (basic-nohangcheck) [119.187910] Starting subtest: basic-nohangcheck [119.457057] Subtest basic-nohangcheck: SUCCESS (0.270s) [119.590439] [022/134] (902s left) syncobj_timeline (wait-zero-handles) [119.652029] Starting subtest: wait-zero-handles [119.654235] Subtest wait-zero-handles: SUCCESS (0.000s) [119.756707] [023/134] (902s left) gem_tiled_pread_basic [119.879094] [024/134] (902s left) kms_atomic_transition (modeset-transition-fencing) [119.967763] Starting subtest: modeset-transition-fencing [119.970095] Starting dynamic subtest: 1x-outputs [130.852396] Dynamic subtest 1x-outputs: SUCCESS (10.884s) [130.854866] Subtest modeset-transition-fencing: SUCCESS (10.885s) [131.686257] [025/134] (890s left) kms_big_fb (y-tiled-16bpp-rotate-180) [131.787806] Starting subtest: y-tiled-16bpp-rotate-180 [131.792044] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s) [131.918768] [026/134] (890s left) vgem_basic (sysfs) [131.995559] Starting subtest: sysfs [131.997406] Subtest sysfs: SUCCESS (0.000s) [132.057674] [FACT vgem_basic (sysfs)] new: kernel.kmod_is_loaded.vgem: true [132.060770] [027/134] (890s left) gem_close_race (basic-process) [132.131568] Starting subtest: basic-process [132.181907] Subtest basic-process: SUCCESS (0.050s) [132.371097] [028/134] (890s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-pwrite) [132.460127] Starting subtest: fbc-rgb101010-draw-pwrite [137.785794] Subtest fbc-rgb101010-draw-pwrite: SUCCESS (5.331s) [138.906755] [029/134] (883s left) gem_userptr_blits (unsync-unmap-cycles) [138.973222] Subtest unsync-unmap-cycles: SKIP (0.000s) [139.117237] [030/134] (883s left) gem_exec_schedule (manyslice) [139.190601] Starting subtest: manyslice [139.192750] Starting dynamic subtest: rcs0 [143.786776] Dynamic subtest rcs0: SUCCESS (4.604s) [143.799244] Starting dynamic subtest: bcs0 [149.901561] Dynamic subtest bcs0: SUCCESS (6.111s) [149.913605] Starting dynamic subtest: vcs0 [155.478757] Dynamic subtest vcs0: SUCCESS (5.575s) [155.489725] Starting dynamic subtest: vcs1 [161.543912] Dynamic subtest vcs1: SUCCESS (6.067s) [161.554390] Starting dynamic subtest: vecs0 [167.107676] Dynamic subtest vecs0: SUCCESS (5.562s) [167.115595] Starting dynamic subtest: ccs0 [173.778114] Dynamic subtest ccs0: SUCCESS (6.669s) [173.781147] Subtest manyslice: SUCCESS (34.593s) [174.103582] [031/134] (848s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc) [174.215891] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc [174.218421] Starting dynamic subtest: pipe-A-eDP-1 [174.241379] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [174.251066] Starting dynamic subtest: pipe-B-eDP-1 [174.271558] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [174.278362] Starting dynamic subtest: pipe-C-eDP-1 [174.299183] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [174.305616] Starting dynamic subtest: pipe-D-eDP-1 [174.327248] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [174.331531] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s) [176.490326] [032/134] (846s left) kms_cursor_legacy (cursorb-vs-flipb-legacy) [176.623308] Starting subtest: cursorB-vs-flipB-legacy [176.627751] Subtest cursorB-vs-flipB-legacy: SKIP (0.001s) [176.764169] [033/134] (846s left) gem_exec_params (invalid-bsd2-flag-on-render) [176.818697] Starting subtest: invalid-bsd2-flag-on-render [176.821049] Subtest invalid-bsd2-flag-on-render: SUCCESS (0.000s) [176.939743] [034/134] (845s left) kms_chamelium_edid (dp-edid-resolution-list) [177.323762] Subtest dp-edid-resolution-list: SKIP (0.000s) [178.159721] [035/134] (844s left) gem_spin_batch (spin-all-new) [178.231071] Starting subtest: spin-all-new [178.245575] Subtest spin-all-new: SUCCESS (0.015s) [179.914247] [036/134] (843s left) kms_psr_stress_test (flip-primary-invalidate-overlay) [180.017698] Starting subtest: flip-primary-invalidate-overlay [191.586869] Subtest flip-primary-invalidate-overlay: SUCCESS (11.571s) [191.721509] [037/134] (831s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier-source-clamping) [191.818630] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier-source-clamping [191.846851] Starting dynamic subtest: pipe-A-plane-0 [191.850567] Dynamic subtest pipe-A-plane-0: SKIP (0.000s) [191.857575] Starting dynamic subtest: pipe-A-plane-3 [191.861208] Dynamic subtest pipe-A-plane-3: SKIP (0.000s) [191.867536] Starting dynamic subtest: pipe-A-plane-5 [191.871496] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [192.929758] Starting dynamic subtest: pipe-B-plane-0 [192.934126] Dynamic subtest pipe-B-plane-0: SKIP (0.000s) [192.940842] Starting dynamic subtest: pipe-B-plane-3 [192.945261] Dynamic subtest pipe-B-plane-3: SKIP (0.000s) [192.951754] Starting dynamic subtest: pipe-B-plane-5 [192.955818] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [193.250385] Subtest pixel-format-4-tiled-bmg-ccs-modifier-source-clamping: SKIP (1.426s) [194.087551] [038/134] (828s left) kms_dsc (dsc-fractional-bpp-with-bpc) [194.187489] Starting subtest: dsc-fractional-bpp-with-bpc [194.217446] Subtest dsc-fractional-bpp-with-bpc: SKIP (0.001s) [194.268305] [039/134] (828s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render) [194.390718] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render [194.395168] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s) [194.525393] [040/134] (828s left) i915_hangman (gt-engine-error) [194.599051] Starting subtest: gt-engine-error [194.601258] Starting dynamic subtest: rcs0 [195.893478] Dynamic subtest rcs0: SUCCESS (1.292s) [195.905912] Starting dynamic subtest: bcs0 [197.875604] Dynamic subtest bcs0: SUCCESS (1.980s) [197.885426] Starting dynamic subtest: vcs0 [199.860737] Dynamic subtest vcs0: SUCCESS (1.983s) [199.871612] Starting dynamic subtest: vcs1 [201.844786] Dynamic subtest vcs1: SUCCESS (1.982s) [201.855930] Starting dynamic subtest: vecs0 [203.892751] Dynamic subtest vecs0: SUCCESS (2.046s) [203.902809] Starting dynamic subtest: ccs0 [205.877953] Dynamic subtest ccs0: SUCCESS (1.983s) [205.880717] Subtest gt-engine-error: SUCCESS (11.278s) [205.973866] [041/134] (817s left) gem_exec_fence (submit3) [206.158479] Starting subtest: submit3 [206.163268] Subtest submit3: SKIP (0.000s) [208.005643] [042/134] (815s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt) [208.102049] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt [208.105934] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [208.224353] [043/134] (815s left) kms_plane_cursor (overlay) [208.319797] Starting subtest: overlay [208.324826] Starting dynamic subtest: pipe-A-eDP-1-size-64 [210.782129] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.463s) [210.839483] Starting dynamic subtest: pipe-A-eDP-1-size-128 [213.337894] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.504s) [213.397574] Starting dynamic subtest: pipe-A-eDP-1-size-256 [215.883744] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.493s) [216.238977] Starting dynamic subtest: pipe-B-eDP-1-size-64 [219.517975] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.295s) [219.578087] Starting dynamic subtest: pipe-B-eDP-1-size-128 [222.084557] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.516s) [222.143548] Starting dynamic subtest: pipe-B-eDP-1-size-256 [224.665542] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.527s) [225.015247] Starting dynamic subtest: pipe-C-eDP-1-size-64 [227.900120] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.893s) [227.943046] Starting dynamic subtest: pipe-C-eDP-1-size-128 [230.133153] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.202s) [230.169895] Starting dynamic subtest: pipe-C-eDP-1-size-256 [232.343334] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.180s) [232.669528] Starting dynamic subtest: pipe-D-eDP-1-size-64 [235.528170] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.868s) [235.565069] Starting dynamic subtest: pipe-D-eDP-1-size-128 [237.706058] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.146s) [237.742623] Starting dynamic subtest: pipe-D-eDP-1-size-256 [239.839294] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.103s) [240.153680] Subtest overlay: SUCCESS (31.835s) [240.974709] [044/134] (782s left) kms_cursor_crc (cursor-rapid-movement-256x85) [241.215335] Starting subtest: cursor-rapid-movement-256x85 [241.261429] Subtest cursor-rapid-movement-256x85: SKIP (0.041s) [241.456964] [045/134] (781s left) syncobj_timeline (invalid-transfer-bad-pad) [241.519794] Starting subtest: invalid-transfer-bad-pad [241.522189] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s) [241.636378] [046/134] (781s left) syncobj_timeline (wait-all-for-submit-complex) [241.699617] Starting subtest: wait-all-for-submit-complex [241.912530] Subtest wait-all-for-submit-complex: SUCCESS (0.214s) [241.997535] [047/134] (781s left) gem_partial_pwrite_pread (writes-after-reads) [242.071818] Subtest writes-after-reads: SKIP (0.000s) [242.156576] [048/134] (781s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt) [242.253169] Starting subtest: fbcpsr-rgb565-draw-blt [249.194925] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (6.944s) [249.363509] [049/134] (774s left) gem_blits (basic) [249.435399] Starting subtest: basic [250.740082] Subtest basic: SUCCESS (1.306s) [250.900314] [050/134] (772s left) kms_psr (fbc-psr-primary-mmap-gtt) [250.994403] Starting subtest: fbc-psr-primary-mmap-gtt [250.996267] Starting dynamic subtest: eDP-1 [251.000239] Dynamic subtest eDP-1: SKIP (0.000s) [251.004107] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s) [251.075527] [051/134] (772s left) gem_madvise (dontneed-after-mmap) [251.119142] Starting subtest: dontneed-after-mmap [251.142650] Subtest dontneed-after-mmap: SUCCESS (0.024s) [251.272104] [052/134] (772s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled) [251.337068] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled [251.341410] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s) [251.529428] [053/134] (772s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-pwrite) [251.630018] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-pwrite [258.757380] Subtest fbc-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (7.130s) [259.891129] [054/134] (763s left) api_intel_bb (object-noreloc-keep-cache-simple) [259.970649] Starting subtest: object-noreloc-keep-cache-simple [259.977433] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.009s) [260.134278] [055/134] (763s left) kms_pm_rpm (modeset-non-lpsp-stress) [262.046234] Starting subtest: modeset-non-lpsp-stress [263.204336] Subtest modeset-non-lpsp-stress: SKIP (1.158s) [263.593480] [056/134] (760s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs) [263.701135] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs [263.703489] Starting dynamic subtest: pipe-A-eDP-1 [263.726576] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [263.734655] Starting dynamic subtest: pipe-B-eDP-1 [263.756340] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [263.763477] Starting dynamic subtest: pipe-C-eDP-1 [263.785084] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [263.792872] Starting dynamic subtest: pipe-D-eDP-1 [263.816553] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [263.820946] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs: SKIP (0.004s) [265.971472] [057/134] (757s left) gem_mmap_gtt (cpuset-medium-copy) [266.028846] Subtest cpuset-medium-copy: SKIP (0.000s) [266.094595] [058/134] (757s left) dmabuf_sync_file (export-basic) [266.141332] Starting subtest: export-basic [266.143531] Subtest export-basic: SUCCESS (0.001s) [266.207960] [059/134] (757s left) gem_eio (context-create) [266.435321] Starting subtest: context-create [266.799684] Subtest context-create: SUCCESS (0.365s) [266.969498] [060/134] (756s left) kms_psr (psr2-sprite-mmap-gtt) [267.070572] Starting subtest: psr2-sprite-mmap-gtt [267.072328] Starting dynamic subtest: eDP-1 [268.535056] Dynamic subtest eDP-1: SKIP (1.460s) [268.540052] Subtest psr2-sprite-mmap-gtt: SKIP (1.463s) [268.716450] [061/134] (755s left) kms_big_fb (yf-tiled-32bpp-rotate-90) [268.823051] Starting subtest: yf-tiled-32bpp-rotate-90 [268.827582] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s) [268.952385] [062/134] (755s left) kms_3d (basic) [269.021830] Starting subtest: basic [271.033716] Subtest basic: SUCCESS (2.016s) [271.517924] [063/134] (752s left) gem_exec_schedule (promotion) [271.596857] Starting subtest: promotion [271.598856] Starting dynamic subtest: rcs0 [271.709658] Dynamic subtest rcs0: SUCCESS (0.116s) [271.718365] Starting dynamic subtest: vcs0 [271.796036] Dynamic subtest vcs0: SUCCESS (0.085s) [271.807370] Starting dynamic subtest: vcs1 [271.893710] Dynamic subtest vcs1: SUCCESS (0.097s) [271.902741] Starting dynamic subtest: vecs0 [271.986617] Dynamic subtest vecs0: SUCCESS (0.092s) [271.995696] Starting dynamic subtest: ccs0 [272.075525] Dynamic subtest ccs0: SUCCESS (0.086s) [272.078442] Subtest promotion: SUCCESS (0.482s) [272.979695] [064/134] (751s left) perf (gen8-unprivileged-single-ctx-counters) [273.104597] Starting subtest: gen8-unprivileged-single-ctx-counters [273.108698] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s) [273.150547] [065/134] (750s left) kms_cursor_crc (cursor-onscreen-64x64) [273.311432] Starting subtest: cursor-onscreen-64x64 [273.316468] Starting dynamic subtest: pipe-A-eDP-1 [275.407267] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.090s) [275.434429] Starting dynamic subtest: pipe-D-eDP-1 [278.213599] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.784s) [278.215736] Subtest cursor-onscreen-64x64: SUCCESS (4.899s) [279.081031] [066/134] (745s left) gem_exec_reloc (basic-gtt-read-noreloc) [279.150280] Subtest basic-gtt-read-noreloc: SKIP (0.000s) [279.222896] [067/134] (744s left) kms_rotation_crc (primary-y-tiled-reflect-x-90) [279.319083] Starting subtest: primary-y-tiled-reflect-x-90 [279.323156] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s) [279.419115] [068/134] (744s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc) [279.522380] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc [279.524575] Starting dynamic subtest: pipe-A-eDP-1 [280.246033] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.717s) [280.254518] Starting dynamic subtest: pipe-B-eDP-1 [282.045654] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.798s) [282.054313] Starting dynamic subtest: pipe-C-eDP-1 [283.850842] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.801s) [283.860046] Starting dynamic subtest: pipe-D-eDP-1 [285.644930] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.794s) [285.646885] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (6.117s) [286.775757] [069/134] (737s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf) [291.764217] Starting subtest: pr-overlay-plane-move-continuous-sf [291.769030] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.002s) [292.577211] [070/134] (731s left) kms_rotation_crc (primary-rotation-270) [292.669837] Starting subtest: primary-rotation-270 [292.674228] Subtest primary-rotation-270: SKIP (0.001s) [292.772277] [071/134] (731s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area) [297.861065] Starting subtest: psr2-overlay-plane-update-sf-dmg-area [297.863419] Starting dynamic subtest: pipe-A-eDP-1 [304.330395] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.468s) [304.339593] Starting dynamic subtest: pipe-B-eDP-1 [310.826278] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.492s) [310.828562] Subtest psr2-overlay-plane-update-sf-dmg-area: SUCCESS (12.964s) [311.673912] [072/134] (712s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move) [311.769978] Starting subtest: psr-1p-primscrn-cur-indfb-move [319.011044] Subtest psr-1p-primscrn-cur-indfb-move: SUCCESS (7.244s) [319.158597] [073/134] (705s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt) [319.252042] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt [319.256072] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s) [319.377862] [074/134] (705s left) kms_invalid_mode (bad-vsync-end) [319.482371] Starting subtest: bad-vsync-end [319.484611] Starting dynamic subtest: pipe-A-eDP-1 [319.800649] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.318s) [319.809198] Starting dynamic subtest: pipe-B-eDP-1 [319.811551] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [319.819263] Starting dynamic subtest: pipe-C-eDP-1 [319.821135] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [319.828282] Starting dynamic subtest: pipe-D-eDP-1 [319.830205] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [319.832467] Subtest bad-vsync-end: SUCCESS (0.336s) [320.689656] [075/134] (703s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa [320.758770] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled [320.761056] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.000s) [320.866054] [076/134] (703s left) gem_mmap_offset (pf-nonblock) [320.927365] Starting subtest: pf-nonblock [320.932340] Subtest pf-nonblock: SUCCESS (0.005s) [321.091508] [077/134] (703s left) gem_wait (write-wait) [321.158765] Starting subtest: write-wait [321.161049] Starting dynamic subtest: all-engines [322.300703] Dynamic subtest all-engines: SUCCESS (1.141s) [322.315232] Starting dynamic subtest: rcs0 [323.360326] Dynamic subtest rcs0: SUCCESS (1.057s) [323.376040] Starting dynamic subtest: bcs0 [324.417278] Dynamic subtest bcs0: SUCCESS (1.056s) [324.433060] Starting dynamic subtest: vcs0 [325.471372] Dynamic subtest vcs0: SUCCESS (1.052s) [325.486902] Starting dynamic subtest: vcs1 [326.525055] Dynamic subtest vcs1: SUCCESS (1.051s) [326.540445] Starting dynamic subtest: vecs0 [327.579535] Dynamic subtest vecs0: SUCCESS (1.052s) [327.595388] Starting dynamic subtest: ccs0 [328.634932] Dynamic subtest ccs0: SUCCESS (1.054s) [328.637390] Subtest write-wait: SUCCESS (7.477s) [328.846913] [078/134] (695s left) perf_pmu (gt-awake) [328.887092] Starting subtest: gt-awake [337.944542] Subtest gt-awake: SUCCESS (9.056s) [338.074410] [079/134] (686s left) kms_content_protection (suspend-resume) [338.211829] Starting subtest: suspend-resume [338.216365] Subtest suspend-resume: SKIP (0.000s) [338.355505] [080/134] (686s left) api_intel_allocator (simple-allocator) [338.414544] Starting subtest: simple-allocator [338.416941] Starting dynamic subtest: basic [338.419181] Dynamic subtest basic: SUCCESS (0.003s) [338.431271] Starting dynamic subtest: parallel-one [338.594975] Dynamic subtest parallel-one: SUCCESS (0.178s) [338.603437] Starting dynamic subtest: print [338.605664] Dynamic subtest print: SUCCESS (0.000s) [338.613562] Starting dynamic subtest: reuse [338.615787] Dynamic subtest reuse: SUCCESS (0.000s) [338.623387] Starting dynamic subtest: reserve [338.625625] Dynamic subtest reserve: SUCCESS (0.000s) [338.633546] Starting dynamic subtest: fork-reopen-allocator [338.635767] Dynamic subtest fork-reopen-allocator: SUCCESS (0.014s) [338.638055] Subtest simple-allocator: SUCCESS (0.200s) [338.779671] [081/134] (685s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render) [338.877469] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render [338.881876] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s) [338.993582] [082/134] (685s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip) [339.088614] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip [339.093057] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s) [339.221653] [083/134] (685s left) prime_mmap (test_correct) [339.284012] Starting subtest: test_correct [339.285922] Starting dynamic subtest: test_correct-smem [339.335695] Dynamic subtest test_correct-smem: SUCCESS (0.053s) [339.338222] Subtest test_correct: SUCCESS (0.054s) [339.442676] [084/134] (685s left) syncobj_wait (multi-wait-all-for-submit-signaled) [339.508618] Starting subtest: multi-wait-all-for-submit-signaled [339.510858] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.000s) [339.633579] [085/134] (685s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt) [339.746015] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt [344.163923] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.424s) [345.380383] [086/134] (679s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling) [345.491810] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling [345.496227] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s) [345.571453] [087/134] (679s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling) [345.671851] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling [345.676107] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.000s) [345.753975] [088/134] (679s left) kms_flip (plain-flip-ts-check-interruptible) [345.851752] Starting subtest: plain-flip-ts-check-interruptible [345.854064] Starting dynamic subtest: A-eDP1 [354.722803] Dynamic subtest A-eDP1: SUCCESS (8.869s) [354.733750] Starting dynamic subtest: B-eDP1 [363.522799] Dynamic subtest B-eDP1: SUCCESS (8.797s) [363.530990] Starting dynamic subtest: C-eDP1 [372.310141] Dynamic subtest C-eDP1: SUCCESS (8.784s) [372.321410] Starting dynamic subtest: D-eDP1 [381.107172] Dynamic subtest D-eDP1: SUCCESS (8.796s) [381.112660] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.259s) [382.370184] [089/134] (642s left) gem_mmap_offset (partial-remap) [382.420973] Starting subtest: partial-remap [382.423357] Starting dynamic subtest: smem0 [382.434911] Dynamic subtest smem0: SUCCESS (0.005s) [382.437168] Subtest partial-remap: SUCCESS (0.007s) [382.584251] [090/134] (642s left) perf (sysctl-defaults) [382.659564] Starting subtest: sysctl-defaults [382.661923] Subtest sysctl-defaults: SUCCESS (0.000s) [382.715919] [091/134] (642s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt) [382.816496] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt [387.229401] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (4.416s) [388.395370] [092/134] (636s left) kms_pm_rpm (basic-rte) [388.435171] Starting subtest: basic-rte [391.491664] Subtest basic-rte: SUCCESS (3.057s) [393.008984] [093/134] (632s left) kms_ccs (crc-sprite-planes-basic-yf-tiled-ccs) [393.112123] Starting subtest: crc-sprite-planes-basic-yf-tiled-ccs [393.114476] Starting dynamic subtest: pipe-A-eDP-1 [393.174854] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [393.189618] Starting dynamic subtest: pipe-B-eDP-1 [393.248555] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [393.258866] Starting dynamic subtest: pipe-C-eDP-1 [393.315745] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [393.326083] Starting dynamic subtest: pipe-D-eDP-1 [393.385630] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [393.390337] Subtest crc-sprite-planes-basic-yf-tiled-ccs: SKIP (0.009s) [395.368906] [094/134] (629s left) kms_lease (implicit-plane-lease) [395.466345] Starting subtest: implicit-plane-lease [395.471078] Subtest implicit-plane-lease: SUCCESS (0.003s) [395.595880] [095/134] (629s left) gem_exec_gttfill (engines) [395.661207] Starting subtest: engines [395.663368] Starting dynamic subtest: rcs0 [418.587672] Dynamic subtest rcs0: SUCCESS (22.928s) [418.598893] Starting dynamic subtest: bcs0 [441.957690] Dynamic subtest bcs0: SUCCESS (23.367s) [441.968995] Starting dynamic subtest: vcs0 [465.268036] Dynamic subtest vcs0: SUCCESS (23.308s) [465.284062] Starting dynamic subtest: vcs1 [488.600796] Dynamic subtest vcs1: SUCCESS (23.330s) [488.612554] Starting dynamic subtest: vecs0 [511.943363] Dynamic subtest vecs0: SUCCESS (23.339s) [511.960099] Starting dynamic subtest: ccs0 [535.270678] Dynamic subtest ccs0: SUCCESS (23.324s) [535.273244] Subtest engines: SUCCESS (139.610s) [535.474460] [096/134] (489s left) gem_exec_store (cachelines) [535.583431] Starting subtest: cachelines [535.585672] Starting dynamic subtest: rcs0 [535.695981] Dynamic subtest rcs0: SUCCESS (0.112s) [535.707219] Starting dynamic subtest: bcs0 [535.763025] Dynamic subtest bcs0: SUCCESS (0.065s) [535.774897] Starting dynamic subtest: vcs0 [535.825024] Dynamic subtest vcs0: SUCCESS (0.060s) [535.836166] Starting dynamic subtest: vcs1 [535.881036] Dynamic subtest vcs1: SUCCESS (0.054s) [535.892056] Starting dynamic subtest: vecs0 [535.951820] Dynamic subtest vecs0: SUCCESS (0.070s) [535.963181] Starting dynamic subtest: ccs0 [536.019787] Dynamic subtest ccs0: SUCCESS (0.066s) [536.022176] Subtest cachelines: SUCCESS (0.438s) [536.215437] [097/134] (489s left) kms_big_fb (x-tiled-addfb-size-overflow) [536.344393] Starting subtest: x-tiled-addfb-size-overflow [536.346567] Subtest x-tiled-addfb-size-overflow: SUCCESS (0.000s) [536.470719] [098/134] (488s left) syncobj_timeline (etime-single-wait-available-unsubmitted) [536.532245] Starting subtest: etime-single-wait-available-unsubmitted [536.642118] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.107s) [536.729046] [099/134] (488s left) gem_exec_reloc (basic-softpin) [536.797262] Subtest basic-softpin: SKIP (0.000s) [536.872406] [100/134] (488s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation) [536.974882] Starting subtest: plane-scaler-with-clipping-clamping-rotation [536.977139] Starting dynamic subtest: pipe-A [537.270191] Dynamic subtest pipe-A: SUCCESS (0.296s) [537.278858] Starting dynamic subtest: pipe-B [538.587936] Dynamic subtest pipe-B: SUCCESS (1.317s) [538.597638] Starting dynamic subtest: pipe-C [539.886985] Dynamic subtest pipe-C: SUCCESS (1.298s) [539.896535] Starting dynamic subtest: pipe-D [541.200532] Dynamic subtest pipe-D: SUCCESS (1.312s) [541.202836] Subtest plane-scaler-with-clipping-clamping-rotation: SUCCESS (4.227s) [542.354545] [101/134] (483s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt) [542.453668] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt [549.806364] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.354s) [549.966389] [102/134] (475s left) gem_ctx_persistence (heartbeat-many) [550.038726] Starting subtest: heartbeat-many [550.043309] Subtest heartbeat-many: SKIP (0.000s) [550.146118] [103/134] (475s left) i915_query (query-topology-garbage-items) [550.207044] Starting subtest: query-topology-garbage-items [550.209198] Subtest query-topology-garbage-items: SUCCESS (0.000s) [550.326437] [104/134] (475s left) prime_vgem (sync) [550.409423] Starting subtest: sync [550.411680] Starting dynamic subtest: rcs0 [550.477487] Dynamic subtest rcs0: SUCCESS (0.069s) [550.486741] Starting dynamic subtest: bcs0 [550.561662] Dynamic subtest bcs0: SUCCESS (0.083s) [550.570405] Starting dynamic subtest: vcs0 [550.609052] Dynamic subtest vcs0: SUCCESS (0.046s) [550.617759] Starting dynamic subtest: vcs1 [550.653738] Dynamic subtest vcs1: SUCCESS (0.044s) [550.662548] Starting dynamic subtest: vecs0 [550.698831] Dynamic subtest vecs0: SUCCESS (0.044s) [550.707790] Starting dynamic subtest: ccs0 [550.744608] Dynamic subtest ccs0: SUCCESS (0.045s) [550.746528] Subtest sync: SUCCESS (0.337s) [550.895438] [105/134] (474s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers) [550.990579] Starting subtest: plane-upscale-factor-0-25-with-modifiers [550.992480] Starting dynamic subtest: pipe-A [551.326709] Dynamic subtest pipe-A: SUCCESS (0.338s) [551.337132] Starting dynamic subtest: pipe-B [552.694365] Dynamic subtest pipe-B: SUCCESS (1.366s) [552.703179] Starting dynamic subtest: pipe-C [554.116807] Dynamic subtest pipe-C: SUCCESS (1.422s) [554.125765] Starting dynamic subtest: pipe-D [555.542261] Dynamic subtest pipe-D: SUCCESS (1.425s) [555.544530] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.554s) [556.754919] [106/134] (468s left) kms_frontbuffer_tracking (fbc-abgr161616f-draw-mmap-cpu) [556.867332] Starting subtest: fbc-abgr161616f-draw-mmap-cpu [556.871834] Subtest fbc-abgr161616f-draw-mmap-cpu: SKIP (0.000s) [557.004712] [107/134] (468s left) gem_exec_balancer (persistence) [557.278428] Starting subtest: persistence [558.140445] Subtest persistence: SUCCESS (0.861s) [558.295728] [108/134] (467s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw) [558.407950] Starting subtest: fbc-2p-pri-indfb-multidraw [558.412325] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s) [558.526926] [109/134] (467s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move) [558.627606] Starting subtest: psr-2p-primscrn-cur-indfb-move [558.631998] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s) [558.754458] [110/134] (467s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render) [558.853547] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render [558.858052] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s) [558.968220] [111/134] (467s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [559.083336] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip [559.918932] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.837s) [560.138784] [112/134] (465s left) gem_create (create-valid-nonaligned) [560.200683] Starting subtest: create-valid-nonaligned [560.202837] Subtest create-valid-nonaligned: SUCCESS (0.000s) [560.398121] [113/134] (465s left) i915_drm_fdinfo (busy-idle) [560.435362] Starting subtest: busy-idle [560.437591] Starting dynamic subtest: rcs0 [560.465090] Dynamic subtest rcs0: SKIP (0.029s) [560.474697] Starting dynamic subtest: bcs0 [560.478933] Dynamic subtest bcs0: SKIP (0.001s) [560.487513] Starting dynamic subtest: vcs0 [560.491927] Dynamic subtest vcs0: SKIP (0.001s) [560.500697] Starting dynamic subtest: vcs1 [560.504864] Dynamic subtest vcs1: SKIP (0.000s) [560.513230] Starting dynamic subtest: vecs0 [560.517338] Dynamic subtest vecs0: SKIP (0.000s) [560.525880] Starting dynamic subtest: ccs0 [560.530074] Dynamic subtest ccs0: SKIP (0.000s) [560.534183] Subtest busy-idle: SKIP (0.038s) [560.573470] [114/134] (465s left) kms_cursor_legacy (cursorb-vs-flipa-atomic) [560.688957] Starting subtest: cursorB-vs-flipA-atomic [560.694401] Subtest cursorB-vs-flipA-atomic: SKIP (0.002s) [560.842970] [115/134] (465s left) gem_softpin (softpin) [560.904415] Starting subtest: softpin [593.294264] Subtest softpin: SUCCESS (32.386s) [593.446326] [116/134] (432s left) gem_set_tiling_vs_blt (tiled-to-untiled) [593.508084] Subtest tiled-to-untiled: SKIP (0.000s) [593.596932] [117/134] (432s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier) [593.703141] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier [593.728908] Starting dynamic subtest: pipe-A-plane-0 [593.733338] Dynamic subtest pipe-A-plane-0: SKIP (0.000s) [593.744064] Starting dynamic subtest: pipe-A-plane-3 [593.749024] Dynamic subtest pipe-A-plane-3: SKIP (0.000s) [593.757619] Starting dynamic subtest: pipe-A-plane-5 [593.761753] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [594.797640] Starting dynamic subtest: pipe-B-plane-0 [594.802192] Dynamic subtest pipe-B-plane-0: SKIP (0.000s) [594.810700] Starting dynamic subtest: pipe-B-plane-3 [594.815309] Dynamic subtest pipe-B-plane-3: SKIP (0.000s) [594.824057] Starting dynamic subtest: pipe-B-plane-5 [594.828204] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [595.100886] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier: SKIP (1.397s) [595.943973] [118/134] (430s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt) [596.047473] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt [596.051857] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s) [596.180693] [119/134] (430s left) kms_big_fb (4-tiled-8bpp-rotate-90) [596.278065] Starting subtest: 4-tiled-8bpp-rotate-90 [596.298711] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.020s) [596.423221] [120/134] (429s left) kms_color (invalid-ctm-matrix-sizes) [596.517061] Starting subtest: invalid-ctm-matrix-sizes [596.519336] Starting dynamic subtest: pipe-A [596.521567] Dynamic subtest pipe-A: SUCCESS (0.002s) [596.530230] Starting dynamic subtest: pipe-B [596.532365] Dynamic subtest pipe-B: SUCCESS (0.002s) [596.540718] Starting dynamic subtest: pipe-C [596.542999] Dynamic subtest pipe-C: SUCCESS (0.003s) [596.550956] Starting dynamic subtest: pipe-D [596.553311] Dynamic subtest pipe-D: SUCCESS (0.003s) [596.555511] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.013s) [596.608735] [121/134] (429s left) kms_chamelium_hpd (dp-hpd-after-suspend) [596.999644] Subtest dp-hpd-after-suspend: SKIP (0.000s) [597.815878] [122/134] (428s left) kms_rmfb (close-fd) [597.928119] Starting subtest: close-fd [597.930455] Starting dynamic subtest: pipe-A-eDP-1 [598.036349] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.107s) [598.045511] Starting dynamic subtest: pipe-B-eDP-1 [599.182250] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.145s) [599.192754] Starting dynamic subtest: pipe-C-eDP-1 [600.353944] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.171s) [600.363077] Starting dynamic subtest: pipe-D-eDP-1 [601.560973] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.206s) [601.563334] Subtest close-fd: SUCCESS (3.633s) [602.747793] [123/134] (423s left) kms_busy (extended-modeset-hang-newfb-with-reset) [602.864078] Starting subtest: extended-modeset-hang-newfb-with-reset [602.866449] Starting dynamic subtest: pipe-A [616.959381] Dynamic subtest pipe-A: SUCCESS (14.092s) [616.969168] Starting dynamic subtest: pipe-D [633.075244] Dynamic subtest pipe-D: SUCCESS (16.115s) [633.077905] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (30.211s) [633.964601] [124/134] (392s left) perf_pmu (busy-accuracy-50) [634.004340] Starting subtest: busy-accuracy-50 [634.006691] Starting dynamic subtest: rcs0 [635.535031] Dynamic subtest rcs0: SUCCESS (1.530s) [635.546678] Starting dynamic subtest: bcs0 [637.074543] Dynamic subtest bcs0: SUCCESS (1.537s) [637.086309] Starting dynamic subtest: vcs0 [638.618865] Dynamic subtest vcs0: SUCCESS (1.542s) [638.630730] Starting dynamic subtest: vcs1 [640.156937] Dynamic subtest vcs1: SUCCESS (1.536s) [640.168772] Starting dynamic subtest: vecs0 [641.699741] Dynamic subtest vecs0: SUCCESS (1.540s) [641.711475] Starting dynamic subtest: ccs0 [643.240957] Dynamic subtest ccs0: SUCCESS (1.539s) [643.243411] Subtest busy-accuracy-50: SUCCESS (9.238s) [643.398204] [125/134] (383s left) gem_lmem_evict (dontneed-evict-race) [643.441910] Subtest dontneed-evict-race: SKIP (0.000s) [643.490441] [126/134] (383s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs) [643.590742] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs [643.593030] Starting dynamic subtest: pipe-A-eDP-1 [643.601813] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [643.611615] Starting dynamic subtest: pipe-B-eDP-1 [643.620150] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [643.629056] Starting dynamic subtest: pipe-C-eDP-1 [643.637664] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [643.646061] Starting dynamic subtest: pipe-D-eDP-1 [643.654183] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [643.658227] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s) [645.837955] [127/134] (380s left) i915_pm_rpm (system-suspend-devices) [648.092090] Starting subtest: system-suspend-devices [655.866352] Subtest system-suspend-devices: SUCCESS (7.773s) [656.258476] [128/134] (370s left) syncobj_wait (wait-any-complex) [656.332461] Starting subtest: wait-any-complex [656.391316] Subtest wait-any-complex: SUCCESS (0.062s) [656.482193] [129/134] (370s left) kms_vblank (wait-forked) [656.579873] Starting subtest: wait-forked [656.582060] Starting dynamic subtest: pipe-A-eDP-1 [658.414223] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.832s) [658.429439] Starting dynamic subtest: pipe-D-eDP-1 [660.904140] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.487s) [660.906499] Subtest wait-forked: SUCCESS (4.323s) [661.754127] [130/134] (364s left) gem_exec_balancer (noheartbeat) [662.007632] Starting subtest: noheartbeat [662.012087] Subtest noheartbeat: SKIP (0.000s) [662.130942] [131/134] (364s left) kms_psr (fbc-psr2-cursor-mmap-cpu) [662.223977] Starting subtest: fbc-psr2-cursor-mmap-cpu [662.226348] Starting dynamic subtest: eDP-1 [662.230725] Dynamic subtest eDP-1: SKIP (0.000s) [662.235243] Subtest fbc-psr2-cursor-mmap-cpu: SKIP (0.001s) [662.304477] [132/134] (364s left) kms_getfb (getfb2-handle-not-fb) [662.397287] Starting subtest: getfb2-handle-not-fb [662.399659] Subtest getfb2-handle-not-fb: SUCCESS (0.000s) [662.515054] [133/134] (364s left) syncobj_wait (wait-for-submit-snapshot) [662.574400] Starting subtest: wait-for-submit-snapshot [662.654650] Subtest wait-for-submit-snapshot: SUCCESS (0.081s) [662.744894] [134/134] (364s left) kms_addfb_basic (size-max) [662.834217] Starting subtest: size-max [662.836269] Subtest size-max: SUCCESS (0.000s) [662.955667] 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.