[58.310604] Initializing watchdogs [58.310658] /dev/watchdog0 [58.323739] [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] [58.327899] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [58.330105] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [58.333220] [001/131] (960s left) kms_atomic (atomic-invalid-params) [58.468864] Starting subtest: atomic-invalid-params [58.471167] Starting dynamic subtest: pipe-A-eDP-1 [58.914898] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.447s) [58.916779] Subtest atomic-invalid-params: SUCCESS (0.448s) [59.722369] [002/131] (959s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-cpu) [59.824927] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-cpu [66.836968] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (7.024s) [66.982745] [003/131] (951s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs) [67.362420] Starting subtest: crc-primary-suspend-yf-tiled-ccs [67.364886] Starting dynamic subtest: pipe-A-eDP-1 [67.374635] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [67.384088] Starting dynamic subtest: pipe-B-eDP-1 [67.393829] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [67.401501] Starting dynamic subtest: pipe-C-eDP-1 [67.410447] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [67.417467] Starting dynamic subtest: pipe-D-eDP-1 [67.426466] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [67.431033] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.006s) [69.674559] [004/131] (949s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted) [69.723736] Starting subtest: etime-single-wait-for-submit-available-unsubmitted [69.825515] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.101s) [69.922977] [005/131] (949s left) kms_big_fb (x-tiled-16bpp-rotate-180) [70.021045] Starting subtest: x-tiled-16bpp-rotate-180 [71.242211] Subtest x-tiled-16bpp-rotate-180: SUCCESS (1.222s) [71.416399] [006/131] (947s left) kms_big_fb (yf-tiled-32bpp-rotate-270) [71.526035] Starting subtest: yf-tiled-32bpp-rotate-270 [71.529496] Subtest yf-tiled-32bpp-rotate-270: SKIP (0.000s) [71.644121] [007/131] (947s left) kms_feature_discovery (psr1) [71.738932] Starting subtest: psr1 [71.740799] Subtest psr1: SUCCESS (0.000s) [71.829760] [008/131] (947s left) gen9_exec_parse (bb-start-out) [71.894357] Subtest bb-start-out: SKIP (0.000s) [71.975054] [009/131] (947s left) sw_sync (sync_merge_same) [72.004879] Starting subtest: sync_merge_same [72.006799] Subtest sync_merge_same: SUCCESS (0.000s) [72.074363] [010/131] (947s left) kms_lease (lease-invalid-plane) [72.171732] Starting subtest: lease-invalid-plane [72.173616] Starting dynamic subtest: pipe-A-eDP-1 [72.175771] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [72.183897] Starting dynamic subtest: pipe-B-eDP-1 [72.185654] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [72.192396] Starting dynamic subtest: pipe-C-eDP-1 [72.194051] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [72.200947] Starting dynamic subtest: pipe-D-eDP-1 [72.202650] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [72.204424] Subtest lease-invalid-plane: SUCCESS (0.002s) [72.263736] [011/131] (946s left) gem_pwrite (basic-random) [72.327091] Subtest basic-random: SKIP (0.000s) [72.391880] [012/131] (946s left) kms_psr (psr-sprite-mmap-cpu) [72.495197] Starting subtest: psr-sprite-mmap-cpu [72.497133] Starting dynamic subtest: eDP-1 [74.276787] Dynamic subtest eDP-1: SUCCESS (1.781s) [74.279235] Subtest psr-sprite-mmap-cpu: SUCCESS (1.782s) [75.146384] [013/131] (944s left) i915_drm_fdinfo (busy) [75.185875] Starting subtest: busy [75.188570] Starting dynamic subtest: rcs0 [75.228435] Dynamic subtest rcs0: SKIP (0.040s) [75.235702] Starting dynamic subtest: bcs0 [75.239866] Dynamic subtest bcs0: SKIP (0.001s) [75.246735] Starting dynamic subtest: vcs0 [75.250727] Dynamic subtest vcs0: SKIP (0.001s) [75.257786] Starting dynamic subtest: vcs1 [75.262098] Dynamic subtest vcs1: SKIP (0.000s) [75.269108] Starting dynamic subtest: vecs0 [75.273641] Dynamic subtest vecs0: SKIP (0.001s) [75.282866] Starting dynamic subtest: ccs0 [75.287174] Dynamic subtest ccs0: SKIP (0.001s) [75.291438] Subtest busy: SKIP (0.046s) [75.327078] [014/131] (943s left) gem_exec_whisper (basic-forked-all) [75.398610] Starting subtest: basic-forked-all [88.923614] Subtest basic-forked-all: SUCCESS (13.521s) [89.135308] [015/131] (930s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-pwrite) [89.249655] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-pwrite [89.253993] Subtest fbc-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [89.387895] [016/131] (930s left) kms_frontbuffer_tracking (psr-1p-rte) [89.493682] Starting subtest: psr-1p-rte [94.884094] Subtest psr-1p-rte: SUCCESS (5.394s) [95.049396] [017/131] (924s left) kms_cursor_crc (cursor-random-max-size) [95.346347] Starting subtest: cursor-random-max-size [95.352882] Subtest cursor-random-max-size: SKIP (0.000s) [95.515348] [018/131] (923s left) kms_getfb (getfb-handle-protection) [95.604081] Starting subtest: getfb-handle-protection [95.630706] Subtest getfb-handle-protection: SUCCESS (0.028s) [95.783244] [019/131] (923s left) syncobj_timeline (wait-for-submit-delayed-submit) [95.830501] Starting subtest: wait-for-submit-delayed-submit [95.935295] Subtest wait-for-submit-delayed-submit: SUCCESS (0.103s) [96.038373] [020/131] (923s left) kms_vblank (query-forked-busy-hang) [96.124909] Starting subtest: query-forked-busy-hang [96.127276] Starting dynamic subtest: pipe-A-eDP-1 [122.662568] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.536s) [122.676992] Starting dynamic subtest: pipe-D-eDP-1 [147.667067] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.001s) [147.669417] Subtest query-forked-busy-hang: SUCCESS (51.541s) [148.506642] [021/131] (871s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc) [148.601015] Starting subtest: fbcpsr-rgb565-draw-mmap-wc [155.552918] Subtest fbcpsr-rgb565-draw-mmap-wc: SUCCESS (6.954s) [155.698847] [022/131] (863s left) gem_ctx_shared (q-promotion) [155.762359] Starting subtest: Q-promotion [155.764631] Starting dynamic subtest: rcs0 [155.906817] Dynamic subtest rcs0: SUCCESS (0.142s) [155.922385] Starting dynamic subtest: vcs0 [155.990072] Dynamic subtest vcs0: SUCCESS (0.083s) [156.005967] Starting dynamic subtest: vcs1 [156.065886] Dynamic subtest vcs1: SUCCESS (0.075s) [156.081683] Starting dynamic subtest: vecs0 [156.138024] Dynamic subtest vecs0: SUCCESS (0.072s) [156.154797] Starting dynamic subtest: ccs0 [156.218872] Dynamic subtest ccs0: SUCCESS (0.080s) [156.221791] Subtest Q-promotion: SUCCESS (0.456s) [158.037642] [FACT gem_ctx_shared (q-promotion)] new: kernel.kmod_is_loaded.vgem: true [158.040971] [023/131] (861s left) kms_flip (plain-flip-ts-check) [158.136237] Starting subtest: plain-flip-ts-check [158.138561] Starting dynamic subtest: A-eDP1 [166.997711] Dynamic subtest A-eDP1: SUCCESS (8.859s) [167.011182] Starting dynamic subtest: B-eDP1 [175.836305] Dynamic subtest B-eDP1: SUCCESS (8.836s) [175.846728] Starting dynamic subtest: C-eDP1 [184.659727] Dynamic subtest C-eDP1: SUCCESS (8.822s) [184.671178] Starting dynamic subtest: D-eDP1 [193.485621] Dynamic subtest D-eDP1: SUCCESS (8.825s) [193.491360] Subtest plain-flip-ts-check: SUCCESS (35.355s) [194.688161] [024/131] (825s left) gem_ctx_persistence (engines-cleanup) [194.745065] Starting subtest: engines-cleanup [194.747326] Starting dynamic subtest: rcs0 [194.861737] Dynamic subtest rcs0: SUCCESS (0.116s) [194.872814] Starting dynamic subtest: bcs0 [194.886556] Dynamic subtest bcs0: SUCCESS (0.024s) [194.895612] Starting dynamic subtest: vcs0 [194.990867] Dynamic subtest vcs0: SUCCESS (0.104s) [195.001610] Starting dynamic subtest: vcs1 [195.052519] Dynamic subtest vcs1: SUCCESS (0.061s) [195.063709] Starting dynamic subtest: vecs0 [195.123855] Dynamic subtest vecs0: SUCCESS (0.070s) [195.134819] Starting dynamic subtest: ccs0 [195.150325] Dynamic subtest ccs0: SUCCESS (0.026s) [195.152621] Subtest engines-cleanup: SUCCESS (0.406s) [195.313916] [025/131] (824s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary) [195.415428] Starting subtest: psr-shrfb-scaledprimary [201.168813] Subtest psr-shrfb-scaledprimary: SUCCESS (5.754s) [201.334915] [026/131] (818s left) syncobj_timeline (signal) [201.387036] Starting subtest: signal [201.388963] Subtest signal: SUCCESS (0.000s) [201.514221] [027/131] (818s left) kms_plane_scaling (invalid-num-scalers) [201.603335] Starting subtest: invalid-num-scalers [201.605596] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers [201.619523] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.017s) [201.628031] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers [201.650966] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.030s) [201.658873] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers [201.682419] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.030s) [201.690296] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers [201.713423] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.030s) [201.715724] Subtest invalid-num-scalers: SUCCESS (0.112s) [201.847301] [028/131] (818s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted) [201.899113] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted [202.004092] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.103s) [202.098863] [029/131] (817s left) gen3_render_linear_blits [202.244124] [030/131] (817s left) gem_exec_schedule (in-order) [202.326446] Starting subtest: in-order [202.328733] Starting dynamic subtest: rcs0 [202.421580] Dynamic subtest rcs0: SUCCESS (0.099s) [202.433198] Starting dynamic subtest: vcs0 [202.500956] Dynamic subtest vcs0: SUCCESS (0.080s) [202.512904] Starting dynamic subtest: vcs1 [202.577018] Dynamic subtest vcs1: SUCCESS (0.075s) [202.589336] Starting dynamic subtest: vecs0 [202.650254] Dynamic subtest vecs0: SUCCESS (0.072s) [202.662704] Starting dynamic subtest: ccs0 [202.728825] Dynamic subtest ccs0: SUCCESS (0.078s) [202.731852] Subtest in-order: SUCCESS (0.407s) [204.067303] [031/131] (815s left) kms_big_fb (linear-16bpp-rotate-180) [204.176316] Starting subtest: linear-16bpp-rotate-180 [205.576814] Subtest linear-16bpp-rotate-180: SUCCESS (1.400s) [205.719947] [032/131] (814s left) i915_suspend (basic-s3-without-i915) [205.752280] Starting subtest: basic-s3-without-i915 [209.194516] Subtest basic-s3-without-i915: SKIP (3.437s) [210.773438] [033/131] (809s left) gem_tiled_pread_pwrite [210.905293] [034/131] (809s left) gem_exec_params (cliprects-invalid) [210.983422] Starting subtest: cliprects-invalid [210.985708] Subtest cliprects-invalid: SUCCESS (0.000s) [211.119713] [035/131] (809s left) syncobj_wait (single-wait-for-submit-unsubmitted) [211.177305] Starting subtest: single-wait-for-submit-unsubmitted [211.281270] Subtest single-wait-for-submit-unsubmitted: SUCCESS (0.104s) [211.379718] [036/131] (808s left) kms_big_fb (y-tiled-16bpp-rotate-90) [211.482493] Starting subtest: y-tiled-16bpp-rotate-90 [211.486695] Subtest y-tiled-16bpp-rotate-90: SKIP (0.000s) [211.622929] [037/131] (808s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt) [211.715633] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt [211.719759] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s) [211.833913] [038/131] (808s left) gem_spin_batch (legacy-resubmit) [211.890270] Starting subtest: legacy-resubmit [211.892682] Starting dynamic subtest: default [211.899285] Dynamic subtest default: SUCCESS (0.008s) [211.910442] Starting dynamic subtest: render [211.912650] Dynamic subtest render: SUCCESS (0.003s) [211.920475] Starting dynamic subtest: bsd [211.922345] Dynamic subtest bsd: SUCCESS (0.002s) [211.929378] Starting dynamic subtest: bsd1 [211.931311] Dynamic subtest bsd1: SUCCESS (0.002s) [211.938959] Starting dynamic subtest: bsd2 [211.941067] Dynamic subtest bsd2: SUCCESS (0.001s) [211.949329] Starting dynamic subtest: blt [211.951256] Dynamic subtest blt: SUCCESS (0.002s) [211.958710] Starting dynamic subtest: vebox [211.960956] Dynamic subtest vebox: SUCCESS (0.003s) [211.963202] Subtest legacy-resubmit: SUCCESS (0.026s) [212.187996] [039/131] (808s left) perf_pmu (busy-start) [212.233543] Starting subtest: busy-start [212.235749] Starting dynamic subtest: rcs0 [214.783336] Dynamic subtest rcs0: SUCCESS (2.550s) [214.793079] Starting dynamic subtest: bcs0 [217.334342] Dynamic subtest bcs0: SUCCESS (2.549s) [217.343939] Starting dynamic subtest: vcs0 [220.887277] Dynamic subtest vcs0: SUCCESS (3.550s) [220.896064] Starting dynamic subtest: vcs1 [224.917269] Dynamic subtest vcs1: SUCCESS (4.028s) [224.927782] Starting dynamic subtest: vecs0 [228.885478] Dynamic subtest vecs0: SUCCESS (3.967s) [228.896615] Starting dynamic subtest: ccs0 [231.435325] Dynamic subtest ccs0: SUCCESS (2.549s) [231.438392] Subtest busy-start: SUCCESS (19.202s) [231.575655] [040/131] (788s left) perf (invalid-oa-metric-set-id) [231.723494] Starting subtest: invalid-oa-metric-set-id [231.735064] Subtest invalid-oa-metric-set-id: SUCCESS (0.013s) [231.773870] [041/131] (788s left) gem_exec_schedule (thriceslice) [231.855198] Starting subtest: thriceslice [231.857120] Starting dynamic subtest: rcs0 [231.903684] Dynamic subtest rcs0: SUCCESS (0.055s) [231.914435] Starting dynamic subtest: bcs0 [231.939971] Dynamic subtest bcs0: SUCCESS (0.035s) [231.947745] Starting dynamic subtest: vcs0 [231.970374] Dynamic subtest vcs0: SUCCESS (0.030s) [231.977924] Starting dynamic subtest: vcs1 [232.025662] Dynamic subtest vcs1: SUCCESS (0.054s) [232.037704] Starting dynamic subtest: vecs0 [232.057096] Dynamic subtest vecs0: SUCCESS (0.031s) [232.065355] Starting dynamic subtest: ccs0 [232.090154] Dynamic subtest ccs0: SUCCESS (0.033s) [232.092320] Subtest thriceslice: SUCCESS (0.243s) [234.008544] [042/131] (786s left) gem_lmem_swapping (heavy-verify-random) [234.054507] Subtest heavy-verify-random: SKIP (0.000s) [234.103834] [043/131] (786s left) syncobj_wait (wait-all-snapshot) [234.159311] Starting subtest: wait-all-snapshot [234.239559] Subtest wait-all-snapshot: SUCCESS (0.081s) [234.339537] [044/131] (786s left) syncobj_timeline (wait-zero-handles) [234.405744] Starting subtest: wait-zero-handles [234.408081] Subtest wait-zero-handles: SUCCESS (0.000s) [234.525197] [045/131] (786s left) kms_vblank (query-idle-hang) [234.617991] Starting subtest: query-idle-hang [234.620342] Starting dynamic subtest: pipe-A-eDP-1 [260.715692] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.094s) [260.735323] Starting dynamic subtest: pipe-D-eDP-1 [285.645193] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.926s) [285.647171] Subtest query-idle-hang: SUCCESS (51.023s) [286.495389] [046/131] (734s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions-varying-size) [286.620983] Starting subtest: cursorB-vs-flipB-atomic-transitions-varying-size [286.625495] Subtest cursorB-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s) [286.787101] [047/131] (733s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-render) [286.900816] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-render [290.606607] Subtest fbc-1p-primscrn-spr-indfb-draw-render: SUCCESS (3.708s) [291.802777] [048/131] (728s left) kms_chamelium_hpd (dp-hpd-with-enabled-mode) [292.200811] Subtest dp-hpd-with-enabled-mode: SKIP (0.000s) [292.975805] [049/131] (727s left) kms_big_fb (4-tiled-64bpp-rotate-180) [293.077999] Starting subtest: 4-tiled-64bpp-rotate-180 [294.557074] Subtest 4-tiled-64bpp-rotate-180: SUCCESS (1.478s) [294.762945] [050/131] (725s left) kms_fence_pin_leak [294.945090] [051/131] (725s left) gem_tiling_max_stride [295.071998] [052/131] (725s left) kms_invalid_mode (int-max-clock) [295.162340] Starting subtest: int-max-clock [295.164722] Starting dynamic subtest: pipe-A-eDP-1 [295.446917] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.283s) [295.455970] Starting dynamic subtest: pipe-B-eDP-1 [295.457984] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [295.465643] Starting dynamic subtest: pipe-C-eDP-1 [295.468038] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [295.475845] Starting dynamic subtest: pipe-D-eDP-1 [295.478244] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [295.480636] Subtest int-max-clock: SUCCESS (0.288s) [296.346591] [053/131] (724s left) i915_drm_fdinfo (virtual-idle) [296.391797] Starting subtest: virtual-idle [299.482517] Subtest virtual-idle: SUCCESS (3.086s) [299.576791] [054/131] (721s left) syncobj_wait (multi-wait-all-for-submit-signaled) [299.638302] Starting subtest: multi-wait-all-for-submit-signaled [299.640602] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.000s) [299.786351] [055/131] (721s left) gem_mmap_gtt (basic-small-copy) [299.849517] Subtest basic-small-copy: SKIP (0.000s) [299.918788] [056/131] (721s left) kms_flip (2x-flip-vs-wf_vblank-interruptible) [300.019315] Starting subtest: 2x-flip-vs-wf_vblank-interruptible [300.031368] Subtest 2x-flip-vs-wf_vblank-interruptible: SKIP (0.011s) [300.130925] [057/131] (720s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area) [305.085362] Starting subtest: psr2-primary-plane-update-sf-dmg-area [305.087569] Starting dynamic subtest: pipe-A-eDP-1 [311.695823] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.610s) [311.707464] Starting dynamic subtest: pipe-B-eDP-1 [318.315128] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.616s) [318.317459] Subtest psr2-primary-plane-update-sf-dmg-area: SUCCESS (13.231s) [319.222014] [058/131] (701s left) kms_psr (psr2-sprite-plane-onoff) [319.335350] Starting subtest: psr2-sprite-plane-onoff [319.337719] Starting dynamic subtest: eDP-1 [321.107383] Dynamic subtest eDP-1: SUCCESS (1.773s) [321.109783] Subtest psr2-sprite-plane-onoff: SUCCESS (1.774s) [321.996776] [059/131] (699s left) kms_flip (2x-wf_vblank-ts-check) [322.092539] Starting subtest: 2x-wf_vblank-ts-check [322.103270] Subtest 2x-wf_vblank-ts-check: SKIP (0.010s) [322.238237] [060/131] (698s left) kms_psr2_sf (pr-cursor-plane-update-sf) [327.225955] Starting subtest: pr-cursor-plane-update-sf [327.230542] Subtest pr-cursor-plane-update-sf: SKIP (0.002s) [328.111193] [061/131] (693s left) kms_chamelium_color (ctm-max) [328.221271] Subtest ctm-max: SKIP (0.000s) [328.265513] [062/131] (692s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move) [328.364645] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move [328.368744] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s) [328.512084] [063/131] (692s left) kms_content_protection (legacy) [328.658277] Starting subtest: legacy [328.662238] Subtest legacy: SKIP (0.000s) [328.824495] [064/131] (692s left) kms_psr (fbc-psr2-primary-render) [328.924176] Starting subtest: fbc-psr2-primary-render [328.926039] Starting dynamic subtest: eDP-1 [328.930077] Dynamic subtest eDP-1: SKIP (0.000s) [328.934147] Subtest fbc-psr2-primary-render: SKIP (0.001s) [329.022581] [065/131] (692s left) kms_properties (colorop-properties-atomic) [329.123222] Starting subtest: colorop-properties-atomic [329.124770] Starting dynamic subtest: pipe-A-eDP-1 [329.490741] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.368s) [329.499645] Starting dynamic subtest: pipe-B-eDP-1 [330.563850] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.070s) [330.572790] Starting dynamic subtest: pipe-C-eDP-1 [331.600946] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.038s) [331.610123] Starting dynamic subtest: pipe-D-eDP-1 [332.634822] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.030s) [332.636809] Subtest colorop-properties-atomic: SUCCESS (3.511s) [333.455411] [066/131] (687s left) gem_ringfill (engines-basic) [338.845396] Starting subtest: engines-basic [338.847817] Starting dynamic subtest: rcs0 [338.938738] Dynamic subtest rcs0: SUCCESS (0.096s) [338.959039] Starting dynamic subtest: bcs0 [338.994024] Dynamic subtest bcs0: SUCCESS (0.053s) [339.012669] Starting dynamic subtest: vcs0 [339.040163] Dynamic subtest vcs0: SUCCESS (0.044s) [339.057230] Starting dynamic subtest: vcs1 [339.086995] Dynamic subtest vcs1: SUCCESS (0.045s) [339.105158] Starting dynamic subtest: vecs0 [339.133031] Dynamic subtest vecs0: SUCCESS (0.044s) [339.150168] Starting dynamic subtest: ccs0 [339.184161] Dynamic subtest ccs0: SUCCESS (0.049s) [339.186862] Subtest engines-basic: SUCCESS (0.344s) [339.326793] [067/131] (682s left) gem_watchdog (default-virtual) [339.412333] Starting subtest: default-virtual [345.695995] Subtest default-virtual: SUCCESS (6.290s) [345.802240] [068/131] (675s left) kms_dp_aux_dev [346.179410] [069/131] (675s left) kms_chamelium_edid (hdmi-edid-read) [346.552422] Subtest hdmi-edid-read: SKIP (0.000s) [347.340715] [070/131] (674s left) kms_fbcon_fbt (psr) [347.393067] Starting subtest: psr [354.694703] Subtest psr: SUCCESS (7.297s) [354.778288] [071/131] (666s left) syncobj_timeline (invalid-transfer-illegal-handle) [354.842853] Starting subtest: invalid-transfer-illegal-handle [354.845185] Subtest invalid-transfer-illegal-handle: SUCCESS (0.000s) [354.949369] [072/131] (666s left) gem_exec_reloc (basic-write-cpu-noreloc) [355.019745] Subtest basic-write-cpu-noreloc: SKIP (0.000s) [355.105116] [073/131] (666s left) gem_workarounds (suspend-resume) [355.169142] Starting subtest: suspend-resume [370.970415] Subtest suspend-resume: SUCCESS (4.750s) [371.143887] [074/131] (650s left) kms_frontbuffer_tracking (fbcpsr-tiling-4) [371.263639] Starting subtest: fbcpsr-tiling-4 [378.302844] Subtest fbcpsr-tiling-4: SUCCESS (7.103s) [378.485871] [075/131] (643s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy) [378.617222] Starting subtest: 2x-flip-vs-cursor-legacy [378.621801] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.001s) [378.789559] [076/131] (643s left) gem_ctx_persistence (idempotent) [378.852264] Starting subtest: idempotent [378.854548] Subtest idempotent: SUCCESS (0.000s) [378.992167] [077/131] (642s left) kms_psr (psr2-cursor-blt) [379.091869] Starting subtest: psr2-cursor-blt [379.094167] Starting dynamic subtest: eDP-1 [380.785449] Dynamic subtest eDP-1: SUCCESS (1.699s) [380.787663] Subtest psr2-cursor-blt: SUCCESS (1.701s) [381.606684] [078/131] (640s left) kms_cursor_crc (cursor-offscreen-max-size) [381.895651] Starting subtest: cursor-offscreen-max-size [381.901969] Subtest cursor-offscreen-max-size: SKIP (0.000s) [382.069980] [079/131] (639s left) kms_force_connector_basic (prune-stale-modes) [382.149087] Starting subtest: prune-stale-modes [382.589289] Subtest prune-stale-modes: SUCCESS (0.442s) [382.780844] [080/131] (639s left) kms_cursor_crc (cursor-suspend) [382.911197] Starting subtest: cursor-suspend [382.913068] Starting dynamic subtest: pipe-A-eDP-1 [415.444944] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.196s) [415.456463] Starting dynamic subtest: pipe-D-eDP-1 [449.411505] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.776s) [449.413421] Subtest cursor-suspend: SUCCESS (6.975s) [450.272532] [081/131] (571s left) kms_plane_cursor (primary) [450.380827] Starting subtest: primary [450.385793] Starting dynamic subtest: pipe-A-eDP-1-size-64 [452.912092] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.557s) [452.935865] Starting dynamic subtest: pipe-A-eDP-1-size-128 [455.561261] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.648s) [455.587181] Starting dynamic subtest: pipe-A-eDP-1-size-256 [458.136197] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.570s) [458.455670] Starting dynamic subtest: pipe-B-eDP-1-size-64 [461.714795] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.280s) [461.740098] Starting dynamic subtest: pipe-B-eDP-1-size-128 [464.275514] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.548s) [464.300852] Starting dynamic subtest: pipe-B-eDP-1-size-256 [466.882616] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.593s) [467.198696] Starting dynamic subtest: pipe-C-eDP-1-size-64 [470.103534] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.922s) [470.131344] Starting dynamic subtest: pipe-C-eDP-1-size-128 [472.325541] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.205s) [472.353357] Starting dynamic subtest: pipe-C-eDP-1-size-256 [474.488843] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.145s) [474.822728] Starting dynamic subtest: pipe-D-eDP-1-size-64 [477.693566] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.883s) [477.721325] Starting dynamic subtest: pipe-D-eDP-1-size-128 [479.905928] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.193s) [479.936016] Starting dynamic subtest: pipe-D-eDP-1-size-256 [482.249906] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.324s) [482.564762] Subtest primary: SUCCESS (32.277s) [483.386457] [082/131] (538s left) gem_exec_balancer (fairslice) [483.451687] Starting subtest: fairslice [486.306305] Subtest fairslice: SUCCESS (2.852s) [487.556311] [083/131] (534s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc) [487.650316] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc [487.652551] Starting dynamic subtest: pipe-A-eDP-1 [487.674578] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [487.686767] Starting dynamic subtest: pipe-B-eDP-1 [487.709099] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [487.717717] Starting dynamic subtest: pipe-C-eDP-1 [487.739358] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [487.747674] Starting dynamic subtest: pipe-D-eDP-1 [487.768450] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [487.772677] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.008s) [489.978645] [084/131] (532s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-upscaling) [490.091304] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-upscaling [490.093620] Starting dynamic subtest: pipe-A-default-mode [490.387642] Dynamic subtest pipe-A-default-mode: SKIP (0.294s) [490.392544] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-upscaling: SKIP (0.296s) [491.270973] [085/131] (530s left) syncobj_eventfd (invalid-bad-pad) [491.323599] Starting subtest: invalid-bad-pad [491.325862] Subtest invalid-bad-pad: SUCCESS (0.000s) [491.435273] [086/131] (530s left) kms_psr (fbc-psr-sprite-blt) [491.532290] Starting subtest: fbc-psr-sprite-blt [491.534573] Starting dynamic subtest: eDP-1 [491.538960] Dynamic subtest eDP-1: SKIP (0.000s) [491.543370] Subtest fbc-psr-sprite-blt: SKIP (0.001s) [491.631258] [087/131] (530s left) gem_exec_reloc (basic-concurrent16) [491.696696] Subtest basic-concurrent16: SKIP (0.000s) [491.787999] [088/131] (530s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu) [491.886460] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu [491.890167] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [491.998146] [089/131] (530s left) syncobj_wait (wait-all-interrupted) [492.054986] Starting subtest: wait-all-interrupted [492.155745] Subtest wait-all-interrupted: SUCCESS (0.102s) [492.254002] [090/131] (530s left) kms_flip (flip-vs-expired-vblank) [492.337505] Starting subtest: flip-vs-expired-vblank [492.339318] Starting dynamic subtest: A-eDP1 [501.043410] Dynamic subtest A-eDP1: SUCCESS (8.705s) [501.060242] Starting dynamic subtest: B-eDP1 [509.734549] Dynamic subtest B-eDP1: SUCCESS (8.691s) [509.744059] Starting dynamic subtest: C-eDP1 [518.420676] Dynamic subtest C-eDP1: SUCCESS (8.687s) [518.431342] Starting dynamic subtest: D-eDP1 [527.114578] Dynamic subtest D-eDP1: SUCCESS (8.697s) [527.116903] Subtest flip-vs-expired-vblank: SUCCESS (34.789s) [528.370119] [091/131] (494s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs) [528.470115] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs [528.472398] Starting dynamic subtest: pipe-A-eDP-1 [528.530413] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [528.541311] Starting dynamic subtest: pipe-B-eDP-1 [528.598598] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [528.609170] Starting dynamic subtest: pipe-C-eDP-1 [528.667300] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [528.677993] Starting dynamic subtest: pipe-D-eDP-1 [528.734098] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [528.738541] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.009s) [530.763070] [092/131] (491s left) kms_cursor_legacy (cursorb-vs-flipa-toggle) [530.880898] Starting subtest: cursorB-vs-flipA-toggle [530.885654] Subtest cursorB-vs-flipA-toggle: SKIP (0.001s) [531.055189] [093/131] (491s left) gem_exec_fence (syncobj-stationary-timeline-chain-engines) [531.614128] Starting subtest: syncobj-stationary-timeline-chain-engines [531.724990] Subtest syncobj-stationary-timeline-chain-engines: SUCCESS (0.111s) [532.664509] [094/131] (489s left) gem_mmap_gtt (basic-write-cpu-read-gtt) [532.728210] Subtest basic-write-cpu-read-gtt: SKIP (0.000s) [532.801439] [095/131] (489s left) gem_softpin (evict-active-interruptible) [532.864586] Starting subtest: evict-active-interruptible [532.870028] Subtest evict-active-interruptible: SUCCESS (0.006s) [533.021951] [096/131] (489s left) gem_render_copy (yf-tiled-ccs-to-linear) [533.088210] Starting subtest: yf-tiled-ccs-to-linear [533.092399] Subtest yf-tiled-ccs-to-linear: SKIP (0.000s) [533.291571] [097/131] (489s left) device_reset (unbind-reset-rebind) [533.334420] Starting subtest: unbind-reset-rebind [538.015259] Subtest unbind-reset-rebind: SUCCESS (4.681s) [538.062505] [098/131] (484s left) kms_pm_dc (dc5-dpms) [539.158441] Starting subtest: dc5-dpms [541.233122] Subtest dc5-dpms: SUCCESS (2.075s) [541.333988] [099/131] (481s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs-cc) [541.436649] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs-cc [541.439078] Starting dynamic subtest: pipe-A-eDP-1 [541.463336] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [541.473790] Starting dynamic subtest: pipe-B-eDP-1 [541.496273] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [541.506133] Starting dynamic subtest: pipe-C-eDP-1 [541.528941] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [541.539620] Starting dynamic subtest: pipe-D-eDP-1 [541.562358] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [541.566467] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s) [543.688878] [100/131] (479s left) kms_big_fb (yf-tiled-64bpp-rotate-90) [543.799365] Starting subtest: yf-tiled-64bpp-rotate-90 [543.803987] Subtest yf-tiled-64bpp-rotate-90: SKIP (0.000s) [543.921569] [101/131] (478s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt) [544.023018] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt [544.027267] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [544.155396] [102/131] (478s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render) [544.252022] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render [544.256265] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s) [544.394289] [103/131] (478s left) kms_frontbuffer_tracking (fbc-indfb-scaledprimary) [544.495069] Starting subtest: fbc-indfb-scaledprimary [547.463607] Subtest fbc-indfb-scaledprimary: SUCCESS (2.970s) [548.679523] [104/131] (474s left) vgem_basic (create) [548.728859] Starting subtest: create [548.730765] Subtest create: SUCCESS (0.000s) [548.810917] [105/131] (474s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt) [548.901935] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt [548.906046] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [549.040207] [106/131] (474s left) gem_exec_fence (basic-await) [549.217099] Starting subtest: basic-await [549.219831] Starting dynamic subtest: rcs0 [549.295521] Dynamic subtest rcs0: SUCCESS (0.078s) [549.305301] Starting dynamic subtest: bcs0 [549.371242] Dynamic subtest bcs0: SUCCESS (0.075s) [549.382501] Starting dynamic subtest: vcs0 [549.444714] Dynamic subtest vcs0: SUCCESS (0.071s) [549.457615] Starting dynamic subtest: vcs1 [549.516364] Dynamic subtest vcs1: SUCCESS (0.070s) [549.529144] Starting dynamic subtest: vecs0 [549.588165] Dynamic subtest vecs0: SUCCESS (0.070s) [549.601632] Starting dynamic subtest: ccs0 [549.660120] Dynamic subtest ccs0: SUCCESS (0.070s) [549.662885] Subtest basic-await: SUCCESS (0.443s) [551.654874] [107/131] (471s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-blt) [551.776561] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-blt [556.181021] Subtest fbc-1p-primscrn-pri-indfb-draw-blt: SUCCESS (4.404s) [557.365080] [108/131] (465s left) kms_ccs (bad-aux-stride-yf-tiled-ccs) [557.474752] Starting subtest: bad-aux-stride-yf-tiled-ccs [557.477078] Starting dynamic subtest: pipe-A-eDP-1 [557.500800] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [557.516162] Starting dynamic subtest: pipe-B-eDP-1 [557.539459] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [557.551318] Starting dynamic subtest: pipe-C-eDP-1 [557.573462] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [557.584313] Starting dynamic subtest: pipe-D-eDP-1 [557.606543] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [557.610650] Subtest bad-aux-stride-yf-tiled-ccs: SKIP (0.004s) [559.721037] [109/131] (463s left) gem_userptr_blits (create-destroy-unsync) [559.797955] Subtest create-destroy-unsync: SKIP (0.000s) [559.965080] [110/131] (463s left) kms_pm_rpm (universal-planes) [561.699502] Starting subtest: universal-planes [561.701793] Starting dynamic subtest: plane-33 [569.987116] Dynamic subtest plane-33: SUCCESS (8.289s) [569.999669] Starting dynamic subtest: plane-63 [578.260821] Dynamic subtest plane-63: SUCCESS (8.271s) [578.274002] Starting dynamic subtest: plane-93 [586.883293] Dynamic subtest plane-93: SUCCESS (8.620s) [586.896311] Starting dynamic subtest: plane-123 [595.582278] Dynamic subtest plane-123: SUCCESS (8.697s) [595.603164] Starting dynamic subtest: plane-133 [603.876861] Dynamic subtest plane-133: SUCCESS (8.293s) [603.890567] Starting dynamic subtest: plane-143 [612.588275] Dynamic subtest plane-143: SUCCESS (8.711s) [612.590766] Subtest universal-planes: SUCCESS (50.896s) [612.983247] [111/131] (410s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic) [613.111853] Starting subtest: 2x-flip-vs-cursor-atomic [613.116395] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.001s) [613.316654] [112/131] (410s left) kms_frontbuffer_tracking (psr-rgb565-draw-blt) [613.418737] Starting subtest: psr-rgb565-draw-blt [620.418486] Subtest psr-rgb565-draw-blt: SUCCESS (7.004s) [620.590350] [113/131] (402s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu) [620.696387] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu [620.700321] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [620.835328] [114/131] (402s left) kms_plane_scaling (plane-upscale-20x20-with-rotation) [620.929990] Starting subtest: plane-upscale-20x20-with-rotation [620.932180] Starting dynamic subtest: pipe-A [621.154984] Dynamic subtest pipe-A: SUCCESS (0.226s) [621.165685] Starting dynamic subtest: pipe-B [622.475288] Dynamic subtest pipe-B: SUCCESS (1.319s) [622.484715] Starting dynamic subtest: pipe-C [623.802486] Dynamic subtest pipe-C: SUCCESS (1.327s) [623.817041] Starting dynamic subtest: pipe-D [625.136600] Dynamic subtest pipe-D: SUCCESS (1.333s) [625.138907] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.210s) [626.348828] [115/131] (397s left) gem_busy (busy) [626.423786] Starting subtest: busy [626.425719] Starting dynamic subtest: all-engines [626.482962] Dynamic subtest all-engines: SUCCESS (0.062s) [626.495730] Starting dynamic subtest: rcs0 [628.475277] Dynamic subtest rcs0: SUCCESS (1.990s) [628.486619] Starting dynamic subtest: bcs0 [628.548756] Dynamic subtest bcs0: SUCCESS (0.071s) [628.560155] Starting dynamic subtest: vcs0 [628.587221] Dynamic subtest vcs0: SUCCESS (0.038s) [628.597323] Starting dynamic subtest: vcs1 [630.523965] Dynamic subtest vcs1: SUCCESS (1.933s) [630.535099] Starting dynamic subtest: vecs0 [632.571355] Dynamic subtest vecs0: SUCCESS (2.048s) [632.582796] Starting dynamic subtest: ccs0 [634.554267] Dynamic subtest ccs0: SUCCESS (1.983s) [634.556361] Subtest busy: SUCCESS (8.134s) [634.962605] [116/131] (388s left) kms_legacy_colorkey (invalid-plane) [635.070115] Starting subtest: invalid-plane [635.072368] Starting dynamic subtest: zero-id [635.074241] Dynamic subtest zero-id: SUCCESS (0.000s) [635.084176] Starting dynamic subtest: outrange-id [635.086429] Dynamic subtest outrange-id: SUCCESS (0.000s) [635.088645] Subtest invalid-plane: SUCCESS (0.001s) [635.167378] [117/131] (388s left) gem_exec_reloc (basic-wc-gtt-noreloc) [635.233259] Subtest basic-wc-gtt-noreloc: SKIP (0.000s) [635.314998] [118/131] (388s left) api_intel_bb (object-noreloc-keep-cache-simple) [635.362340] Starting subtest: object-noreloc-keep-cache-simple [635.364982] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.005s) [635.511758] [119/131] (388s left) gem_close_race (multigpu-basic-process) [635.577054] Starting subtest: multigpu-basic-process [635.581258] Subtest multigpu-basic-process: SKIP (0.000s) [635.831214] [120/131] (387s left) kms_flip (nonblocking-read) [635.917900] Starting subtest: nonblocking-read [635.920264] Subtest nonblocking-read: SUCCESS (0.000s) [636.058073] [121/131] (387s left) intel_hwmon (hwmon-write) [636.115885] Subtest hwmon-write: SKIP (0.000s) [636.183765] [122/131] (387s left) gem_lmem_swapping (random) [636.233172] Subtest random: SKIP (0.000s) [636.280462] [123/131] (387s left) kms_feature_discovery (display-2x) [636.380967] Starting subtest: display-2x [636.385081] Subtest display-2x: SKIP (0.000s) [636.480605] [124/131] (387s left) gem_mmap_gtt (basic-small-copy-xy) [636.546210] Subtest basic-small-copy-XY: SKIP (0.000s) [636.607355] [125/131] (387s left) perf (gen12-mi-rpc) [636.745536] Starting subtest: gen12-mi-rpc [636.747050] Starting dynamic subtest: rcs0 [636.763416] Dynamic subtest rcs0: SUCCESS (0.018s) [636.764933] Subtest gen12-mi-rpc: SUCCESS (0.019s) [636.803898] [126/131] (387s left) i915_pm_rc6_residency (rc6-fence) [636.894792] Starting subtest: rc6-fence [636.942604] Starting dynamic subtest: gt0 [649.264283] Dynamic subtest gt0: SUCCESS (12.324s) [649.276766] Starting dynamic subtest: gt1 [667.511612] Dynamic subtest gt1: SUCCESS (18.247s) [667.514407] Subtest rc6-fence: SUCCESS (30.624s) [667.612692] [127/131] (356s left) kms_addfb_basic (basic) [667.675061] Starting subtest: basic [667.677333] Subtest basic: SUCCESS (0.000s) [667.861725] [128/131] (356s left) gem_mmap_offset (clear) [667.922253] Starting subtest: clear [667.924569] Starting dynamic subtest: smem0 [692.997548] Dynamic subtest smem0: SUCCESS (25.062s) [692.999964] Subtest clear: SUCCESS (25.064s) [693.167528] [129/131] (330s left) gem_ctx_param (basic-default) [693.271200] Starting subtest: basic-default [693.273601] Subtest basic-default: SUCCESS (0.000s) [693.372773] [130/131] (330s left) kms_cursor_legacy (cursor-vs-flip-varying-size) [693.496317] Starting subtest: cursor-vs-flip-varying-size [724.116512] Subtest cursor-vs-flip-varying-size: SUCCESS (30.612s) [724.975222] [131/131] (299s left) api_intel_bb (blit-noreloc-purge-cache) [725.032769] Starting subtest: blit-noreloc-purge-cache [725.041523] Subtest blit-noreloc-purge-cache: SUCCESS (0.010s) [725.190755] Closing watchdogs results: parsing output: 0/ for test: kms_atomic results: parsing output: 1/ for test: kms_frontbuffer_tracking results: parsing output: 2/ for test: kms_ccs results: parsing output: 3/ for test: syncobj_timeline results: parsing output: 4/ for test: kms_big_fb results: parsing output: 5/ for test: kms_big_fb results: parsing output: 6/ for test: kms_feature_discovery results: parsing output: 7/ for test: gen9_exec_parse results: parsing output: 8/ for test: sw_sync results: parsing output: 9/ for test: kms_lease results: parsing output: 10/ for test: gem_pwrite results: parsing output: 11/ for test: kms_psr results: parsing output: 12/ for test: i915_drm_fdinfo results: parsing output: 13/ for test: gem_exec_whisper results: parsing output: 14/ for test: kms_frontbuffer_tracking results: parsing output: 15/ for test: kms_frontbuffer_tracking results: parsing output: 16/ for test: kms_cursor_crc results: parsing output: 17/ for test: kms_getfb results: parsing output: 18/ for test: syncobj_timeline results: parsing output: 19/ for test: kms_vblank results: parsing output: 20/ for test: kms_frontbuffer_tracking results: parsing output: 21/ for test: gem_ctx_shared results: parsing output: 22/ for test: kms_flip results: parsing output: 23/ for test: gem_ctx_persistence results: parsing output: 24/ for test: kms_frontbuffer_tracking results: parsing output: 25/ for test: syncobj_timeline results: parsing output: 26/ for test: kms_plane_scaling results: parsing output: 27/ for test: syncobj_timeline results: parsing output: 28/ for test: gen3_render_linear_blits results: parsing output: 29/ for test: gem_exec_schedule results: parsing output: 30/ for test: kms_big_fb results: parsing output: 31/ for test: i915_suspend results: parsing output: 32/ for test: gem_tiled_pread_pwrite results: parsing output: 33/ for test: gem_exec_params results: parsing output: 34/ for test: syncobj_wait results: parsing output: 35/ for test: kms_big_fb results: parsing output: 36/ for test: kms_frontbuffer_tracking results: parsing output: 37/ for test: gem_spin_batch results: parsing output: 38/ for test: perf_pmu results: parsing output: 39/ for test: perf results: parsing output: 40/ for test: gem_exec_schedule results: parsing output: 41/ for test: gem_lmem_swapping results: parsing output: 42/ for test: syncobj_wait results: parsing output: 43/ for test: syncobj_timeline results: parsing output: 44/ for test: kms_vblank results: parsing output: 45/ for test: kms_cursor_legacy results: parsing output: 46/ for test: kms_frontbuffer_tracking results: parsing output: 47/ for test: kms_chamelium_hpd results: parsing output: 48/ for test: kms_big_fb results: parsing output: 49/ for test: kms_fence_pin_leak results: parsing output: 50/ for test: gem_tiling_max_stride results: parsing output: 51/ for test: kms_invalid_mode results: parsing output: 52/ for test: i915_drm_fdinfo results: parsing output: 53/ for test: syncobj_wait results: parsing output: 54/ for test: gem_mmap_gtt results: parsing output: 55/ for test: kms_flip results: parsing output: 56/ for test: kms_psr2_sf results: parsing output: 57/ for test: kms_psr results: parsing output: 58/ for test: kms_flip results: parsing output: 59/ for test: kms_psr2_sf results: parsing output: 60/ for test: kms_chamelium_color results: parsing output: 61/ for test: kms_frontbuffer_tracking results: parsing output: 62/ for test: kms_content_protection results: parsing output: 63/ for test: kms_psr results: parsing output: 64/ for test: kms_properties results: parsing output: 65/ for test: gem_ringfill results: parsing output: 66/ for test: gem_watchdog results: parsing output: 67/ for test: kms_dp_aux_dev results: parsing output: 68/ for test: kms_chamelium_edid results: parsing output: 69/ for test: kms_fbcon_fbt results: parsing output: 70/ for test: syncobj_timeline results: parsing output: 71/ for test: gem_exec_reloc results: parsing output: 72/ for test: gem_workarounds results: parsing output: 73/ for test: kms_frontbuffer_tracking results: parsing output: 74/ for test: kms_cursor_legacy results: parsing output: 75/ for test: gem_ctx_persistence results: parsing output: 76/ for test: kms_psr results: parsing output: 77/ for test: kms_cursor_crc results: parsing output: 78/ for test: kms_force_connector_basic results: parsing output: 79/ for test: kms_cursor_crc results: parsing output: 80/ for test: kms_plane_cursor results: parsing output: 81/ for test: gem_exec_balancer results: parsing output: 82/ for test: kms_ccs results: parsing output: 83/ for test: kms_flip_scaled_crc results: parsing output: 84/ for test: syncobj_eventfd results: parsing output: 85/ for test: kms_psr results: parsing output: 86/ for test: gem_exec_reloc results: parsing output: 87/ for test: kms_frontbuffer_tracking results: parsing output: 88/ for test: syncobj_wait results: parsing output: 89/ for test: kms_flip results: parsing output: 90/ for test: kms_ccs results: parsing output: 91/ for test: kms_cursor_legacy results: parsing output: 92/ for test: gem_exec_fence results: parsing output: 93/ for test: gem_mmap_gtt results: parsing output: 94/ for test: gem_softpin results: parsing output: 95/ for test: gem_render_copy results: parsing output: 96/ for test: device_reset results: parsing output: 97/ for test: kms_pm_dc results: parsing output: 98/ for test: kms_ccs results: parsing output: 99/ for test: kms_big_fb results: parsing output: 100/ for test: kms_frontbuffer_tracking results: parsing output: 101/ for test: kms_frontbuffer_tracking results: parsing output: 102/ for test: kms_frontbuffer_tracking results: parsing output: 103/ for test: vgem_basic results: parsing output: 104/ for test: kms_frontbuffer_tracking results: parsing output: 105/ for test: gem_exec_fence results: parsing output: 106/ for test: kms_frontbuffer_tracking results: parsing output: 107/ for test: kms_ccs results: parsing output: 108/ for test: gem_userptr_blits results: parsing output: 109/ for test: kms_pm_rpm results: parsing output: 110/ for test: kms_cursor_legacy results: parsing output: 111/ for test: kms_frontbuffer_tracking results: parsing output: 112/ for test: kms_frontbuffer_tracking results: parsing output: 113/ for test: kms_plane_scaling results: parsing output: 114/ for test: gem_busy results: parsing output: 115/ for test: kms_legacy_colorkey results: parsing output: 116/ for test: gem_exec_reloc results: parsing output: 117/ for test: api_intel_bb results: parsing output: 118/ for test: gem_close_race results: parsing output: 119/ for test: kms_flip results: parsing output: 120/ for test: intel_hwmon results: parsing output: 121/ for test: gem_lmem_swapping results: parsing output: 122/ for test: kms_feature_discovery results: parsing output: 123/ for test: gem_mmap_gtt results: parsing output: 124/ for test: perf results: parsing output: 125/ for test: i915_pm_rc6_residency results: parsing output: 126/ for test: kms_addfb_basic results: parsing output: 127/ for test: gem_mmap_offset results: parsing output: 128/ for test: gem_ctx_param results: parsing output: 129/ for test: kms_cursor_legacy results: parsing output: 130/ for test: api_intel_bb Done.