[141.093987] Initializing watchdogs [141.094146] /dev/watchdog0 [141.107833] [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] [141.111918] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [141.114047] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [141.117325] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite) [141.243355] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite [148.045954] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.805s) [148.217513] [002/133] (953s left) gem_exec_reloc (basic-gtt-read-noreloc) [148.286065] Subtest basic-gtt-read-noreloc: SKIP (0.000s) [148.353894] [003/133] (953s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible) [148.451557] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible [148.462292] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.010s) [148.548778] [004/133] (953s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0) [148.665071] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0 [149.666236] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.001s) [149.771746] [005/133] (952s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc) [149.866767] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc [149.869028] Starting dynamic subtest: pipe-A-eDP-1 [149.927351] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [149.936803] Starting dynamic subtest: pipe-B-eDP-1 [149.985218] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [149.992570] Starting dynamic subtest: pipe-C-eDP-1 [150.039606] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [150.047541] Starting dynamic subtest: pipe-D-eDP-1 [150.094955] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [150.098582] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.007s) [152.048318] [006/133] (949s left) sysfs_preempt_timeout (idempotent) [152.103781] Starting subtest: idempotent [152.106075] Starting dynamic subtest: vecs0 [152.108474] Dynamic subtest vecs0: SUCCESS (0.000s) [152.117181] Starting dynamic subtest: ccs0 [152.119374] Dynamic subtest ccs0: SUCCESS (0.000s) [152.125823] Starting dynamic subtest: vcs0 [152.127695] Dynamic subtest vcs0: SUCCESS (0.000s) [152.133797] Starting dynamic subtest: bcs0 [152.135675] Dynamic subtest bcs0: SUCCESS (0.000s) [152.141833] Starting dynamic subtest: rcs0 [152.143706] Dynamic subtest rcs0: SUCCESS (0.000s) [152.149940] Starting dynamic subtest: vcs1 [152.151921] Dynamic subtest vcs1: SUCCESS (0.000s) [152.153924] Subtest idempotent: SUCCESS (0.004s) [152.224855] [007/133] (949s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu) [152.340866] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu [152.345118] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [152.434603] [008/133] (949s left) kms_rotation_crc (primary-y-tiled-reflect-x-90) [152.531787] Starting subtest: primary-y-tiled-reflect-x-90 [152.536327] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s) [152.603666] [009/133] (949s left) kms_busy (basic-hang) [152.699181] Starting subtest: basic-hang [152.701385] Starting dynamic subtest: flip-pipe-A [153.330679] Dynamic subtest flip-pipe-A: SUCCESS (0.630s) [153.339381] Starting dynamic subtest: modeset-pipe-A [156.763878] Dynamic subtest modeset-pipe-A: SUCCESS (3.434s) [156.771075] Starting dynamic subtest: flip-pipe-D [157.976108] Dynamic subtest flip-pipe-D: SUCCESS (1.209s) [157.985220] Starting dynamic subtest: modeset-pipe-D [161.389178] Dynamic subtest modeset-pipe-D: SUCCESS (3.414s) [161.391399] Subtest basic-hang: SUCCESS (8.691s) [162.208784] [010/133] (939s left) kms_hdr (invalid-hdr) [162.315856] Starting subtest: invalid-hdr [164.416914] Starting dynamic subtest: pipe-A-eDP-1 [167.309569] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.892s) [167.312080] Subtest invalid-hdr: SUCCESS (4.995s) [167.408021] [011/133] (934s left) gem_ctx_param (set-priority-invalid-size) [167.460818] Starting subtest: set-priority-invalid-size [167.463381] Subtest set-priority-invalid-size: SUCCESS (0.000s) [167.527027] [012/133] (934s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-gtt) [167.625088] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-gtt [167.629082] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [167.700356] [013/133] (934s left) api_intel_allocator (open-vm) [167.753850] Starting subtest: open-vm [167.758315] Subtest open-vm: SUCCESS (0.006s) [167.864218] [014/133] (934s left) kms_frontbuffer_tracking (fbcpsr-tiling-linear) [167.969241] Starting subtest: fbcpsr-tiling-linear [174.554940] Subtest fbcpsr-tiling-linear: SUCCESS (6.589s) [174.675771] [015/133] (927s left) gem_softpin (evict-snoop-interruptible) [174.741492] Starting subtest: evict-snoop-interruptible [174.746184] Subtest evict-snoop-interruptible: SKIP (0.000s) [174.859906] [016/133] (927s left) gem_ctx_shared (create-shared-gtt) [174.934342] Starting subtest: create-shared-gtt [177.140209] Subtest create-shared-gtt: SUCCESS (2.151s) [178.292071] [017/133] (923s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-upscaling) [178.400083] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-upscaling [178.404665] Subtest flip-32bpp-ytile-to-64bpp-ytile-upscaling: SKIP (0.000s) [178.477938] [018/133] (923s left) kms_cursor_crc (cursor-offscreen-512x512) [178.746660] Starting subtest: cursor-offscreen-512x512 [178.751177] Subtest cursor-offscreen-512x512: SKIP (0.001s) [178.916599] [019/133] (923s left) i915_pm_rps (thresholds-idle-park) [178.974553] Starting subtest: thresholds-idle-park [178.979066] Subtest thresholds-idle-park: SKIP (0.000s) [179.092963] [020/133] (923s left) syncobj_timeline (invalid-signal-one-illegal-handle) [179.148104] Starting subtest: invalid-signal-one-illegal-handle [179.150447] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.001s) [179.246266] [021/133] (923s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-render) [179.347375] Starting subtest: psr-1p-primscrn-pri-indfb-draw-render [186.644698] Subtest psr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.297s) [186.763537] [022/133] (915s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted) [186.821853] Starting subtest: etime-multi-wait-all-for-submit-submitted [186.931304] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.109s) [187.002795] [023/133] (915s left) prime_vgem (basic-read) [187.122342] Starting subtest: basic-read [187.129790] Subtest basic-read: SKIP (0.005s) [187.225345] [FACT prime_vgem (basic-read)] new: kernel.kmod_is_loaded.vgem: true [187.229011] [024/133] (915s left) gem_reg_read (timestamp-moving) [187.284680] Starting subtest: timestamp-moving [188.287260] Subtest timestamp-moving: SUCCESS (1.001s) [188.374169] [025/133] (914s left) gem_ctx_param (basic-default) [188.421634] Starting subtest: basic-default [188.423784] Subtest basic-default: SUCCESS (0.000s) [188.482807] [026/133] (914s left) gem_eio (unwedge-stress) [188.701112] Starting subtest: unwedge-stress [188.703505] Starting dynamic subtest: render [193.363062] Dynamic subtest render: SUCCESS (4.660s) [193.376688] Starting dynamic subtest: bsd1 [211.351718] Dynamic subtest bsd1: SUCCESS (17.987s) [211.366238] Starting dynamic subtest: bsd2 [229.347494] Dynamic subtest bsd2: SUCCESS (17.993s) [229.362870] Starting dynamic subtest: blt [229.367570] Dynamic subtest blt: SKIP (0.000s) [229.375555] Starting dynamic subtest: vebox [247.390043] Dynamic subtest vebox: SUCCESS (18.042s) [247.392273] Subtest unwedge-stress: SUCCESS (58.685s) [248.953839] [027/133] (853s left) gem_exec_reloc (basic-cpu-read-active) [249.018588] Subtest basic-cpu-read-active: SKIP (0.000s) [249.092377] [028/133] (853s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-75) [249.177985] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-75 [249.180309] Starting dynamic subtest: pipe-A [249.200678] Dynamic subtest pipe-A: SKIP (0.017s) [249.213506] Starting dynamic subtest: pipe-B [249.234689] Dynamic subtest pipe-B: SKIP (0.035s) [249.245173] Starting dynamic subtest: pipe-C [249.270627] Dynamic subtest pipe-C: SKIP (0.035s) [249.278458] Starting dynamic subtest: pipe-D [249.301182] Dynamic subtest pipe-D: SKIP (0.032s) [249.304938] Subtest planes-upscale-factor-0-25-downscale-factor-0-75: SKIP (0.121s) [249.406124] [029/133] (853s left) kms_setmode (clone-exclusive-crtc) [249.458437] Starting subtest: clone-exclusive-crtc [249.464815] Subtest clone-exclusive-crtc: SKIP (0.000s) [249.541507] [030/133] (853s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-mc-ccs) [249.629065] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-mc-ccs [249.631347] Starting dynamic subtest: pipe-A-eDP-1 [251.715462] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.089s) [251.723735] Starting dynamic subtest: pipe-B-eDP-1 [253.867453] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.150s) [253.875462] Starting dynamic subtest: pipe-C-eDP-1 [255.973437] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.102s) [255.981573] Starting dynamic subtest: pipe-D-eDP-1 [258.162574] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.192s) [258.164318] Subtest crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (8.538s) [259.375590] [031/133] (843s left) kms_invalid_mode (zero-hdisplay) [259.473117] Starting subtest: zero-hdisplay [259.475337] Starting dynamic subtest: pipe-A-eDP-1 [259.756502] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.286s) [259.765067] Starting dynamic subtest: pipe-B-eDP-1 [259.767307] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [259.774599] Starting dynamic subtest: pipe-C-eDP-1 [259.776507] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [259.784142] Starting dynamic subtest: pipe-D-eDP-1 [259.786292] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [259.788474] Subtest zero-hdisplay: SUCCESS (0.294s) [260.592448] [032/133] (842s left) gem_exec_params (invalid-bsd1-flag-on-blt) [260.644328] Starting subtest: invalid-bsd1-flag-on-blt [260.646697] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.000s) [260.742984] [033/133] (842s left) kms_pm_lpsp (kms-lpsp) [261.844325] Starting subtest: kms-lpsp [261.846298] Starting dynamic subtest: pipe-A-eDP-1 [261.991663] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.151s) [262.288056] Subtest kms-lpsp: SUCCESS (0.446s) [263.133552] [034/133] (839s left) i915_pm_rc6_residency (rc6-fence) [263.188035] Starting subtest: rc6-fence [263.212818] Starting dynamic subtest: gt0 [275.550815] Dynamic subtest gt0: SUCCESS (12.321s) [275.560243] Starting dynamic subtest: gt1 [289.878825] Dynamic subtest gt1: SUCCESS (14.340s) [289.881573] Subtest rc6-fence: SUCCESS (26.691s) [289.968149] [035/133] (812s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions) [290.081294] Starting subtest: short-flip-after-cursor-atomic-transitions [291.029907] Subtest short-flip-after-cursor-atomic-transitions: SUCCESS (0.947s) [291.883241] [036/133] (811s left) gem_softpin (allocator-nopin-reserve) [291.954817] Starting subtest: allocator-nopin-reserve [292.044358] Subtest allocator-nopin-reserve: SUCCESS (0.090s) [292.196424] [037/133] (810s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc) [292.289617] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc [292.291992] Starting dynamic subtest: pipe-A-eDP-1 [292.314651] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [292.323678] Starting dynamic subtest: pipe-B-eDP-1 [292.344653] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [292.352071] Starting dynamic subtest: pipe-C-eDP-1 [292.372933] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [292.380790] Starting dynamic subtest: pipe-D-eDP-1 [292.402084] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [292.406211] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s) [294.517197] [038/133] (808s left) kms_flip (flip-vs-panning-vs-hang) [294.607455] Starting subtest: flip-vs-panning-vs-hang [294.609880] Starting dynamic subtest: A-eDP1 [345.406588] Dynamic subtest A-eDP1: SUCCESS (50.797s) [345.416290] Starting dynamic subtest: D-eDP1 [385.408251] Dynamic subtest D-eDP1: SUCCESS (39.998s) [385.410519] Subtest flip-vs-panning-vs-hang: SUCCESS (90.801s) [386.607767] [039/133] (716s left) gem_userptr_blits (process-exit) [386.677048] Starting subtest: process-exit [386.684376] Subtest process-exit: SUCCESS (0.008s) [386.803155] [040/133] (716s left) gem_pwrite (basic-random) [386.855288] Subtest basic-random: SKIP (0.000s) [386.915731] [041/133] (716s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf) [387.013639] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf [387.018116] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s) [387.083450] [042/133] (716s left) api_intel_bb (object-reloc-keep-cache) [387.137299] Starting subtest: object-reloc-keep-cache [387.141747] Subtest object-reloc-keep-cache: SKIP (0.003s) [387.245501] [043/133] (716s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu) [387.345348] Starting subtest: fbc-rgb565-draw-mmap-cpu [391.306939] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (3.964s) [392.514192] [044/133] (710s left) kms_psr (psr2-suspend) [392.602935] Starting subtest: psr2-suspend [392.605069] Starting dynamic subtest: eDP-1 [410.853183] Dynamic subtest eDP-1: SUCCESS (2.926s) [410.855435] Subtest psr2-suspend: SUCCESS (2.927s) [411.667393] [045/133] (691s left) kms_big_fb (x-tiled-64bpp-rotate-180) [411.807315] Starting subtest: x-tiled-64bpp-rotate-180 [413.375064] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.579s) [413.552756] [046/133] (689s left) gem_exec_fence (basic-wait) [413.732451] Starting subtest: basic-wait [413.734815] Starting dynamic subtest: rcs0 [413.809949] Dynamic subtest rcs0: SUCCESS (0.078s) [413.821305] Starting dynamic subtest: bcs0 [413.875559] Dynamic subtest bcs0: SUCCESS (0.064s) [413.887078] Starting dynamic subtest: vcs0 [413.938552] Dynamic subtest vcs0: SUCCESS (0.061s) [413.949580] Starting dynamic subtest: vcs1 [413.997306] Dynamic subtest vcs1: SUCCESS (0.057s) [414.008375] Starting dynamic subtest: vecs0 [414.055394] Dynamic subtest vecs0: SUCCESS (0.056s) [414.066011] Starting dynamic subtest: ccs0 [414.116960] Dynamic subtest ccs0: SUCCESS (0.058s) [414.119502] Subtest basic-wait: SUCCESS (0.388s) [416.330338] [047/133] (687s left) kms_plane_alpha_blend (alpha-basic) [416.427235] Starting subtest: alpha-basic [416.704013] Starting dynamic subtest: pipe-A-eDP-1 [418.628589] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.929s) [418.654786] Starting dynamic subtest: pipe-D-eDP-1 [421.266844] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.629s) [421.269213] Subtest alpha-basic: SUCCESS (4.858s) [422.067375] [048/133] (681s left) perf_pmu (busy-double-start) [422.107255] Starting subtest: busy-double-start [422.109483] Starting dynamic subtest: rcs0 [425.746868] Dynamic subtest rcs0: FAIL (3.597s) [425.757499] Starting dynamic subtest: bcs0 [429.292112] Dynamic subtest bcs0: SUCCESS (3.601s) [429.304071] Starting dynamic subtest: vcs0 [433.743466] Dynamic subtest vcs0: SUCCESS (4.454s) [433.755215] Starting dynamic subtest: vcs1 [437.750328] Dynamic subtest vcs1: SUCCESS (4.008s) [437.761745] Starting dynamic subtest: vecs0 [441.732416] Dynamic subtest vecs0: SUCCESS (3.983s) [441.744576] Starting dynamic subtest: ccs0 [445.371001] Dynamic subtest ccs0: FAIL (3.567s) [445.373069] Subtest busy-double-start: FAIL (23.221s) [445.426772] [049/133] (658s left) gem_exec_store (dword) [445.499770] Starting subtest: dword [445.502130] Starting dynamic subtest: rcs0 [445.592447] Dynamic subtest rcs0: SUCCESS (0.094s) [445.605444] Starting dynamic subtest: bcs0 [445.637440] Dynamic subtest bcs0: SUCCESS (0.043s) [445.648338] Starting dynamic subtest: vcs0 [445.680668] Dynamic subtest vcs0: SUCCESS (0.041s) [445.690969] Starting dynamic subtest: vcs1 [445.724717] Dynamic subtest vcs1: SUCCESS (0.042s) [445.736877] Starting dynamic subtest: vecs0 [445.768930] Dynamic subtest vecs0: SUCCESS (0.042s) [445.780294] Starting dynamic subtest: ccs0 [445.816303] Dynamic subtest ccs0: SUCCESS (0.045s) [445.818702] Subtest dword: SUCCESS (0.319s) [446.017110] [050/133] (657s left) kms_psr (fbc-pr-cursor-plane-onoff) [446.122488] Starting subtest: fbc-pr-cursor-plane-onoff [446.126840] Subtest fbc-pr-cursor-plane-onoff: SKIP (0.000s) [446.208288] [051/133] (657s left) gem_userptr_blits (nohangcheck) [446.284306] Starting subtest: nohangcheck [446.542052] Subtest nohangcheck: SUCCESS (0.254s) [446.661484] [052/133] (656s left) kms_psr (fbc-psr-sprite-plane-onoff) [446.745255] Starting subtest: fbc-psr-sprite-plane-onoff [446.747549] Starting dynamic subtest: eDP-1 [446.751639] Dynamic subtest eDP-1: SKIP (0.000s) [446.755692] Subtest fbc-psr-sprite-plane-onoff: SKIP (0.001s) [446.816847] [053/133] (656s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted) [446.875517] Starting subtest: invalid-multi-wait-all-unsubmitted [446.877695] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s) [446.988915] [054/133] (656s left) kms_addfb_basic (bad-pitch-65536) [447.041858] Starting subtest: bad-pitch-65536 [447.043791] Subtest bad-pitch-65536: SUCCESS (0.000s) [447.175017] [055/133] (656s left) gem_gpgpu_fill (basic) [447.235910] Starting subtest: basic [447.238504] Starting dynamic subtest: smem [447.243802] Dynamic subtest smem: SUCCESS (0.009s) [447.246211] Subtest basic: SUCCESS (0.010s) [447.402873] [056/133] (656s left) prime_vgem (shrink) [447.480197] Starting subtest: shrink [447.492556] Subtest shrink: SUCCESS (0.013s) [447.595283] [057/133] (656s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip) [447.696877] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip [448.787006] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (1.090s) [448.910880] [058/133] (654s left) kms_content_protection (mei-interface) [449.049056] Starting subtest: mei-interface [449.053233] Subtest mei-interface: SKIP (0.001s) [449.224978] [059/133] (654s left) gem_ctx_shared (q-out-order) [449.289979] Starting subtest: Q-out-order [449.291930] Starting dynamic subtest: rcs0 [449.392329] Dynamic subtest rcs0: SUCCESS (0.101s) [449.409510] Starting dynamic subtest: vcs0 [449.472286] Dynamic subtest vcs0: SUCCESS (0.079s) [449.488223] Starting dynamic subtest: vcs1 [449.549387] Dynamic subtest vcs1: SUCCESS (0.076s) [449.568197] Starting dynamic subtest: vecs0 [449.628001] Dynamic subtest vecs0: SUCCESS (0.076s) [449.643713] Starting dynamic subtest: ccs0 [449.706508] Dynamic subtest ccs0: SUCCESS (0.077s) [449.708801] Subtest Q-out-order: SUCCESS (0.417s) [451.329201] [060/133] (652s left) gem_mmap_gtt (ptrace) [451.378618] Subtest ptrace: SKIP (0.000s) [451.439770] [061/133] (652s left) i915_hangman (gt-error-state-capture) [451.499511] Starting subtest: gt-error-state-capture [451.501910] Starting dynamic subtest: rcs0 [463.184740] Dynamic subtest rcs0: SUCCESS (11.691s) [463.196021] Starting dynamic subtest: bcs0 [475.216697] Dynamic subtest bcs0: SUCCESS (12.035s) [475.228291] Starting dynamic subtest: vcs0 [487.184004] Dynamic subtest vcs0: SUCCESS (11.971s) [487.195795] Starting dynamic subtest: vcs1 [499.152251] Dynamic subtest vcs1: SUCCESS (11.971s) [499.164803] Starting dynamic subtest: vecs0 [510.160324] Dynamic subtest vecs0: SUCCESS (10.995s) [510.171994] Starting dynamic subtest: ccs0 [521.169144] Dynamic subtest ccs0: SUCCESS (10.984s) [521.172328] Subtest gt-error-state-capture: SUCCESS (69.663s) [521.250355] [062/133] (582s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-render) [521.374060] Starting subtest: psr-2p-primscrn-spr-indfb-draw-render [521.378288] Subtest psr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [521.479799] [063/133] (582s left) gen9_exec_parse (cmd-crossing-page) [521.537977] Subtest cmd-crossing-page: SKIP (0.000s) [521.618661] [064/133] (582s left) kms_big_fb (yf-tiled-8bpp-rotate-180) [521.721660] Starting subtest: yf-tiled-8bpp-rotate-180 [521.725737] Subtest yf-tiled-8bpp-rotate-180: SKIP (0.000s) [521.819585] [065/133] (582s left) gem_ringfill (legacy-basic) [527.222521] Starting subtest: legacy-basic [527.225174] Starting dynamic subtest: default [527.283350] Dynamic subtest default: SUCCESS (0.061s) [527.296462] Starting dynamic subtest: render [527.325247] Dynamic subtest render: SUCCESS (0.039s) [527.336900] Starting dynamic subtest: bsd [527.369263] Dynamic subtest bsd: SUCCESS (0.041s) [527.378822] Starting dynamic subtest: bsd1 [527.412412] Dynamic subtest bsd1: SUCCESS (0.041s) [527.423261] Starting dynamic subtest: bsd2 [527.452520] Dynamic subtest bsd2: SUCCESS (0.038s) [527.463732] Starting dynamic subtest: blt [527.500660] Dynamic subtest blt: SUCCESS (0.046s) [527.512482] Starting dynamic subtest: vebox [527.545404] Dynamic subtest vebox: SUCCESS (0.042s) [527.548141] Subtest legacy-basic: SUCCESS (0.326s) [527.624145] [066/133] (576s left) kms_cursor_crc (cursor-random-64x21) [527.833343] Starting subtest: cursor-random-64x21 [527.879317] Subtest cursor-random-64x21: SKIP (0.041s) [528.147848] [067/133] (576s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers) [528.253008] Starting subtest: plane-downscale-factor-0-5-with-modifiers [528.254958] Starting dynamic subtest: pipe-A [528.275349] Dynamic subtest pipe-A: SKIP (0.019s) [528.284681] Starting dynamic subtest: pipe-B [528.309688] Dynamic subtest pipe-B: SKIP (0.032s) [528.317986] Starting dynamic subtest: pipe-C [528.340458] Dynamic subtest pipe-C: SKIP (0.032s) [528.348774] Starting dynamic subtest: pipe-D [528.374063] Dynamic subtest pipe-D: SKIP (0.032s) [528.377503] Subtest plane-downscale-factor-0-5-with-modifiers: SKIP (0.117s) [528.463884] [068/133] (575s left) kms_flip (flip-vs-suspend) [528.560335] Starting subtest: flip-vs-suspend [528.562370] Starting dynamic subtest: A-eDP1 [577.458446] Dynamic subtest A-eDP1: SUCCESS (4.551s) [577.468818] Starting dynamic subtest: B-eDP1 [626.472548] Dynamic subtest B-eDP1: SUCCESS (4.563s) [626.483408] Starting dynamic subtest: C-eDP1 [675.455885] Dynamic subtest C-eDP1: SUCCESS (4.517s) [675.470388] Starting dynamic subtest: D-eDP1 [724.460486] Dynamic subtest D-eDP1: SUCCESS (4.543s) [724.465130] Subtest flip-vs-suspend: SUCCESS (18.185s) [725.634610] [069/133] (378s left) kms_psr (fbc-pr-primary-page-flip) [725.731032] Starting subtest: fbc-pr-primary-page-flip [725.736283] Subtest fbc-pr-primary-page-flip: SKIP (0.000s) [725.802477] [070/133] (378s left) kms_universal_plane (disable-primary-vs-flip) [725.898965] Starting subtest: disable-primary-vs-flip [725.901082] Starting dynamic subtest: pipe-A-eDP-1 [727.430886] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.539s) [727.441126] Starting dynamic subtest: pipe-B-eDP-1 [729.656051] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.236s) [729.666798] Starting dynamic subtest: pipe-C-eDP-1 [731.822177] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.173s) [731.833629] Starting dynamic subtest: pipe-D-eDP-1 [734.004664] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.189s) [734.007077] Subtest disable-primary-vs-flip: SUCCESS (8.143s) [734.808030] [071/133] (369s left) kms_rotation_crc (primary-rotation-270) [734.903941] Starting subtest: primary-rotation-270 [734.908943] Subtest primary-rotation-270: SKIP (0.001s) [734.975811] [072/133] (369s left) kms_vblank (wait-forked-hang) [735.063241] Starting subtest: wait-forked-hang [735.065879] Starting dynamic subtest: pipe-A-eDP-1 [761.791435] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.749s) [761.808298] Starting dynamic subtest: pipe-D-eDP-1 [776.685234] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.894s) [776.688435] Subtest wait-forked-hang: SUCCESS (41.648s) [777.547444] [073/133] (326s left) i915_query (query-topology-kernel-writes) [777.607363] Starting subtest: query-topology-kernel-writes [777.610367] Subtest query-topology-kernel-writes: SUCCESS (0.000s) [777.708672] [074/133] (326s left) kms_pm_rpm (legacy-planes) [779.238189] Starting subtest: legacy-planes [779.241072] Starting dynamic subtest: plane-64 [787.529760] Dynamic subtest plane-64: SUCCESS (8.296s) [787.542406] Starting dynamic subtest: plane-94 [795.846171] Dynamic subtest plane-94: SUCCESS (8.317s) [795.858461] Starting dynamic subtest: plane-124 [804.136796] Dynamic subtest plane-124: SUCCESS (8.290s) [804.148447] Starting dynamic subtest: plane-134 [812.431104] Dynamic subtest plane-134: SUCCESS (8.295s) [812.434299] Subtest legacy-planes: SUCCESS (33.210s) [812.810804] [075/133] (291s left) gem_ctx_persistence (engines-queued) [812.867291] Starting subtest: engines-queued [812.870295] Starting dynamic subtest: rcs0 [812.945760] Dynamic subtest rcs0: SUCCESS (0.078s) [812.959485] Starting dynamic subtest: bcs0 [812.971354] Dynamic subtest bcs0: SUCCESS (0.024s) [812.981053] Starting dynamic subtest: vcs0 [814.933716] Dynamic subtest vcs0: SUCCESS (1.961s) [814.947114] Starting dynamic subtest: vcs1 [816.915245] Dynamic subtest vcs1: SUCCESS (1.978s) [816.928268] Starting dynamic subtest: vecs0 [818.953960] Dynamic subtest vecs0: SUCCESS (1.980s) [818.966510] Starting dynamic subtest: ccs0 [819.087870] Dynamic subtest ccs0: SUCCESS (0.189s) [819.091288] Subtest engines-queued: SUCCESS (6.223s) [819.202991] [076/133] (285s left) gem_exec_schedule (u-semaphore-user) [819.279342] Starting subtest: u-semaphore-user [819.334395] Subtest u-semaphore-user: SUCCESS (0.064s) [821.036967] [077/133] (283s left) gem_exec_create (basic) [821.092446] Starting subtest: basic [821.095310] Starting dynamic subtest: smem [824.949072] Dynamic subtest smem: SUCCESS (3.852s) [824.952300] Subtest basic: SUCCESS (3.854s) [825.157765] [078/133] (279s left) gem_blits (basic) [825.211242] Starting subtest: basic [827.412404] Subtest basic: SUCCESS (2.145s) [827.490203] [079/133] (277s left) gem_exec_reloc (basic-gtt) [827.561449] Subtest basic-gtt: SKIP (0.000s) [827.627479] [080/133] (277s left) gem_pxp (reject-modify-context-protection-off-3) [827.743017] Starting subtest: reject-modify-context-protection-off-3 [827.746061] Subtest reject-modify-context-protection-off-3: SUCCESS (0.002s) [827.857742] [081/133] (277s left) kms_async_flips (test-time-stamp-atomic) [827.949326] Starting subtest: test-time-stamp-atomic [828.334168] Starting dynamic subtest: pipe-A-eDP-1 [829.107414] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.770s) [829.477031] Starting dynamic subtest: pipe-B-eDP-1 [830.241034] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.767s) [830.609729] Starting dynamic subtest: pipe-C-eDP-1 [831.372364] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.768s) [831.738937] Starting dynamic subtest: pipe-D-eDP-1 [832.498816] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.764s) [832.501581] Subtest test-time-stamp-atomic: SUCCESS (4.547s) [833.665020] [082/133] (271s left) gem_exec_suspend (basic-s3-devices) [833.724426] Starting subtest: basic-S3-devices [833.727006] Starting dynamic subtest: smem [844.980259] Dynamic subtest smem: SUCCESS (11.250s) [844.983365] Subtest basic-S3-devices: SUCCESS (11.253s) [845.173367] [083/133] (259s left) kms_chamelium_hpd (hdmi-hpd-for-each-pipe) [845.585845] Subtest hdmi-hpd-for-each-pipe: SKIP (0.000s) [846.362908] [084/133] (258s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render) [846.474120] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render [846.479221] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [846.569649] [085/133] (258s left) gem_exec_schedule (preempt-queue-chain) [846.658284] Subtest preempt-queue-chain: SKIP (0.000s) [846.960173] [086/133] (258s left) gem_exec_reloc (basic-write-gtt-active) [847.031336] Subtest basic-write-gtt-active: SKIP (0.000s) [847.103208] [087/133] (258s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff) [847.194042] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff [847.199196] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s) [847.287706] [088/133] (257s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs-cc) [847.382158] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs-cc [847.385166] Starting dynamic subtest: pipe-A-eDP-1 [847.412103] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [847.422665] Starting dynamic subtest: pipe-B-eDP-1 [847.450238] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [847.460245] Starting dynamic subtest: pipe-C-eDP-1 [847.487360] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [847.496941] Starting dynamic subtest: pipe-D-eDP-1 [847.525311] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [847.530324] Subtest random-ccs-data-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s) [849.636307] [089/133] (255s left) kms_psr (psr-primary-mmap-gtt) [849.730728] Starting subtest: psr-primary-mmap-gtt [849.733055] Starting dynamic subtest: eDP-1 [851.147410] Dynamic subtest eDP-1: SKIP (1.414s) [851.153264] Subtest psr-primary-mmap-gtt: SKIP (1.416s) [851.294066] [090/133] (253s left) kms_psr (pr-primary-render) [851.392474] Starting subtest: pr-primary-render [851.397552] Subtest pr-primary-render: SKIP (0.000s) [851.465064] [091/133] (253s left) kms_prop_blob (blob-prop-validate) [851.512420] Starting subtest: blob-prop-validate [851.514760] Subtest blob-prop-validate: SUCCESS (0.000s) [851.612315] [092/133] (253s left) gem_exec_reloc (basic-gtt-wc-active) [851.672320] Subtest basic-gtt-wc-active: SKIP (0.000s) [851.745844] [093/133] (253s left) gem_mmap_gtt (cpuset-medium-copy) [851.804251] Subtest cpuset-medium-copy: SKIP (0.000s) [851.859628] [094/133] (253s left) perf_pmu (busy-no-semaphores) [851.900757] Starting subtest: busy-no-semaphores [851.903080] Starting dynamic subtest: rcs0 [852.459426] Dynamic subtest rcs0: SUCCESS (0.558s) [852.470946] Starting dynamic subtest: bcs0 [853.013817] Dynamic subtest bcs0: SUCCESS (0.551s) [853.027087] Starting dynamic subtest: vcs0 [853.565602] Dynamic subtest vcs0: SUCCESS (0.549s) [853.583407] Starting dynamic subtest: vcs1 [855.479577] Dynamic subtest vcs1: SUCCESS (1.910s) [855.492427] Starting dynamic subtest: vecs0 [857.466339] Dynamic subtest vecs0: SUCCESS (1.984s) [857.480300] Starting dynamic subtest: ccs0 [859.514123] Dynamic subtest ccs0: SUCCESS (2.044s) [859.517141] Subtest busy-no-semaphores: SUCCESS (7.614s) [859.645010] [095/133] (245s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc) [859.740157] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc [859.742830] Starting dynamic subtest: pipe-A-eDP-1 [859.766233] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [859.779873] Starting dynamic subtest: pipe-B-eDP-1 [859.803904] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [859.812550] Starting dynamic subtest: pipe-C-eDP-1 [859.834857] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [859.843523] Starting dynamic subtest: pipe-D-eDP-1 [859.866254] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [859.870939] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.006s) [861.970035] [096/133] (243s left) kms_cursor_crc (cursor-sliding-32x10) [862.144392] Starting subtest: cursor-sliding-32x10 [862.196975] Subtest cursor-sliding-32x10: SKIP (0.048s) [862.461435] [097/133] (243s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions) [862.590865] Starting subtest: cursor-vs-flip-atomic-transitions [892.464005] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (29.871s) [893.296084] [098/133] (212s left) gem_create (create-massive) [893.367296] Starting subtest: create-massive [893.370456] Subtest create-massive: SUCCESS (0.000s) [893.557059] [099/133] (212s left) syncobj_wait (multi-wait-for-submit-submitted) [893.618057] Starting subtest: multi-wait-for-submit-submitted [893.720821] Subtest multi-wait-for-submit-submitted: SUCCESS (0.103s) [893.809769] [100/133] (211s left) kms_big_fb (y-tiled-8bpp-rotate-180) [893.916174] Starting subtest: y-tiled-8bpp-rotate-180 [893.921287] Subtest y-tiled-8bpp-rotate-180: SKIP (0.000s) [894.010841] [101/133] (211s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy) [894.159165] Starting subtest: 2x-long-flip-vs-cursor-legacy [894.163897] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s) [894.305527] [102/133] (211s left) vgem_basic (create) [894.355752] Starting subtest: create [894.358027] Subtest create: SUCCESS (0.000s) [894.425948] [103/133] (211s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-submitted-signaled) [894.488682] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [894.491205] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [894.596275] [104/133] (211s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [894.687281] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [895.311004] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.626s) [895.472438] [105/133] (210s left) gem_partial_pwrite_pread (reads-display) [895.530209] Subtest reads-display: SKIP (0.000s) [895.596353] [106/133] (210s left) syncobj_timeline (wait-all-snapshot) [895.655753] Starting subtest: wait-all-snapshot [895.737438] Subtest wait-all-snapshot: SUCCESS (0.083s) [895.828894] [107/133] (210s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt) [895.932865] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt [895.937998] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [896.041971] [108/133] (210s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [896.135454] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-gtt [896.140309] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [896.227856] [109/133] (209s left) gem_exec_reloc (basic-write-gtt) [896.287236] Subtest basic-write-gtt: SKIP (0.000s) [896.355514] [110/133] (209s left) kms_chamelium_edid (dp-edid-read) [896.731376] Subtest dp-edid-read: SKIP (0.000s) [897.522279] [111/133] (208s left) kms_async_flips (crc) [897.610430] Starting subtest: crc [897.987011] Starting dynamic subtest: pipe-A-eDP-1 [900.962714] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.957s) [901.323148] Starting dynamic subtest: pipe-B-eDP-1 [904.284545] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.953s) [904.648047] Starting dynamic subtest: pipe-C-eDP-1 [907.604464] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.934s) [907.954690] Starting dynamic subtest: pipe-D-eDP-1 [910.837819] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.859s) [910.840349] Subtest crc: SUCCESS (13.205s) [911.965137] [112/133] (194s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-pwrite) [912.062223] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-pwrite [912.067132] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [912.159560] [113/133] (194s left) core_getversion (basic) [912.208296] Starting subtest: basic [912.213974] Subtest basic: SUCCESS (0.000s) [912.268120] [114/133] (194s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier) [912.352302] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier [912.357211] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier: SKIP (0.000s) [912.427703] [115/133] (193s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt) [912.527760] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt [919.930063] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.408s) [920.050878] [116/133] (186s left) kms_fbcon_fbt (psr-suspend) [920.119830] Starting subtest: psr-suspend [969.500919] Subtest psr-suspend: SUCCESS (19.619s) [969.542526] [117/133] (136s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-render) [969.652125] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-render [973.733385] Subtest fbc-1p-offscreen-pri-indfb-draw-render: SUCCESS (4.099s) [974.932933] [118/133] (131s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier) [975.046922] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier [975.050943] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier: SKIP (0.000s) [975.120117] [119/133] (131s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted) [975.176823] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted [975.277267] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.101s) [975.355306] [120/133] (131s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted) [975.419823] Starting subtest: multi-wait-all-for-submit-unsubmitted [975.527095] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.108s) [975.613172] [121/133] (131s left) kms_legacy_colorkey (basic) [975.717845] Starting subtest: basic [975.719751] Starting dynamic subtest: pipe-A [975.761113] Dynamic subtest pipe-A: SUCCESS (0.045s) [975.773606] Starting dynamic subtest: pipe-B [975.775999] Dynamic subtest pipe-B: SUCCESS (0.000s) [975.785756] Starting dynamic subtest: pipe-C [975.788167] Dynamic subtest pipe-C: SUCCESS (0.000s) [975.797024] Starting dynamic subtest: pipe-D [975.799162] Dynamic subtest pipe-D: SUCCESS (0.000s) [975.801033] Subtest basic: SUCCESS (0.050s) [975.846355] [122/133] (130s left) gen9_exec_parse (unaligned-access) [975.901003] Subtest unaligned-access: SKIP (0.000s) [975.978119] [123/133] (130s left) gem_fence_thrash (bo-write-verify-none) [976.018378] Starting subtest: bo-write-verify-none [976.037682] Subtest bo-write-verify-none: SKIP (0.020s) [976.106860] [124/133] (130s left) gem_exec_gttfill (all-engines) [976.175301] Starting subtest: all-engines [999.162118] Subtest all-engines: SUCCESS (23.014s) [999.349559] [125/133] (107s left) gem_partial_pwrite_pread (write-snoop) [999.454015] Subtest write-snoop: SKIP (0.000s) [999.530248] [126/133] (107s left) gem_exec_balancer (parallel-bb-first) [999.784007] Starting subtest: parallel-bb-first [1000.711172] Subtest parallel-bb-first: SUCCESS (0.928s) [1001.753547] [127/133] (105s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-cpu) [1001.866693] Starting subtest: fbc-rgb101010-draw-mmap-cpu [1006.474346] Subtest fbc-rgb101010-draw-mmap-cpu: SUCCESS (4.608s) [1007.649943] [128/133] ( 99s left) kms_cursor_legacy (forked-move) [1007.771068] Starting subtest: forked-move [1007.772877] Starting dynamic subtest: pipe-A [1013.280796] Dynamic subtest pipe-A: SUCCESS (5.452s) [1013.292352] Starting dynamic subtest: pipe-B [1018.753123] Dynamic subtest pipe-B: SUCCESS (5.471s) [1018.765538] Starting dynamic subtest: pipe-C [1024.237323] Dynamic subtest pipe-C: SUCCESS (5.483s) [1024.248304] Starting dynamic subtest: pipe-D [1029.704549] Dynamic subtest pipe-D: SUCCESS (5.463s) [1029.720771] Starting dynamic subtest: all-pipes [1035.188966] Dynamic subtest all-pipes: SUCCESS (5.486s) [1035.191539] Subtest forked-move: SUCCESS (27.365s) [1035.284618] [129/133] ( 71s left) kms_color (deep-color) [1035.389620] Starting subtest: deep-color [1035.404674] Starting dynamic subtest: pipe-A-eDP-1-gamma [1036.114091] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.707s) [1036.125065] Starting dynamic subtest: pipe-A-eDP-1-degamma [1037.551400] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.436s) [1037.562487] Starting dynamic subtest: pipe-A-eDP-1-ctm [1038.972119] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.421s) [1039.756805] Starting dynamic subtest: pipe-B-eDP-1-gamma [1040.457766] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.708s) [1040.469091] Starting dynamic subtest: pipe-B-eDP-1-degamma [1041.874804] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.418s) [1041.886686] Starting dynamic subtest: pipe-B-eDP-1-ctm [1043.266542] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.389s) [1044.058481] Starting dynamic subtest: pipe-C-eDP-1-gamma [1044.765593] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.715s) [1044.776751] Starting dynamic subtest: pipe-C-eDP-1-degamma [1046.208060] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.443s) [1046.220266] Starting dynamic subtest: pipe-C-eDP-1-ctm [1047.656340] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.448s) [1048.446672] Starting dynamic subtest: pipe-D-eDP-1-gamma [1049.139266] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.703s) [1049.150274] Starting dynamic subtest: pipe-D-eDP-1-degamma [1050.506136] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.367s) [1050.517278] Starting dynamic subtest: pipe-D-eDP-1-ctm [1051.920184] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.413s) [1051.922528] Subtest deep-color: SUCCESS (16.537s) [1052.811791] [130/133] ( 54s left) gem_bad_reloc (negative-reloc-bltcopy) [1052.879581] Subtest negative-reloc-bltcopy: SKIP (0.000s) [1052.954130] [131/133] ( 54s left) kms_dsc (dsc-basic) [1053.049790] Starting subtest: dsc-basic [1053.062835] Subtest dsc-basic: SKIP (0.000s) [1053.121390] [132/133] ( 54s left) gem_exec_fence (syncobj-timeline-chain-engines) [1053.686618] Starting subtest: syncobj-timeline-chain-engines [1053.798352] Subtest syncobj-timeline-chain-engines: SUCCESS (0.112s) [1054.791746] [133/133] ( 52s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-wc) [1054.918462] Starting subtest: psr-rgb565-draw-mmap-wc [1061.680620] Subtest psr-rgb565-draw-mmap-wc: SUCCESS (6.764s) [1061.786131] Closing watchdogs results: parsing output: 0/ for test: kms_frontbuffer_tracking results: parsing output: 1/ for test: gem_exec_reloc results: parsing output: 2/ for test: kms_flip results: parsing output: 3/ for test: kms_big_fb results: parsing output: 4/ for test: kms_ccs results: parsing output: 5/ for test: sysfs_preempt_timeout results: parsing output: 6/ for test: kms_frontbuffer_tracking results: parsing output: 7/ for test: kms_rotation_crc results: parsing output: 8/ for test: kms_busy results: parsing output: 9/ for test: kms_hdr results: parsing output: 10/ for test: gem_ctx_param results: parsing output: 11/ for test: kms_frontbuffer_tracking results: parsing output: 12/ for test: api_intel_allocator results: parsing output: 13/ for test: kms_frontbuffer_tracking results: parsing output: 14/ for test: gem_softpin results: parsing output: 15/ for test: gem_ctx_shared results: parsing output: 16/ for test: kms_flip_scaled_crc results: parsing output: 17/ for test: kms_cursor_crc results: parsing output: 18/ for test: i915_pm_rps results: parsing output: 19/ for test: syncobj_timeline results: parsing output: 20/ for test: kms_frontbuffer_tracking results: parsing output: 21/ for test: syncobj_timeline results: parsing output: 22/ for test: prime_vgem results: parsing output: 23/ for test: gem_reg_read results: parsing output: 24/ for test: gem_ctx_param results: parsing output: 25/ for test: gem_eio results: parsing output: 26/ for test: gem_exec_reloc results: parsing output: 27/ for test: kms_plane_scaling results: parsing output: 28/ for test: kms_setmode results: parsing output: 29/ for test: kms_ccs results: parsing output: 30/ for test: kms_invalid_mode results: parsing output: 31/ for test: gem_exec_params results: parsing output: 32/ for test: kms_pm_lpsp results: parsing output: 33/ for test: i915_pm_rc6_residency results: parsing output: 34/ for test: kms_cursor_legacy results: parsing output: 35/ for test: gem_softpin results: parsing output: 36/ for test: kms_ccs results: parsing output: 37/ for test: kms_flip results: parsing output: 38/ for test: gem_userptr_blits results: parsing output: 39/ for test: gem_pwrite results: parsing output: 40/ for test: kms_psr2_sf results: parsing output: 41/ for test: api_intel_bb results: parsing output: 42/ for test: kms_frontbuffer_tracking results: parsing output: 43/ for test: kms_psr results: parsing output: 44/ for test: kms_big_fb results: parsing output: 45/ for test: gem_exec_fence results: parsing output: 46/ for test: kms_plane_alpha_blend results: parsing output: 47/ for test: perf_pmu results: parsing output: 48/ for test: gem_exec_store results: parsing output: 49/ for test: kms_psr results: parsing output: 50/ for test: gem_userptr_blits results: parsing output: 51/ for test: kms_psr results: parsing output: 52/ for test: syncobj_timeline results: parsing output: 53/ for test: kms_addfb_basic results: parsing output: 54/ for test: gem_gpgpu_fill results: parsing output: 55/ for test: prime_vgem results: parsing output: 56/ for test: kms_big_fb results: parsing output: 57/ for test: kms_content_protection results: parsing output: 58/ for test: gem_ctx_shared results: parsing output: 59/ for test: gem_mmap_gtt results: parsing output: 60/ for test: i915_hangman results: parsing output: 61/ for test: kms_frontbuffer_tracking results: parsing output: 62/ for test: gen9_exec_parse results: parsing output: 63/ for test: kms_big_fb results: parsing output: 64/ for test: gem_ringfill results: parsing output: 65/ for test: kms_cursor_crc results: parsing output: 66/ for test: kms_plane_scaling results: parsing output: 67/ for test: kms_flip results: parsing output: 68/ for test: kms_psr results: parsing output: 69/ for test: kms_universal_plane results: parsing output: 70/ for test: kms_rotation_crc results: parsing output: 71/ for test: kms_vblank results: parsing output: 72/ for test: i915_query results: parsing output: 73/ for test: kms_pm_rpm results: parsing output: 74/ for test: gem_ctx_persistence results: parsing output: 75/ for test: gem_exec_schedule results: parsing output: 76/ for test: gem_exec_create results: parsing output: 77/ for test: gem_blits results: parsing output: 78/ for test: gem_exec_reloc results: parsing output: 79/ for test: gem_pxp results: parsing output: 80/ for test: kms_async_flips results: parsing output: 81/ for test: gem_exec_suspend results: parsing output: 82/ for test: kms_chamelium_hpd results: parsing output: 83/ for test: kms_frontbuffer_tracking results: parsing output: 84/ for test: gem_exec_schedule results: parsing output: 85/ for test: gem_exec_reloc results: parsing output: 86/ for test: kms_frontbuffer_tracking results: parsing output: 87/ for test: kms_ccs results: parsing output: 88/ for test: kms_psr results: parsing output: 89/ for test: kms_psr results: parsing output: 90/ for test: kms_prop_blob results: parsing output: 91/ for test: gem_exec_reloc results: parsing output: 92/ for test: gem_mmap_gtt results: parsing output: 93/ for test: perf_pmu results: parsing output: 94/ for test: kms_ccs results: parsing output: 95/ for test: kms_cursor_crc results: parsing output: 96/ for test: kms_cursor_legacy results: parsing output: 97/ for test: gem_create results: parsing output: 98/ for test: syncobj_wait results: parsing output: 99/ for test: kms_big_fb results: parsing output: 100/ for test: kms_cursor_legacy results: parsing output: 101/ for test: vgem_basic results: parsing output: 102/ for test: syncobj_timeline results: parsing output: 103/ for test: kms_big_fb results: parsing output: 104/ for test: gem_partial_pwrite_pread results: parsing output: 105/ for test: syncobj_timeline results: parsing output: 106/ for test: kms_frontbuffer_tracking results: parsing output: 107/ for test: kms_frontbuffer_tracking results: parsing output: 108/ for test: gem_exec_reloc results: parsing output: 109/ for test: kms_chamelium_edid results: parsing output: 110/ for test: kms_async_flips results: parsing output: 111/ for test: kms_frontbuffer_tracking results: parsing output: 112/ for test: core_getversion results: parsing output: 113/ for test: kms_plane results: parsing output: 114/ for test: kms_frontbuffer_tracking results: parsing output: 115/ for test: kms_fbcon_fbt results: parsing output: 116/ for test: kms_frontbuffer_tracking results: parsing output: 117/ for test: kms_plane results: parsing output: 118/ for test: syncobj_wait results: parsing output: 119/ for test: syncobj_wait results: parsing output: 120/ for test: kms_legacy_colorkey results: parsing output: 121/ for test: gen9_exec_parse results: parsing output: 122/ for test: gem_fence_thrash results: parsing output: 123/ for test: gem_exec_gttfill results: parsing output: 124/ for test: gem_partial_pwrite_pread results: parsing output: 125/ for test: gem_exec_balancer results: parsing output: 126/ for test: kms_frontbuffer_tracking results: parsing output: 127/ for test: kms_cursor_legacy results: parsing output: 128/ for test: kms_color results: parsing output: 129/ for test: gem_bad_reloc results: parsing output: 130/ for test: kms_dsc results: parsing output: 131/ for test: gem_exec_fence results: parsing output: 132/ for test: kms_frontbuffer_tracking Done.