[63.915219] Initializing watchdogs [63.915289] /dev/watchdog0 [63.935770] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770] [63.946709] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0 [63.950617] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [63.953132] [001/133] (960s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-wc) [65.464222] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-wc [65.465919] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-wc: SKIP (0.000s) [65.611650] [002/133] (958s left) gem_flink_basic (bad-open) [65.715827] Starting subtest: bad-open [65.716627] Subtest bad-open: SUCCESS (0.000s) [65.869496] [003/133] (958s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move) [67.378445] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move [67.380303] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s) [67.809567] [004/133] (956s left) gem_ppgtt (shrink-vs-evict-pinned) [67.938004] Starting subtest: shrink-vs-evict-pinned [75.881218] Subtest shrink-vs-evict-pinned: SUCCESS (7.948s) [75.952153] [005/133] (948s left) gem_exec_schedule (implicit-boths) [76.031698] Starting subtest: implicit-boths [76.032564] Starting dynamic subtest: rcs0 [76.326905] Dynamic subtest rcs0: SUCCESS (0.295s) [76.334600] Starting dynamic subtest: bcs0 [76.532921] Dynamic subtest bcs0: SUCCESS (0.206s) [76.540772] Starting dynamic subtest: vcs0 [76.746934] Dynamic subtest vcs0: SUCCESS (0.214s) [76.754726] Starting dynamic subtest: vcs1 [76.963871] Dynamic subtest vcs1: SUCCESS (0.217s) [76.971574] Starting dynamic subtest: vecs0 [77.178987] Dynamic subtest vecs0: SUCCESS (0.215s) [77.186574] Starting dynamic subtest: vecs1 [77.396616] Dynamic subtest vecs1: SUCCESS (0.217s) [77.404405] Starting dynamic subtest: ccs0 [77.609168] Dynamic subtest ccs0: SUCCESS (0.212s) [77.610170] Subtest implicit-boths: SUCCESS (1.578s) [78.080153] [006/133] (946s left) vgem_slow (nohang) [78.178873] Starting subtest: nohang [88.665063] Subtest nohang: SUCCESS (10.485s) [88.742814] [FACT vgem_slow (nohang)] new: kernel.kmod_is_loaded.vgem: true [88.744472] [007/133] (936s left) gem_exec_schedule (u-submit-late-slice) [88.838817] Starting subtest: u-submit-late-slice [88.839746] Starting dynamic subtest: rcs0 [88.922668] Dynamic subtest rcs0: SUCCESS (0.084s) [88.930783] Starting dynamic subtest: bcs0 [88.978475] Dynamic subtest bcs0: SUCCESS (0.056s) [88.986754] Starting dynamic subtest: vcs0 [89.028203] Dynamic subtest vcs0: SUCCESS (0.049s) [89.036926] Starting dynamic subtest: vcs1 [89.081005] Dynamic subtest vcs1: SUCCESS (0.052s) [89.089255] Starting dynamic subtest: vecs0 [89.130528] Dynamic subtest vecs0: SUCCESS (0.049s) [89.138533] Starting dynamic subtest: vecs1 [89.185697] Dynamic subtest vecs1: SUCCESS (0.055s) [89.194623] Starting dynamic subtest: ccs0 [89.236014] Dynamic subtest ccs0: SUCCESS (0.050s) [89.237120] Subtest u-submit-late-slice: SUCCESS (0.397s) [89.670044] [008/133] (935s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-rc-ccs) [91.182022] Starting subtest: missing-ccs-buffer-y-tiled-gen12-rc-ccs [91.182874] Starting dynamic subtest: pipe-A-HDMI-A-3 [91.191232] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s) [91.199429] Starting dynamic subtest: pipe-B-HDMI-A-3 [91.207725] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s) [91.216142] Starting dynamic subtest: pipe-C-HDMI-A-3 [91.224251] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s) [91.232440] Starting dynamic subtest: pipe-D-HDMI-A-3 [91.242729] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s) [91.244734] Subtest missing-ccs-buffer-y-tiled-gen12-rc-ccs: SKIP (0.004s) [91.444238] [009/133] (933s left) kms_cursor_legacy (torture-move) [92.964249] Starting subtest: torture-move [92.965182] Starting dynamic subtest: pipe-A [98.480936] Dynamic subtest pipe-A: SUCCESS (5.523s) [98.489635] Starting dynamic subtest: pipe-B [103.944135] Dynamic subtest pipe-B: SUCCESS (5.462s) [103.952268] Starting dynamic subtest: pipe-C [109.403963] Dynamic subtest pipe-C: SUCCESS (5.459s) [109.413066] Starting dynamic subtest: pipe-D [114.861497] Dynamic subtest pipe-D: SUCCESS (5.457s) [114.870828] Starting dynamic subtest: all-pipes [120.325577] Dynamic subtest all-pipes: SUCCESS (5.464s) [120.327216] Subtest torture-move: SUCCESS (27.367s) [120.428242] [010/133] (904s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-cpu) [121.986743] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-cpu [121.988423] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [122.114312] [011/133] (902s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-wc) [123.656914] Starting subtest: psr-rgb101010-draw-mmap-wc [123.658562] Subtest psr-rgb101010-draw-mmap-wc: SKIP (0.000s) [123.809248] [012/133] (901s left) i915_drm_fdinfo (virtual-busy-idle) [123.910367] Starting subtest: virtual-busy-idle [123.912156] Subtest virtual-busy-idle: SKIP (0.000s) [124.085818] [013/133] (901s left) kms_vblank (ts-continuation-modeset) [125.600456] Starting subtest: ts-continuation-modeset [125.601403] Starting dynamic subtest: pipe-A-HDMI-A-3 [126.050162] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.449s) [126.060175] Starting dynamic subtest: pipe-D-HDMI-A-3 [126.302108] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.249s) [126.302963] Subtest ts-continuation-modeset: SUCCESS (0.702s) [126.460902] [014/133] (898s left) i915_pm_rps (thresholds-idle) [126.549481] Starting subtest: thresholds-idle [126.551384] Subtest thresholds-idle: SKIP (0.001s) [126.649478] [015/133] (898s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs-cc) [128.163041] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs-cc [128.163979] Starting dynamic subtest: pipe-A-HDMI-A-3 [128.172609] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s) [128.180976] Starting dynamic subtest: pipe-B-HDMI-A-3 [128.189863] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s) [128.198090] Starting dynamic subtest: pipe-C-HDMI-A-3 [128.206484] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s) [128.214449] Starting dynamic subtest: pipe-D-HDMI-A-3 [128.222887] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s) [128.224652] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s) [128.416525] [016/133] (897s left) gem_ctx_bad_destroy (invalid-default-ctx) [128.496491] Starting subtest: invalid-default-ctx [128.497397] Subtest invalid-default-ctx: SUCCESS (0.000s) [128.635159] [017/133] (896s left) gem_fence_thrash (bo-write-verify-threaded-y) [128.684675] Starting subtest: bo-write-verify-threaded-y [128.716009] Subtest bo-write-verify-threaded-y: SKIP (0.031s) [128.793612] [018/133] (896s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt) [130.310558] Starting subtest: fbcpsr-farfromfence-mmap-gtt [130.312257] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s) [130.463524] [019/133] (895s left) kms_color_pipeline (plane-lut1d-lut1d) [132.007039] Starting subtest: plane-lut1d-lut1d [132.216266] Starting dynamic subtest: pipe-A-plane-0 [132.449593] Dynamic subtest pipe-A-plane-0: SUCCESS (0.233s) [132.478261] Starting dynamic subtest: pipe-A-plane-1 [132.648469] Dynamic subtest pipe-A-plane-1: SUCCESS (0.199s) [132.657490] Starting dynamic subtest: pipe-A-plane-2 [132.815163] Dynamic subtest pipe-A-plane-2: SUCCESS (0.166s) [133.095547] Starting dynamic subtest: pipe-B-plane-0 [133.268942] Dynamic subtest pipe-B-plane-0: SUCCESS (0.200s) [133.297213] Starting dynamic subtest: pipe-B-plane-1 [133.468017] Dynamic subtest pipe-B-plane-1: SUCCESS (0.199s) [133.476455] Starting dynamic subtest: pipe-B-plane-2 [133.635536] Dynamic subtest pipe-B-plane-2: SUCCESS (0.167s) [133.919795] Starting dynamic subtest: pipe-C-plane-0 [134.093050] Dynamic subtest pipe-C-plane-0: SUCCESS (0.199s) [134.101400] Starting dynamic subtest: pipe-C-plane-1 [134.259595] Dynamic subtest pipe-C-plane-1: SUCCESS (0.166s) [134.267775] Starting dynamic subtest: pipe-C-plane-2 [134.427428] Dynamic subtest pipe-C-plane-2: SUCCESS (0.167s) [134.735404] Starting dynamic subtest: pipe-D-plane-0 [134.925960] Dynamic subtest pipe-D-plane-0: SUCCESS (0.217s) [134.953071] Starting dynamic subtest: pipe-D-plane-1 [135.125720] Dynamic subtest pipe-D-plane-1: SUCCESS (0.199s) [135.138183] Starting dynamic subtest: pipe-D-plane-2 [135.292433] Dynamic subtest pipe-D-plane-2: SUCCESS (0.166s) [135.348165] Subtest plane-lut1d-lut1d: SUCCESS (3.343s) [135.523909] [020/133] (890s left) gem_ctx_shared (create-shared-gtt) [135.618959] Starting subtest: create-shared-gtt [137.770230] Subtest create-shared-gtt: SUCCESS (2.152s) [139.440531] [021/133] (886s left) gem_exec_create (basic) [139.528467] Starting subtest: basic [139.529371] Starting dynamic subtest: smem [141.633299] Dynamic subtest smem: SUCCESS (2.105s) [141.641894] Starting dynamic subtest: lmem0 [143.740450] Dynamic subtest lmem0: SUCCESS (2.107s) [143.741515] Subtest basic: SUCCESS (4.212s) [143.943516] [022/133] (881s left) syncobj_timeline (single-wait-signaled) [144.023933] Starting subtest: single-wait-signaled [144.024931] Subtest single-wait-signaled: SUCCESS (0.001s) [144.170689] [023/133] (881s left) kms_chamelium_audio (dp-audio) [145.732379] Subtest dp-audio: SKIP (0.000s) [145.832966] [024/133] (880s left) gem_pwrite_snooped [146.018164] [025/133] (879s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render) [147.533084] Starting subtest: fbc-rgb101010-draw-render [150.416534] Subtest fbc-rgb101010-draw-render: SUCCESS (2.883s) [150.559718] [026/133] (875s left) perf (gen12-invalid-class-instance) [150.926608] Starting subtest: gen12-invalid-class-instance [150.945037] Subtest gen12-invalid-class-instance: SUCCESS (0.018s) [150.994538] [027/133] (875s left) kms_psr (fbc-psr-primary-page-flip) [152.510514] Subtest fbc-psr-primary-page-flip: SKIP (0.000s) [152.574009] [028/133] (873s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip) [154.105990] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip [154.107829] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s) [154.243862] [029/133] (871s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen) [155.786131] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen [155.787900] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [155.918233] [030/133] (870s left) gem_exec_params (sol-reset-invalid) [156.026487] Starting subtest: sol-reset-invalid [156.028335] Subtest sol-reset-invalid: SUCCESS (0.002s) [156.186486] [031/133] (870s left) gem_mmap_gtt (zero-extend) [156.264963] Subtest zero-extend: SKIP (0.000s) [156.324321] [032/133] (870s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0) [157.847394] Starting subtest: linear-max-hw-stride-64bpp-rotate-0 [159.150184] Subtest linear-max-hw-stride-64bpp-rotate-0: SUCCESS (1.302s) [159.329428] [033/133] (867s left) kms_rotation_crc (primary-x-tiled-reflect-x-0) [160.841555] Starting subtest: primary-x-tiled-reflect-x-0 [171.143334] Subtest primary-x-tiled-reflect-x-0: SUCCESS (10.302s) [171.492533] [034/133] (855s left) kms_big_fb (linear-32bpp-rotate-0) [173.022045] Starting subtest: linear-32bpp-rotate-0 [174.848948] Subtest linear-32bpp-rotate-0: SUCCESS (1.826s) [175.018532] [035/133] (851s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling) [176.527426] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling [176.528326] Starting dynamic subtest: pipe-A-valid-mode [177.408338] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.881s) [177.409233] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (0.882s) [177.598831] [036/133] (849s left) kms_ccs (crc-primary-basic-yf-tiled-ccs) [179.108099] Starting subtest: crc-primary-basic-yf-tiled-ccs [179.109019] Starting dynamic subtest: pipe-A-HDMI-A-3 [179.117382] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.001s) [179.126314] Starting dynamic subtest: pipe-B-HDMI-A-3 [179.134964] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.001s) [179.143651] Starting dynamic subtest: pipe-C-HDMI-A-3 [179.152141] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.001s) [179.160510] Starting dynamic subtest: pipe-D-HDMI-A-3 [179.170841] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.001s) [179.172997] Subtest crc-primary-basic-yf-tiled-ccs: SKIP (0.007s) [179.431746] [037/133] (847s left) kms_plane (pixel-format-x-tiled-modifier) [180.941007] Starting subtest: pixel-format-x-tiled-modifier [180.975513] Starting dynamic subtest: pipe-A-plane-0 [182.109035] Dynamic subtest pipe-A-plane-0: SUCCESS (1.133s) [182.118585] Starting dynamic subtest: pipe-A-plane-3 [182.792170] Dynamic subtest pipe-A-plane-3: SUCCESS (0.683s) [182.802227] Starting dynamic subtest: pipe-A-plane-5 [182.804262] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [182.951800] Starting dynamic subtest: pipe-B-plane-0 [183.961260] Dynamic subtest pipe-B-plane-0: SUCCESS (1.017s) [183.973178] Starting dynamic subtest: pipe-B-plane-3 [184.661347] Dynamic subtest pipe-B-plane-3: SUCCESS (0.699s) [184.673992] Starting dynamic subtest: pipe-B-plane-5 [184.675603] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [184.716436] Subtest pixel-format-x-tiled-modifier: SUCCESS (3.776s) [184.949620] [038/133] (841s left) kms_psr (psr2-primary-render) [186.462165] Subtest psr2-primary-render: SKIP (0.000s) [186.513161] [039/133] (840s left) kms_cursor_legacy (cursor-vs-flip-atomic) [188.024422] Starting subtest: cursor-vs-flip-atomic [218.994525] Subtest cursor-vs-flip-atomic: SUCCESS (30.970s) [219.165618] [040/133] (807s left) gem_ctx_freq (sysfs) [219.252919] Starting subtest: sysfs [219.253845] Starting dynamic subtest: gt0 [224.868349] Dynamic subtest gt0: SUCCESS (5.614s) [224.869919] Subtest sysfs: SUCCESS (5.616s) [225.058601] [041/133] (801s left) gem_lmem_swapping (heavy-verify-multi) [229.580929] Starting subtest: heavy-verify-multi [229.582162] Starting dynamic subtest: lmem0 [242.995574] Dynamic subtest lmem0: SUCCESS (13.414s) [242.996488] Subtest heavy-verify-multi: SUCCESS (13.415s) [244.097332] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0 [244.098345] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: kernel.kmod_is_loaded.i915: true [244.101129] [042/133] (782s left) kms_plane_multiple (tiling-none) [249.057289] Starting subtest: tiling-none [249.058212] Starting dynamic subtest: pipe-A-HDMI-A-3 [249.883849] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.826s) [249.895198] Starting dynamic subtest: pipe-B-HDMI-A-3 [250.600193] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.714s) [250.610139] Starting dynamic subtest: pipe-C-HDMI-A-3 [251.325985] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.724s) [251.335359] Starting dynamic subtest: pipe-D-HDMI-A-3 [252.018242] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.692s) [252.019202] Subtest tiling-none: SUCCESS (2.961s) [252.241775] [FACT kms_plane_multiple (tiling-none)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0 [252.244287] [FACT kms_plane_multiple (tiling-none)] new: kernel.kmod_is_loaded.i915: true [252.246760] [043/133] (774s left) gem_partial_pwrite_pread (reads) [252.338792] Subtest reads: SKIP (0.000s) [252.414135] [044/133] (774s left) kms_ccs (crc-primary-suspend-4-tiled-lnl-ccs) [253.926258] Starting subtest: crc-primary-suspend-4-tiled-lnl-ccs [253.927967] Subtest crc-primary-suspend-4-tiled-lnl-ccs: SKIP (0.000s) [254.131039] [045/133] (773s left) core_getclient (basic) [254.210379] Starting subtest: basic [254.211276] Subtest basic: SUCCESS (0.000s) [254.346203] [046/133] (772s left) gem_eio (create) [254.618249] Starting subtest: create [255.078185] Subtest create: SUCCESS (0.460s) [256.609455] [047/133] (770s left) gem_exec_schedule (smoketest) [256.847341] Starting subtest: smoketest [256.858097] Starting dynamic subtest: rcs0 [262.322276] Dynamic subtest rcs0: SUCCESS (5.480s) [262.333226] Starting dynamic subtest: bcs0 [267.785869] Dynamic subtest bcs0: SUCCESS (5.462s) [267.796427] Starting dynamic subtest: vcs0 [273.247876] Dynamic subtest vcs0: SUCCESS (5.461s) [273.258264] Starting dynamic subtest: vcs1 [278.706432] Dynamic subtest vcs1: SUCCESS (5.459s) [278.717206] Starting dynamic subtest: vecs0 [284.171928] Dynamic subtest vecs0: SUCCESS (5.465s) [284.181949] Starting dynamic subtest: vecs1 [289.640106] Dynamic subtest vecs1: SUCCESS (5.467s) [289.650341] Starting dynamic subtest: ccs0 [295.104141] Dynamic subtest ccs0: SUCCESS (5.462s) [295.105136] Subtest smoketest: SUCCESS (38.261s) [295.427890] [048/133] (731s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [296.943971] Starting subtest: basic-flip-after-cursor-legacy [297.912353] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.968s) [298.094847] [049/133] (729s left) kms_cursor_edge_walk (64x64-top-edge) [299.616587] Starting subtest: 64x64-top-edge [299.617474] Starting dynamic subtest: pipe-A-HDMI-A-3 [302.949890] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (3.332s) [302.960728] Starting dynamic subtest: pipe-D-HDMI-A-3 [306.165436] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (3.213s) [306.166287] Subtest 64x64-top-edge: SUCCESS (6.549s) [306.343764] [050/133] (721s left) syncobj_eventfd (binary-wait-before-signal) [306.421474] Starting subtest: binary-wait-before-signal [306.452387] Subtest binary-wait-before-signal: SUCCESS (0.031s) [306.595813] [051/133] (721s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled) [306.675320] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [306.676226] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [306.832365] [052/133] (720s left) core_auth (basic-auth) [306.913184] Starting subtest: basic-auth [306.930186] Subtest basic-auth: SUCCESS (0.017s) [307.085415] [053/133] (720s left) kms_flip (flip-vs-panning) [308.598733] Starting subtest: flip-vs-panning [308.603360] Starting dynamic subtest: A-HDMI-A3 [316.369409] Dynamic subtest A-HDMI-A3: SUCCESS (7.766s) [316.389020] Starting dynamic subtest: B-HDMI-A3 [324.085599] Dynamic subtest B-HDMI-A3: SUCCESS (7.715s) [324.098735] Starting dynamic subtest: C-HDMI-A3 [331.785633] Dynamic subtest C-HDMI-A3: SUCCESS (7.699s) [331.797779] Starting dynamic subtest: D-HDMI-A3 [339.484720] Dynamic subtest D-HDMI-A3: SUCCESS (7.698s) [339.485581] Subtest flip-vs-panning: SUCCESS (30.887s) [339.721264] [054/133] (688s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic) [341.234926] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic [341.238179] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.002s) [341.386213] [055/133] (686s left) gem_cs_tlb (engines) [341.499174] Starting subtest: engines [341.500140] Starting dynamic subtest: rcs0 [343.656029] Dynamic subtest rcs0: SUCCESS (2.156s) [343.667295] Starting dynamic subtest: bcs0 [345.809484] Dynamic subtest bcs0: SUCCESS (2.152s) [345.820124] Starting dynamic subtest: vcs0 [347.961960] Dynamic subtest vcs0: SUCCESS (2.151s) [347.973935] Starting dynamic subtest: vcs1 [350.116490] Dynamic subtest vcs1: SUCCESS (2.154s) [350.127170] Starting dynamic subtest: vecs0 [352.271538] Dynamic subtest vecs0: SUCCESS (2.154s) [352.282007] Starting dynamic subtest: vecs1 [354.426582] Dynamic subtest vecs1: SUCCESS (2.154s) [354.437189] Starting dynamic subtest: ccs0 [356.580805] Dynamic subtest ccs0: SUCCESS (2.153s) [356.582369] Subtest engines: SUCCESS (15.081s) [356.750094] [056/133] (671s left) gem_vm_create (isolation) [356.840938] Starting subtest: isolation [356.854470] Subtest isolation: SUCCESS (0.014s) [357.004150] [057/133] (671s left) kms_frontbuffer_tracking (psr-1p-pri-indfb-multidraw) [358.522907] Starting subtest: psr-1p-pri-indfb-multidraw [358.524547] Subtest psr-1p-pri-indfb-multidraw: SKIP (0.000s) [358.677975] [058/133] (669s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc) [360.223437] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc [360.225129] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [360.378501] [059/133] (667s left) kms_content_protection (dp-mst-type-0-suspend-resume) [361.988265] Starting subtest: dp-mst-type-0-suspend-resume [361.990224] Subtest dp-mst-type-0-suspend-resume: SKIP (0.000s) [362.172812] [060/133] (666s left) gen9_exec_parse (bb-start-param) [362.264429] Subtest bb-start-param: SKIP (0.000s) [362.339387] [061/133] (666s left) kms_flip (flip-vs-dpms-off-vs-modeset) [363.851389] Starting subtest: flip-vs-dpms-off-vs-modeset [363.856642] Starting dynamic subtest: A-HDMI-A3 [364.614978] Dynamic subtest A-HDMI-A3: SUCCESS (0.758s) [364.626496] Starting dynamic subtest: B-HDMI-A3 [365.269511] Dynamic subtest B-HDMI-A3: SUCCESS (0.653s) [365.279965] Starting dynamic subtest: C-HDMI-A3 [365.920867] Dynamic subtest C-HDMI-A3: SUCCESS (0.650s) [365.931069] Starting dynamic subtest: D-HDMI-A3 [366.573798] Dynamic subtest D-HDMI-A3: SUCCESS (0.652s) [366.574600] Subtest flip-vs-dpms-off-vs-modeset: SUCCESS (2.722s) [366.752269] [062/133] (661s left) kms_psr (fbc-psr2-cursor-mmap-gtt) [368.272520] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.000s) [368.338266] [063/133] (660s left) core_getversion (all-cards) [368.404170] Starting subtest: all-cards [368.440287] Subtest all-cards: SUCCESS (0.037s) [368.490938] [064/133] (660s left) gem_ringfill (legacy-basic) [368.936355] Starting subtest: legacy-basic [368.940574] Starting dynamic subtest: default [369.037258] Dynamic subtest default: SUCCESS (0.099s) [369.051747] Starting dynamic subtest: render [369.080771] Dynamic subtest render: SUCCESS (0.042s) [369.101988] Starting dynamic subtest: bsd [369.124841] Dynamic subtest bsd: SUCCESS (0.042s) [369.149486] Starting dynamic subtest: bsd1 [369.170805] Dynamic subtest bsd1: SUCCESS (0.043s) [369.191503] Starting dynamic subtest: bsd2 [369.214861] Dynamic subtest bsd2: SUCCESS (0.042s) [369.235543] Starting dynamic subtest: blt [369.258791] Dynamic subtest blt: SUCCESS (0.042s) [369.279428] Starting dynamic subtest: vebox [369.302821] Dynamic subtest vebox: SUCCESS (0.042s) [369.303938] Subtest legacy-basic: SUCCESS (0.368s) [369.498900] [065/133] (659s left) gem_media_fill (media-fill) [369.581486] Subtest media-fill: SKIP (0.000s) [369.790014] [066/133] (658s left) perf_pmu (render-node-busy) [369.905046] Starting subtest: render-node-busy [369.905977] Starting dynamic subtest: rcs0 [370.521285] Dynamic subtest rcs0: SUCCESS (0.615s) [370.535904] Starting dynamic subtest: bcs0 [371.081255] Dynamic subtest bcs0: SUCCESS (0.556s) [371.095834] Starting dynamic subtest: vcs0 [371.650313] Dynamic subtest vcs0: SUCCESS (0.565s) [371.664865] Starting dynamic subtest: vcs1 [372.211364] Dynamic subtest vcs1: SUCCESS (0.557s) [372.225782] Starting dynamic subtest: vecs0 [372.773322] Dynamic subtest vecs0: SUCCESS (0.558s) [372.787849] Starting dynamic subtest: vecs1 [373.334320] Dynamic subtest vecs1: SUCCESS (0.557s) [373.374470] Starting dynamic subtest: ccs0 [373.908165] Dynamic subtest ccs0: SUCCESS (0.570s) [373.912432] Subtest render-node-busy: SUCCESS (4.005s) [374.019199] [067/133] (654s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt) [375.538942] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt [375.540588] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s) [375.689550] [068/133] (653s left) gem_partial_pwrite_pread (write-display) [375.798518] Subtest write-display: SKIP (0.000s) [375.896937] [069/133] (652s left) gem_userptr_blits (dmabuf-sync) [375.995618] Starting subtest: dmabuf-sync [376.014940] Subtest dmabuf-sync: SKIP (0.018s) [376.229754] [070/133] (652s left) i915_pm_rps (basic-api) [376.313277] Starting subtest: basic-api [376.315187] Subtest basic-api: SKIP (0.000s) [376.416960] [071/133] (652s left) syncobj_basic (bad-handle-to-fd) [376.493547] Starting subtest: bad-handle-to-fd [376.494482] Subtest bad-handle-to-fd: SUCCESS (0.000s) [376.613585] [072/133] (652s left) sysfs_preempt_timeout (idempotent) [376.700268] Starting subtest: idempotent [376.701184] Starting dynamic subtest: vecs0 [376.702068] Dynamic subtest vecs0: SUCCESS (0.001s) [376.712825] Starting dynamic subtest: ccs0 [376.713746] Dynamic subtest ccs0: SUCCESS (0.001s) [376.724393] Starting dynamic subtest: vcs0 [376.725331] Dynamic subtest vcs0: SUCCESS (0.001s) [376.735870] Starting dynamic subtest: bcs0 [376.736957] Dynamic subtest bcs0: SUCCESS (0.001s) [376.747411] Starting dynamic subtest: vecs1 [376.748567] Dynamic subtest vecs1: SUCCESS (0.001s) [376.758740] Starting dynamic subtest: rcs0 [376.759903] Dynamic subtest rcs0: SUCCESS (0.001s) [376.770496] Starting dynamic subtest: vcs1 [376.771560] Dynamic subtest vcs1: SUCCESS (0.001s) [376.772671] Subtest idempotent: SUCCESS (0.013s) [376.819696] [073/133] (652s left) gem_pxp (reject-modify-context-protection-off-2) [379.420223] Starting subtest: reject-modify-context-protection-off-2 [379.422065] Subtest reject-modify-context-protection-off-2: SKIP (0.000s) [379.507740] [074/133] (649s left) gem_exec_reloc (basic-wc-gtt-noreloc) [379.600796] Subtest basic-wc-gtt-noreloc: SKIP (0.000s) [379.693486] [075/133] (649s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted) [379.774481] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted [379.878415] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.104s) [379.998265] [076/133] (649s left) syncobj_basic (bad-flags-handle-to-fd) [380.079677] Starting subtest: bad-flags-handle-to-fd [380.080571] Subtest bad-flags-handle-to-fd: SUCCESS (0.000s) [380.236655] [077/133] (649s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite) [381.754241] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite [381.756066] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [381.877219] [078/133] (647s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0) [383.422695] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0 [384.711054] Subtest x-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.288s) [384.901905] [079/133] (644s left) gem_exec_balancer (sliced) [384.991702] Starting subtest: sliced [384.993711] Subtest sliced: SKIP (0.000s) [385.413951] [080/133] (644s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf) [386.927340] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (0.000s) [386.989761] [081/133] (642s left) syncobj_timeline (multi-wait-for-submit-signaled) [387.074428] Starting subtest: multi-wait-for-submit-signaled [387.075400] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s) [387.213053] [082/133] (642s left) syncobj_wait (multi-wait-signaled) [387.295469] Starting subtest: multi-wait-signaled [387.296469] Subtest multi-wait-signaled: SUCCESS (0.000s) [387.467032] [083/133] (642s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite) [388.988177] Starting subtest: fbcpsr-rgb101010-draw-pwrite [388.990007] Subtest fbcpsr-rgb101010-draw-pwrite: SKIP (0.000s) [389.149486] [084/133] (640s left) kms_big_fb (yf-tiled-32bpp-rotate-90) [390.707951] Starting subtest: yf-tiled-32bpp-rotate-90 [390.709768] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s) [390.858369] [085/133] (639s left) kms_big_fb (y-tiled-8bpp-rotate-270) [392.405703] Starting subtest: y-tiled-8bpp-rotate-270 [392.407450] Subtest y-tiled-8bpp-rotate-270: SKIP (0.000s) [392.554686] [086/133] (637s left) gem_exec_reloc (basic-write-read-noreloc) [392.663551] Subtest basic-write-read-noreloc: SKIP (0.000s) [392.739358] [087/133] (637s left) kms_dsc (dsc-with-output-formats) [394.253193] Starting subtest: dsc-with-output-formats [394.262835] Subtest dsc-with-output-formats: SKIP (0.001s) [394.348108] [088/133] (635s left) kms_chamelium_color (gamma) [395.882402] Subtest gamma: SKIP (0.000s) [395.939500] [089/133] (634s left) kms_psr (psr-suspend) [397.452483] Subtest psr-suspend: SKIP (0.000s) [397.507025] [090/133] (632s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc) [399.021113] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc [399.022986] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [399.180886] [091/133] (631s left) kms_vblank (accuracy-idle) [400.719112] Starting subtest: accuracy-idle [400.720105] Starting dynamic subtest: pipe-A-HDMI-A-3 [402.983963] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.263s) [402.998052] Starting dynamic subtest: pipe-D-HDMI-A-3 [405.170198] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.182s) [405.171206] Subtest accuracy-idle: SUCCESS (4.452s) [405.329645] [092/133] (625s left) kms_async_flips (async-flip-suspend-resume) [406.844005] Starting subtest: async-flip-suspend-resume [407.067152] Starting dynamic subtest: pipe-A-HDMI-A-3 [427.730733] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (4.975s) [427.896429] Starting dynamic subtest: pipe-B-HDMI-A-3 [448.740742] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (4.423s) [448.902608] Starting dynamic subtest: pipe-C-HDMI-A-3 [469.697113] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (4.419s) [469.859953] Starting dynamic subtest: pipe-D-HDMI-A-3 [490.695054] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (4.390s) [490.700107] Subtest async-flip-suspend-resume: SUCCESS (18.898s) [503.022633] [093/133] (539s left) kms_psr (psr2-cursor-blt) [504.584992] Subtest psr2-cursor-blt: SKIP (0.000s) [504.655560] [094/133] (537s left) kms_plane (plane-position-covered) [506.211602] Starting subtest: plane-position-covered [506.631410] Starting dynamic subtest: pipe-A-plane-1 [507.020406] Dynamic subtest pipe-A-plane-1: SUCCESS (0.381s) [507.034348] Starting dynamic subtest: pipe-A-plane-2 [507.411303] Dynamic subtest pipe-A-plane-2: SUCCESS (0.383s) [507.425926] Starting dynamic subtest: pipe-A-plane-3 [507.801637] Dynamic subtest pipe-A-plane-3: SUCCESS (0.382s) [507.814982] Starting dynamic subtest: pipe-A-plane-4 [508.193476] Dynamic subtest pipe-A-plane-4: SUCCESS (0.383s) [508.206821] Starting dynamic subtest: pipe-A-plane-5 [508.212982] Dynamic subtest pipe-A-plane-5: SUCCESS (0.018s) [508.490571] Starting dynamic subtest: pipe-B-plane-1 [508.848318] Dynamic subtest pipe-B-plane-1: SUCCESS (0.364s) [508.861798] Starting dynamic subtest: pipe-B-plane-2 [509.219367] Dynamic subtest pipe-B-plane-2: SUCCESS (0.364s) [509.232886] Starting dynamic subtest: pipe-B-plane-3 [509.589920] Dynamic subtest pipe-B-plane-3: SUCCESS (0.366s) [509.605170] Starting dynamic subtest: pipe-B-plane-4 [509.963398] Dynamic subtest pipe-B-plane-4: SUCCESS (0.366s) [509.977407] Starting dynamic subtest: pipe-B-plane-5 [509.983250] Dynamic subtest pipe-B-plane-5: SUCCESS (0.019s) [509.984064] Subtest plane-position-covered: SUCCESS (3.705s) [510.166230] [095/133] (532s left) kms_joiner (basic-force-big-joiner) [511.699534] Starting subtest: basic-force-big-joiner [511.701337] Subtest basic-force-big-joiner: SKIP (0.000s) [511.872400] [096/133] (530s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic) [513.420623] Starting subtest: 2x-cursor-vs-flip-atomic [513.423692] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.002s) [513.598771] [097/133] (529s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode) [515.194094] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s) [515.297846] [098/133] (527s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-render) [516.828236] Starting subtest: psr-1p-offscreen-pri-indfb-draw-render [516.829886] Subtest psr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s) [516.964141] [099/133] (525s left) kms_pipe_stress (stress-xrgb8888-4tiled) [518.518186] Starting subtest: stress-xrgb8888-4tiled [531.622883] Subtest stress-xrgb8888-4tiled: SUCCESS (13.071s) [531.762843] [100/133] (511s left) kms_pm_dc (dc6-psr) [534.288886] Starting subtest: dc6-psr [534.290649] Subtest dc6-psr: SKIP (0.000s) [534.411569] [101/133] (508s left) kms_cursor_crc (cursor-alpha-transparent) [535.943468] Starting subtest: cursor-alpha-transparent [535.944399] Starting dynamic subtest: pipe-A-HDMI-A-3 [536.533370] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.589s) [536.548454] Starting dynamic subtest: pipe-D-HDMI-A-3 [536.971829] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.436s) [536.972735] Subtest cursor-alpha-transparent: SUCCESS (1.029s) [537.524361] [102/133] (505s left) i915_drm_fdinfo (virtual-busy-hang) [537.597769] Starting subtest: virtual-busy-hang [537.599566] Subtest virtual-busy-hang: SKIP (0.000s) [537.690162] [103/133] (505s left) kms_psr2_su (page_flip-xrgb8888) [537.770692] Subtest page_flip-XRGB8888: SKIP (0.000s) [537.837462] [104/133] (505s left) kms_force_connector_basic (force-connector-state) [537.991371] Starting subtest: force-connector-state [539.683389] Subtest force-connector-state: SUCCESS (1.691s) [541.400723] [105/133] (501s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling) [542.927615] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-downscaling [542.929411] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.000s) [543.050142] [106/133] (500s left) gem_tiled_blits (basic) [543.155849] Subtest basic: SKIP (0.000s) [543.226344] [107/133] (500s left) gem_userptr_blits (access-control) [543.327144] Starting subtest: access-control [543.328862] Subtest access-control: SKIP (0.000s) [543.502731] [108/133] (500s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu) [545.026673] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu [545.028417] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [545.226274] [109/133] (498s left) gem_exec_fence (syncobj-timeline-chain-engines) [545.892295] Starting subtest: syncobj-timeline-chain-engines [546.055734] Subtest syncobj-timeline-chain-engines: SUCCESS (0.165s) [546.430050] [110/133] (497s left) gem_ccs (block-copy-uncompressed) [546.517988] Starting subtest: block-copy-uncompressed [546.521395] Starting dynamic subtest: linear-uncompressed-compfmt0-smem-smem [546.563193] Dynamic subtest linear-uncompressed-compfmt0-smem-smem: SUCCESS (0.044s) [546.578491] Starting dynamic subtest: linear-uncompressed-compfmt0-smem-lmem0 [546.580029] Dynamic subtest linear-uncompressed-compfmt0-smem-lmem0: SUCCESS (0.015s) [546.593645] Starting dynamic subtest: linear-uncompressed-compfmt0-lmem0-smem [546.670872] Dynamic subtest linear-uncompressed-compfmt0-lmem0-smem: SUCCESS (0.091s) [546.685560] Starting dynamic subtest: linear-uncompressed-compfmt0-lmem0-lmem0 [546.772915] Dynamic subtest linear-uncompressed-compfmt0-lmem0-lmem0: SUCCESS (0.101s) [546.787676] Starting dynamic subtest: xmajor-uncompressed-compfmt0-smem-smem [546.790146] Dynamic subtest xmajor-uncompressed-compfmt0-smem-smem: SUCCESS (0.016s) [546.804776] Starting dynamic subtest: xmajor-uncompressed-compfmt0-smem-lmem0 [546.805684] Dynamic subtest xmajor-uncompressed-compfmt0-smem-lmem0: SUCCESS (0.014s) [546.819068] Starting dynamic subtest: xmajor-uncompressed-compfmt0-lmem0-smem [546.904303] Dynamic subtest xmajor-uncompressed-compfmt0-lmem0-smem: SUCCESS (0.098s) [546.919151] Starting dynamic subtest: xmajor-uncompressed-compfmt0-lmem0-lmem0 [547.007886] Dynamic subtest xmajor-uncompressed-compfmt0-lmem0-lmem0: SUCCESS (0.102s) [547.022911] Starting dynamic subtest: tile4-uncompressed-compfmt0-smem-smem [547.024270] Dynamic subtest tile4-uncompressed-compfmt0-smem-smem: SUCCESS (0.015s) [547.039039] Starting dynamic subtest: tile4-uncompressed-compfmt0-smem-lmem0 [547.039938] Dynamic subtest tile4-uncompressed-compfmt0-smem-lmem0: SUCCESS (0.014s) [547.053592] Starting dynamic subtest: tile4-uncompressed-compfmt0-lmem0-smem [547.139121] Dynamic subtest tile4-uncompressed-compfmt0-lmem0-smem: SUCCESS (0.098s) [547.153639] Starting dynamic subtest: tile4-uncompressed-compfmt0-lmem0-lmem0 [547.237909] Dynamic subtest tile4-uncompressed-compfmt0-lmem0-lmem0: SUCCESS (0.098s) [547.252715] Starting dynamic subtest: tile64-uncompressed-compfmt0-smem-smem [547.255327] Dynamic subtest tile64-uncompressed-compfmt0-smem-smem: SUCCESS (0.016s) [547.270183] Starting dynamic subtest: tile64-uncompressed-compfmt0-smem-lmem0 [547.271042] Dynamic subtest tile64-uncompressed-compfmt0-smem-lmem0: SUCCESS (0.014s) [547.284548] Starting dynamic subtest: tile64-uncompressed-compfmt0-lmem0-smem [547.376085] Dynamic subtest tile64-uncompressed-compfmt0-lmem0-smem: SUCCESS (0.105s) [547.391070] Starting dynamic subtest: tile64-uncompressed-compfmt0-lmem0-lmem0 [547.473697] Dynamic subtest tile64-uncompressed-compfmt0-lmem0-lmem0: SUCCESS (0.096s) [547.474620] Subtest block-copy-uncompressed: SUCCESS (0.956s) [547.602235] [111/133] (496s left) kms_big_fb (4-tiled-64bpp-rotate-270) [549.127854] Starting subtest: 4-tiled-64bpp-rotate-270 [549.181922] Subtest 4-tiled-64bpp-rotate-270: SKIP (0.053s) [549.367225] [112/133] (494s left) gem_exec_schedule (preemptive-hang) [549.585887] Starting subtest: preemptive-hang [549.593276] Starting dynamic subtest: rcs0 [559.087515] Dynamic subtest rcs0: SUCCESS (9.514s) [559.101192] Starting dynamic subtest: bcs0 [568.116057] Dynamic subtest bcs0: SUCCESS (9.023s) [568.129969] Starting dynamic subtest: vcs0 [577.085726] Dynamic subtest vcs0: SUCCESS (8.965s) [577.099219] Starting dynamic subtest: vcs1 [586.093941] Dynamic subtest vcs1: SUCCESS (9.003s) [586.107661] Starting dynamic subtest: vecs0 [595.055204] Dynamic subtest vecs0: SUCCESS (8.956s) [595.069208] Starting dynamic subtest: vecs1 [604.083176] Dynamic subtest vecs1: SUCCESS (9.027s) [604.096976] Starting dynamic subtest: ccs0 [613.100070] Dynamic subtest ccs0: SUCCESS (9.020s) [613.100922] Subtest preemptive-hang: SUCCESS (63.516s) [613.362160] [113/133] (430s left) kms_pm_rpm (universal-planes) [617.011946] Starting subtest: universal-planes [617.015556] Starting dynamic subtest: plane-34 [623.952661] Dynamic subtest plane-34: SUCCESS (6.940s) [624.000444] Starting dynamic subtest: plane-64 [630.839641] Dynamic subtest plane-64: SUCCESS (6.884s) [630.887388] Starting dynamic subtest: plane-94 [637.860893] Dynamic subtest plane-94: SUCCESS (7.018s) [637.912913] Starting dynamic subtest: plane-124 [644.834013] Dynamic subtest plane-124: SUCCESS (6.969s) [644.881909] Starting dynamic subtest: plane-134 [651.754601] Dynamic subtest plane-134: SUCCESS (6.915s) [651.808699] Starting dynamic subtest: plane-144 [658.703362] Dynamic subtest plane-144: SUCCESS (6.945s) [658.707072] Subtest universal-planes: SUCCESS (41.691s) [659.678419] [114/133] (384s left) gem_spin_batch (spin-all-new) [659.768893] Starting subtest: spin-all-new [659.827338] Subtest spin-all-new: SUCCESS (0.058s) [660.156122] [115/133] (383s left) gem_exec_reloc (basic-gtt-read-active) [660.241249] Subtest basic-gtt-read-active: SKIP (0.000s) [660.325037] [116/133] (383s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted-signaled) [660.404865] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled [660.405946] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s) [660.531757] [117/133] (383s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic) [662.045413] Starting subtest: 2x-long-flip-vs-cursor-atomic [662.048765] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.002s) [662.208515] [118/133] (382s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen) [663.752331] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen [663.754002] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s) [663.911301] [119/133] (380s left) perf_pmu (semaphore-busy) [664.009907] Starting subtest: semaphore-busy [664.010844] Starting dynamic subtest: rcs0 [665.673900] Dynamic subtest rcs0: SUCCESS (1.661s) [665.688058] Starting dynamic subtest: bcs0 [667.310703] Dynamic subtest bcs0: SUCCESS (1.633s) [667.324901] Starting dynamic subtest: vcs0 [668.948121] Dynamic subtest vcs0: SUCCESS (1.633s) [668.966475] Starting dynamic subtest: vcs1 [670.587952] Dynamic subtest vcs1: SUCCESS (1.635s) [670.603652] Starting dynamic subtest: vecs0 [672.223145] Dynamic subtest vecs0: SUCCESS (1.631s) [672.241064] Starting dynamic subtest: vecs1 [673.862346] Dynamic subtest vecs1: SUCCESS (1.635s) [673.878540] Starting dynamic subtest: ccs0 [675.499525] Dynamic subtest ccs0: SUCCESS (1.633s) [675.501169] Subtest semaphore-busy: SUCCESS (11.487s) [675.664289] [120/133] (368s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area) [677.180773] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s) [677.244415] [121/133] (367s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt) [678.765837] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt [678.767618] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s) [678.915654] [122/133] (365s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen) [680.463390] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen [680.465277] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [680.620381] [123/133] (364s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted) [680.726873] Starting subtest: multi-wait-all-for-submit-available-submitted [680.727825] Subtest multi-wait-all-for-submit-available-submitted: SUCCESS (0.001s) [680.881840] [124/133] (363s left) api_intel_allocator (two-level-inception) [680.961911] Starting subtest: two-level-inception [686.385814] Subtest two-level-inception: SUCCESS (5.423s) [686.536608] [125/133] (358s left) kms_async_flips (test-time-stamp) [688.076374] Starting subtest: test-time-stamp [688.289565] Starting dynamic subtest: pipe-A-HDMI-A-3 [688.584387] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.294s) [688.770698] Starting dynamic subtest: pipe-B-HDMI-A-3 [688.869591] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.111s) [689.052793] Starting dynamic subtest: pipe-C-HDMI-A-3 [689.143797] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.103s) [689.308688] Starting dynamic subtest: pipe-D-HDMI-A-3 [689.409401] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.113s) [689.410412] Subtest test-time-stamp: SUCCESS (1.333s) [689.780730] [126/133] (355s left) drm_read (empty-nonblock) [691.366429] Starting subtest: empty-nonblock [691.367400] Subtest empty-nonblock: SUCCESS (0.000s) [691.576782] [127/133] (353s left) kms_lease (lease-again) [693.090586] Starting subtest: lease-again [693.091475] Starting dynamic subtest: pipe-A-HDMI-A-3 [693.095646] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.004s) [693.111468] Starting dynamic subtest: pipe-B-HDMI-A-3 [693.112407] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.004s) [693.126630] Starting dynamic subtest: pipe-C-HDMI-A-3 [693.127580] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.004s) [693.141250] Starting dynamic subtest: pipe-D-HDMI-A-3 [693.142165] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.004s) [693.142977] Subtest lease-again: SUCCESS (0.024s) [693.256726] [128/133] (351s left) gem_exec_balancer (indices) [693.358967] Starting subtest: indices [695.005797] Subtest indices: SUCCESS (1.646s) [695.434548] [129/133] (349s left) kms_cursor_crc (cursor-rapid-movement-256x85) [697.199739] Starting subtest: cursor-rapid-movement-256x85 [697.203575] Starting dynamic subtest: pipe-A-HDMI-A-3 [697.607586] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.403s) [697.644344] Starting dynamic subtest: pipe-D-HDMI-A-3 [697.931349] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.300s) [697.932252] Subtest cursor-rapid-movement-256x85: SUCCESS (0.732s) [698.220554] [130/133] (346s left) gem_basic (create-fd-close) [698.302898] Starting subtest: create-fd-close [698.304734] Subtest create-fd-close: SUCCESS (0.000s) [698.459575] [131/133] (346s left) core_auth (many-magics) [698.537901] Starting subtest: many-magics [700.308550] Subtest many-magics: SUCCESS (1.771s) [700.742760] [132/133] (344s left) kms_flip (2x-absolute-wf_vblank-interruptible) [702.259795] Starting subtest: 2x-absolute-wf_vblank-interruptible [702.273540] Subtest 2x-absolute-wf_vblank-interruptible: SKIP (0.013s) [702.386454] [133/133] (343s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers) [703.923433] Starting subtest: plane-upscale-factor-0-25-with-modifiers [703.924336] Starting dynamic subtest: pipe-A [704.486630] Dynamic subtest pipe-A: SUCCESS (0.564s) [704.528598] Starting dynamic subtest: pipe-B [705.078362] Dynamic subtest pipe-B: SUCCESS (0.589s) [705.100280] Starting dynamic subtest: pipe-C [705.637534] Dynamic subtest pipe-C: SUCCESS (0.558s) [705.659152] Starting dynamic subtest: pipe-D [706.195668] Dynamic subtest pipe-D: SUCCESS (0.556s) [706.196858] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (2.274s) [706.417182] Closing watchdogs results: parsing output: 0/ for test: kms_frontbuffer_tracking results: parsing output: 1/ for test: gem_flink_basic results: parsing output: 2/ for test: kms_frontbuffer_tracking results: parsing output: 3/ for test: gem_ppgtt results: parsing output: 4/ for test: gem_exec_schedule results: parsing output: 5/ for test: vgem_slow results: parsing output: 6/ for test: gem_exec_schedule results: parsing output: 7/ for test: kms_ccs results: parsing output: 8/ for test: kms_cursor_legacy results: parsing output: 9/ for test: kms_frontbuffer_tracking results: parsing output: 10/ for test: kms_frontbuffer_tracking results: parsing output: 11/ for test: i915_drm_fdinfo results: parsing output: 12/ for test: kms_vblank results: parsing output: 13/ for test: i915_pm_rps results: parsing output: 14/ for test: kms_ccs results: parsing output: 15/ for test: gem_ctx_bad_destroy results: parsing output: 16/ for test: gem_fence_thrash results: parsing output: 17/ for test: kms_frontbuffer_tracking results: parsing output: 18/ for test: kms_color_pipeline results: parsing output: 19/ for test: gem_ctx_shared results: parsing output: 20/ for test: gem_exec_create results: parsing output: 21/ for test: syncobj_timeline results: parsing output: 22/ for test: kms_chamelium_audio results: parsing output: 23/ for test: gem_pwrite_snooped results: parsing output: 24/ for test: kms_frontbuffer_tracking results: parsing output: 25/ for test: perf results: parsing output: 26/ for test: kms_psr results: parsing output: 27/ for test: kms_big_fb results: parsing output: 28/ for test: kms_frontbuffer_tracking results: parsing output: 29/ for test: gem_exec_params results: parsing output: 30/ for test: gem_mmap_gtt results: parsing output: 31/ for test: kms_big_fb results: parsing output: 32/ for test: kms_rotation_crc results: parsing output: 33/ for test: kms_big_fb results: parsing output: 34/ for test: kms_flip_scaled_crc results: parsing output: 35/ for test: kms_ccs results: parsing output: 36/ for test: kms_plane results: parsing output: 37/ for test: kms_psr results: parsing output: 38/ for test: kms_cursor_legacy results: parsing output: 39/ for test: gem_ctx_freq results: parsing output: 40/ for test: gem_lmem_swapping results: parsing output: 41/ for test: kms_plane_multiple results: parsing output: 42/ for test: gem_partial_pwrite_pread results: parsing output: 43/ for test: kms_ccs results: parsing output: 44/ for test: core_getclient results: parsing output: 45/ for test: gem_eio results: parsing output: 46/ for test: gem_exec_schedule results: parsing output: 47/ for test: kms_cursor_legacy results: parsing output: 48/ for test: kms_cursor_edge_walk results: parsing output: 49/ for test: syncobj_eventfd results: parsing output: 50/ for test: syncobj_wait results: parsing output: 51/ for test: core_auth results: parsing output: 52/ for test: kms_flip results: parsing output: 53/ for test: kms_cursor_legacy results: parsing output: 54/ for test: gem_cs_tlb results: parsing output: 55/ for test: gem_vm_create results: parsing output: 56/ for test: kms_frontbuffer_tracking results: parsing output: 57/ for test: kms_frontbuffer_tracking results: parsing output: 58/ for test: kms_content_protection results: parsing output: 59/ for test: gen9_exec_parse results: parsing output: 60/ for test: kms_flip results: parsing output: 61/ for test: kms_psr results: parsing output: 62/ for test: core_getversion results: parsing output: 63/ for test: gem_ringfill results: parsing output: 64/ for test: gem_media_fill results: parsing output: 65/ for test: perf_pmu results: parsing output: 66/ for test: kms_frontbuffer_tracking results: parsing output: 67/ for test: gem_partial_pwrite_pread results: parsing output: 68/ for test: gem_userptr_blits results: parsing output: 69/ for test: i915_pm_rps results: parsing output: 70/ for test: syncobj_basic results: parsing output: 71/ for test: sysfs_preempt_timeout results: parsing output: 72/ for test: gem_pxp results: parsing output: 73/ for test: gem_exec_reloc results: parsing output: 74/ for test: syncobj_timeline results: parsing output: 75/ for test: syncobj_basic results: parsing output: 76/ for test: kms_frontbuffer_tracking results: parsing output: 77/ for test: kms_big_fb results: parsing output: 78/ for test: gem_exec_balancer results: parsing output: 79/ for test: kms_psr2_sf results: parsing output: 80/ for test: syncobj_timeline results: parsing output: 81/ for test: syncobj_wait results: parsing output: 82/ for test: kms_frontbuffer_tracking results: parsing output: 83/ for test: kms_big_fb results: parsing output: 84/ for test: kms_big_fb results: parsing output: 85/ for test: gem_exec_reloc results: parsing output: 86/ for test: kms_dsc results: parsing output: 87/ for test: kms_chamelium_color results: parsing output: 88/ for test: kms_psr results: parsing output: 89/ for test: kms_frontbuffer_tracking results: parsing output: 90/ for test: kms_vblank results: parsing output: 91/ for test: kms_async_flips results: parsing output: 92/ for test: kms_psr results: parsing output: 93/ for test: kms_plane results: parsing output: 94/ for test: kms_joiner results: parsing output: 95/ for test: kms_cursor_legacy results: parsing output: 96/ for test: kms_chamelium_hpd results: parsing output: 97/ for test: kms_frontbuffer_tracking results: parsing output: 98/ for test: kms_pipe_stress results: parsing output: 99/ for test: kms_pm_dc results: parsing output: 100/ for test: kms_cursor_crc results: parsing output: 101/ for test: i915_drm_fdinfo results: parsing output: 102/ for test: kms_psr2_su results: parsing output: 103/ for test: kms_force_connector_basic results: parsing output: 104/ for test: kms_flip_scaled_crc results: parsing output: 105/ for test: gem_tiled_blits results: parsing output: 106/ for test: gem_userptr_blits results: parsing output: 107/ for test: kms_frontbuffer_tracking results: parsing output: 108/ for test: gem_exec_fence results: parsing output: 109/ for test: gem_ccs results: parsing output: 110/ for test: kms_big_fb results: parsing output: 111/ for test: gem_exec_schedule results: parsing output: 112/ for test: kms_pm_rpm results: parsing output: 113/ for test: gem_spin_batch results: parsing output: 114/ for test: gem_exec_reloc results: parsing output: 115/ for test: syncobj_wait results: parsing output: 116/ for test: kms_cursor_legacy results: parsing output: 117/ for test: kms_frontbuffer_tracking results: parsing output: 118/ for test: perf_pmu results: parsing output: 119/ for test: kms_psr2_sf results: parsing output: 120/ for test: kms_frontbuffer_tracking results: parsing output: 121/ for test: kms_frontbuffer_tracking results: parsing output: 122/ for test: syncobj_timeline results: parsing output: 123/ for test: api_intel_allocator results: parsing output: 124/ for test: kms_async_flips results: parsing output: 125/ for test: drm_read results: parsing output: 126/ for test: kms_lease results: parsing output: 127/ for test: gem_exec_balancer results: parsing output: 128/ for test: kms_cursor_crc results: parsing output: 129/ for test: gem_basic results: parsing output: 130/ for test: core_auth results: parsing output: 131/ for test: kms_flip results: parsing output: 132/ for test: kms_plane_scaling Done.