[42.423141] Initializing watchdogs [42.423207] /dev/watchdog0 [42.430313] [001/171] (960s left) i915_module_load (load) [42.496798] Starting subtest: load [43.578382] Subtest load: SUCCESS (1.079s) [43.604714] [002/171] (959s left) core_auth (basic-auth) [43.701184] Starting subtest: basic-auth [43.704584] Subtest basic-auth: SUCCESS (0.000s) [43.758358] [003/171] (959s left) debugfs_test (read_all_entries) [43.826671] Starting subtest: read_all_entries [43.962061] Subtest read_all_entries: SUCCESS (0.134s) [44.074162] [004/171] (958s left) debugfs_test (basic-hwmon) [44.136954] Starting subtest: basic-hwmon [44.143248] Subtest basic-hwmon: SKIP (0.000s) [44.242381] [005/171] (958s left) fbdev (eof) [44.309178] Starting subtest: eof [44.312498] Subtest eof: SUCCESS (0.000s) [44.374308] [006/171] (958s left) fbdev (info) [44.480244] Starting subtest: info [44.483557] Subtest info: SUCCESS (0.000s) [44.541251] [007/171] (958s left) fbdev (nullptr) [44.642395] Starting subtest: nullptr [44.646144] Subtest nullptr: SUCCESS (0.000s) [44.692679] [008/171] (958s left) fbdev (read) [44.792408] Starting subtest: read [45.008248] Subtest read: SUCCESS (0.216s) [45.074179] [009/171] (958s left) fbdev (write) [45.159145] Starting subtest: write [45.272541] Subtest write: SUCCESS (0.113s) [45.324439] [010/171] (957s left) gem_basic (bad-close) [45.434560] Starting subtest: bad-close [45.441554] Subtest bad-close: SUCCESS (0.000s) [45.490412] [011/171] (957s left) gem_basic (create-close) [45.581750] Starting subtest: create-close [45.588731] Subtest create-close: SUCCESS (0.000s) [45.648251] [012/171] (957s left) gem_basic (create-fd-close) [45.727042] Starting subtest: create-fd-close [45.735557] Subtest create-fd-close: SUCCESS (0.000s) [45.838169] [013/171] (957s left) gem_busy (busy@all-engines) [45.918526] Starting subtest: busy [45.921558] Starting dynamic subtest: all-engines [45.940132] Dynamic subtest all-engines: SUCCESS (0.022s) [45.943490] Subtest busy: SUCCESS (0.023s) [46.317663] [014/171] (956s left) gem_close_race (basic-process) [46.394422] Starting subtest: basic-process [46.452542] Subtest basic-process: SUCCESS (0.058s) [46.657377] [015/171] (956s left) gem_close_race (basic-threads) [46.768388] Starting subtest: basic-threads [47.997550] Subtest basic-threads: SUCCESS (1.230s) [48.202364] [016/171] (955s left) gem_ctx_create (basic) [48.277053] Starting subtest: basic [48.279971] Subtest basic: SUCCESS (0.000s) [48.451634] [017/171] (954s left) gem_ctx_create (basic-files) [48.525295] Starting subtest: basic-files [50.532472] Subtest basic-files: SUCCESS (2.009s) [50.988862] [018/171] (952s left) gem_ctx_exec (basic) [51.478210] Starting subtest: basic [51.543884] Subtest basic: SUCCESS (0.002s) [51.838567] [019/171] (952s left) gem_exec_basic (basic) [52.120525] Starting subtest: basic [52.124879] Starting dynamic subtest: rcs0-smem [52.128799] Dynamic subtest rcs0-smem: SUCCESS (0.003s) [52.139431] Starting dynamic subtest: bcs0-smem [52.143136] Dynamic subtest bcs0-smem: SUCCESS (0.002s) [52.149689] Starting dynamic subtest: vcs0-smem [52.152991] Dynamic subtest vcs0-smem: SUCCESS (0.001s) [52.159713] Starting dynamic subtest: vecs0-smem [52.163309] Dynamic subtest vecs0-smem: SUCCESS (0.001s) [52.166552] Subtest basic: SUCCESS (0.009s) [52.520807] [020/171] (951s left) gem_exec_create (basic) [53.033103] Starting subtest: basic [53.101115] Starting dynamic subtest: smem [54.988959] Dynamic subtest smem: SUCCESS (2.037s) [55.055509] Subtest basic: SUCCESS (2.038s) [55.235733] [021/171] (949s left) gem_exec_fence (basic-busy) [55.430048] Starting subtest: basic-busy [55.433463] Starting dynamic subtest: rcs0 [55.458286] Dynamic subtest rcs0: SUCCESS (0.028s) [55.469532] Starting dynamic subtest: bcs0 [55.501697] Dynamic subtest bcs0: SUCCESS (0.042s) [55.525861] Starting dynamic subtest: vcs0 [55.536655] Dynamic subtest vcs0: SUCCESS (0.035s) [55.549070] Starting dynamic subtest: vecs0 [55.576395] Dynamic subtest vecs0: SUCCESS (0.040s) [55.579728] Subtest basic-busy: SUCCESS (0.146s) [56.141112] [022/171] (948s left) gem_exec_fence (basic-wait) [56.316861] Starting subtest: basic-wait [56.320167] Starting dynamic subtest: rcs0 [56.342232] Dynamic subtest rcs0: SUCCESS (0.025s) [56.352041] Starting dynamic subtest: bcs0 [56.376536] Dynamic subtest bcs0: SUCCESS (0.033s) [56.401139] Starting dynamic subtest: vcs0 [56.416476] Dynamic subtest vcs0: SUCCESS (0.040s) [56.439529] Starting dynamic subtest: vecs0 [56.451678] Dynamic subtest vecs0: SUCCESS (0.035s) [56.455382] Subtest basic-wait: SUCCESS (0.135s) [56.935539] [023/171] (947s left) gem_exec_fence (basic-await) [57.121071] Starting subtest: basic-await [57.124127] Starting dynamic subtest: rcs0 [57.192303] Dynamic subtest rcs0: SUCCESS (0.071s) [57.203233] Starting dynamic subtest: bcs0 [57.276543] Dynamic subtest bcs0: SUCCESS (0.083s) [57.299608] Starting dynamic subtest: vcs0 [57.369626] Dynamic subtest vcs0: SUCCESS (0.093s) [57.378200] Starting dynamic subtest: vecs0 [57.445200] Dynamic subtest vecs0: SUCCESS (0.074s) [57.449581] Subtest basic-await: SUCCESS (0.323s) [58.001209] [024/171] (946s left) gem_exec_fence (nb-await) [58.226462] Starting subtest: nb-await [58.230798] Starting dynamic subtest: rcs0 [58.299348] Dynamic subtest rcs0: SUCCESS (0.073s) [58.308184] Starting dynamic subtest: bcs0 [58.358193] Dynamic subtest bcs0: SUCCESS (0.059s) [58.370955] Starting dynamic subtest: vcs0 [58.418178] Dynamic subtest vcs0: SUCCESS (0.059s) [58.441323] Starting dynamic subtest: vecs0 [58.488240] Dynamic subtest vecs0: SUCCESS (0.069s) [58.492510] Subtest nb-await: SUCCESS (0.262s) [59.000647] [025/171] (945s left) gem_exec_gttfill (basic) [59.107605] Starting subtest: basic [63.840671] Subtest basic: SUCCESS (4.734s) [64.005869] [026/171] (940s left) gem_exec_parallel (engines) [64.130388] Starting subtest: engines [64.133474] Starting dynamic subtest: basic [65.524118] Dynamic subtest basic: SUCCESS (1.396s) [65.531550] Starting dynamic subtest: contexts [68.128619] Dynamic subtest contexts: SUCCESS (2.604s) [68.136203] Starting dynamic subtest: fds [70.428472] Dynamic subtest fds: SUCCESS (2.234s) [70.493777] Starting dynamic subtest: userptr [71.968113] Dynamic subtest userptr: SUCCESS (1.605s) [71.971384] Subtest engines: SUCCESS (7.840s) [72.177640] [027/171] (932s left) gem_exec_store (basic) [72.293142] Starting subtest: basic [72.348150] Subtest basic: SUCCESS (0.065s) [72.518195] [028/171] (931s left) gem_flink_basic (bad-flink) [72.608995] Starting subtest: bad-flink [72.612188] Subtest bad-flink: SUCCESS (0.000s) [72.658612] [029/171] (931s left) gem_flink_basic (bad-open) [72.721128] Starting subtest: bad-open [72.724082] Subtest bad-open: SUCCESS (0.000s) [72.776719] [030/171] (931s left) gem_flink_basic (basic) [72.846917] Starting subtest: basic [72.849992] Subtest basic: SUCCESS (0.000s) [72.939558] [031/171] (931s left) gem_flink_basic (double-flink) [73.040492] Starting subtest: double-flink [73.043508] Subtest double-flink: SUCCESS (0.000s) [73.141542] [032/171] (931s left) gem_flink_basic (flink-lifetime) [73.247108] Starting subtest: flink-lifetime [73.250296] Subtest flink-lifetime: SUCCESS (0.001s) [73.340581] [033/171] (931s left) gem_huc_copy (huc-copy) [73.417302] Starting subtest: huc-copy [73.420705] Subtest huc-copy: SUCCESS (0.003s) [73.554285] [034/171] (931s left) gem_linear_blits (basic) [73.747125] Starting subtest: basic [73.754281] Subtest basic: SUCCESS (0.004s) [73.892656] [035/171] (930s left) gem_mmap (basic) [74.059066] Starting subtest: basic [74.075067] Subtest basic: SUCCESS (0.000s) [74.184569] [036/171] (930s left) gem_mmap_gtt (basic) [74.298121] Starting subtest: basic [74.301255] Subtest basic: SUCCESS (0.000s) [74.352145] [037/171] (930s left) gem_render_linear_blits (basic) [74.416427] Starting subtest: basic [74.435210] Subtest basic: SUCCESS (0.018s) [74.468699] [038/171] (930s left) gem_render_tiled_blits (basic) [74.547994] Starting subtest: basic [74.569377] Subtest basic: SUCCESS (0.022s) [74.601653] [039/171] (930s left) gem_ringfill (basic-all) [74.834251] Starting subtest: basic-all [75.964584] Subtest basic-all: SUCCESS (1.128s) [76.103746] [040/171] (928s left) gem_softpin (allocator-basic) [76.182418] Starting subtest: allocator-basic [76.238168] Subtest allocator-basic: SUCCESS (0.058s) [76.360322] [041/171] (928s left) gem_softpin (allocator-basic-reserve) [76.431152] Starting subtest: allocator-basic-reserve [76.488556] Subtest allocator-basic-reserve: SUCCESS (0.060s) [76.620521] [042/171] (928s left) gem_softpin (safe-alignment) [76.696449] Starting subtest: safe-alignment [76.713470] Subtest safe-alignment: SUCCESS (0.007s) [76.817197] [043/171] (928s left) gem_sync (basic-all) [76.906409] Starting subtest: basic-all [79.005655] Subtest basic-all: SUCCESS (2.125s) [79.200244] [044/171] (925s left) gem_sync (basic-each) [79.284283] Starting subtest: basic-each [81.333603] Subtest basic-each: SUCCESS (2.069s) [81.553520] [045/171] (923s left) gem_tiled_blits (basic) [81.737038] Starting subtest: basic [81.748861] Subtest basic: SUCCESS (0.012s) [81.911785] [046/171] (923s left) gem_tiled_fence_blits (basic) [82.145141] Starting subtest: basic [82.152411] Subtest basic: SUCCESS (0.007s) [82.352166] [047/171] (922s left) gem_tiled_pread_basic [82.700340] [048/171] (922s left) gem_wait (busy@all-engines) [82.780845] Starting subtest: busy [82.783955] Starting dynamic subtest: all-engines [83.296105] Dynamic subtest all-engines: SUCCESS (0.515s) [83.299298] Subtest busy: SUCCESS (0.515s) [83.521218] [049/171] (921s left) gem_wait (wait@all-engines) [83.600472] Starting subtest: wait [83.604081] Starting dynamic subtest: all-engines [84.636599] Dynamic subtest all-engines: SUCCESS (1.035s) [84.640768] Subtest wait: SUCCESS (1.035s) [84.838076] [050/171] (920s left) i915_getparams_basic (basic-eu-total) [84.900606] Starting subtest: basic-eu-total [84.907082] Subtest basic-eu-total: SUCCESS (0.000s) [84.971642] [051/171] (920s left) i915_getparams_basic (basic-subslice-total) [85.036077] Starting subtest: basic-subslice-total [85.042407] Subtest basic-subslice-total: SUCCESS (0.000s) [85.094138] [052/171] (920s left) i915_hangman (error-state-basic) [85.187903] Starting subtest: error-state-basic [85.243121] Subtest error-state-basic: SUCCESS (0.054s) [85.324493] [053/171] (919s left) i915_pciid [85.492505] [054/171] (919s left) kms_addfb_basic (addfb25-bad-modifier) [85.562087] Starting subtest: addfb25-bad-modifier [85.565958] Subtest addfb25-bad-modifier: SUCCESS (0.000s) [85.723453] [055/171] (919s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [85.785523] Starting subtest: addfb25-framebuffer-vs-set-tiling [85.788847] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s) [85.906626] [056/171] (919s left) kms_addfb_basic (addfb25-modifier-no-flag) [85.967519] Starting subtest: addfb25-modifier-no-flag [85.970625] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [86.089567] [057/171] (919s left) kms_addfb_basic (addfb25-x-tiled-legacy) [86.150604] Starting subtest: addfb25-x-tiled-legacy [86.153509] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s) [86.289381] [058/171] (919s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [86.356103] Starting subtest: addfb25-x-tiled-mismatch-legacy [86.359686] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.001s) [86.492055] [059/171] (918s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [86.603312] Starting subtest: addfb25-yf-tiled-legacy [86.606191] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [86.676408] [060/171] (918s left) kms_addfb_basic (addfb25-y-tiled-legacy) [86.783058] Starting subtest: addfb25-y-tiled-legacy [86.786271] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s) [86.856789] [061/171] (918s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [86.964738] Starting subtest: addfb25-y-tiled-small-legacy [86.967748] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.000s) [87.039934] [062/171] (918s left) kms_addfb_basic (bad-pitch-0) [87.102957] Starting subtest: bad-pitch-0 [87.106138] Subtest bad-pitch-0: SUCCESS (0.000s) [87.223287] [063/171] (918s left) kms_addfb_basic (bad-pitch-1024) [87.285249] Starting subtest: bad-pitch-1024 [87.288276] Subtest bad-pitch-1024: SUCCESS (0.000s) [87.406496] [064/171] (918s left) kms_addfb_basic (bad-pitch-128) [87.468493] Starting subtest: bad-pitch-128 [87.471716] Subtest bad-pitch-128: SUCCESS (0.000s) [87.590086] [065/171] (917s left) kms_addfb_basic (bad-pitch-256) [87.663467] Starting subtest: bad-pitch-256 [87.666599] Subtest bad-pitch-256: SUCCESS (0.000s) [87.773636] [066/171] (917s left) kms_addfb_basic (bad-pitch-32) [87.837107] Starting subtest: bad-pitch-32 [87.840560] Subtest bad-pitch-32: SUCCESS (0.000s) [87.957147] [067/171] (917s left) kms_addfb_basic (bad-pitch-63) [88.018129] Starting subtest: bad-pitch-63 [88.021127] Subtest bad-pitch-63: SUCCESS (0.000s) [88.139608] [068/171] (917s left) kms_addfb_basic (bad-pitch-65536) [88.203325] Starting subtest: bad-pitch-65536 [88.206637] Subtest bad-pitch-65536: SUCCESS (0.001s) [88.340030] [069/171] (917s left) kms_addfb_basic (bad-pitch-999) [88.404339] Starting subtest: bad-pitch-999 [88.408618] Subtest bad-pitch-999: SUCCESS (0.000s) [88.542122] [070/171] (917s left) kms_addfb_basic (basic) [88.603304] Starting subtest: basic [88.606439] Subtest basic: SUCCESS (0.000s) [88.723571] [071/171] (916s left) kms_addfb_basic (basic-x-tiled-legacy) [88.784849] Starting subtest: basic-x-tiled-legacy [88.788046] Subtest basic-x-tiled-legacy: SUCCESS (0.000s) [88.906692] [072/171] (916s left) kms_addfb_basic (basic-y-tiled-legacy) [88.969054] Starting subtest: basic-y-tiled-legacy [88.972369] Subtest basic-y-tiled-legacy: SUCCESS (0.000s) [89.090069] [073/171] (916s left) kms_addfb_basic (bo-too-small) [89.197913] Starting subtest: bo-too-small [89.200966] Subtest bo-too-small: SUCCESS (0.000s) [89.259426] [074/171] (916s left) kms_addfb_basic (bo-too-small-due-to-tiling) [89.390129] Starting subtest: bo-too-small-due-to-tiling [89.393359] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s) [89.459284] [075/171] (916s left) kms_addfb_basic (clobberred-modifier) [89.521224] Starting subtest: clobberred-modifier [89.524411] Subtest clobberred-modifier: SUCCESS (0.000s) [89.639712] [076/171] (916s left) kms_addfb_basic (framebuffer-vs-set-tiling) [89.701855] Starting subtest: framebuffer-vs-set-tiling [89.705107] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s) [89.823587] [077/171] (915s left) kms_addfb_basic (invalid-get-prop) [89.884406] Starting subtest: invalid-get-prop [89.887567] Subtest invalid-get-prop: SUCCESS (0.000s) [90.012779] [078/171] (915s left) kms_addfb_basic (invalid-get-prop-any) [90.074774] Starting subtest: invalid-get-prop-any [90.078033] Subtest invalid-get-prop-any: SUCCESS (0.000s) [90.206841] [079/171] (915s left) kms_addfb_basic (invalid-set-prop) [90.268411] Starting subtest: invalid-set-prop [90.271743] Subtest invalid-set-prop: SUCCESS (0.000s) [90.390414] [080/171] (915s left) kms_addfb_basic (invalid-set-prop-any) [90.452225] Starting subtest: invalid-set-prop-any [90.455341] Subtest invalid-set-prop-any: SUCCESS (0.000s) [90.572916] [081/171] (915s left) kms_addfb_basic (no-handle) [90.633325] Starting subtest: no-handle [90.636118] Subtest no-handle: SUCCESS (0.000s) [90.755836] [082/171] (915s left) kms_addfb_basic (size-max) [90.861396] Starting subtest: size-max [90.864245] Subtest size-max: SUCCESS (0.000s) [90.939305] [083/171] (914s left) kms_addfb_basic (small-bo) [91.043483] Starting subtest: small-bo [91.046196] Subtest small-bo: SUCCESS (0.000s) [91.123886] [084/171] (914s left) kms_addfb_basic (tile-pitch-mismatch) [91.189489] Starting subtest: tile-pitch-mismatch [91.192989] Subtest tile-pitch-mismatch: SUCCESS (0.001s) [91.323831] [085/171] (914s left) kms_addfb_basic (too-high) [91.477548] Starting subtest: too-high [91.480395] Subtest too-high: SUCCESS (0.000s) [91.508540] [086/171] (914s left) kms_addfb_basic (too-wide) [91.616853] Starting subtest: too-wide [91.620355] Subtest too-wide: SUCCESS (0.000s) [91.690348] [087/171] (914s left) kms_addfb_basic (unused-handle) [91.752668] Starting subtest: unused-handle [91.755730] Subtest unused-handle: SUCCESS (0.000s) [91.873263] [088/171] (914s left) kms_addfb_basic (unused-modifier) [91.934536] Starting subtest: unused-modifier [91.937503] Subtest unused-modifier: SUCCESS (0.000s) [92.056489] [089/171] (913s left) kms_addfb_basic (unused-offsets) [92.117468] Starting subtest: unused-offsets [92.120539] Subtest unused-offsets: SUCCESS (0.000s) [92.239989] [090/171] (913s left) kms_addfb_basic (unused-pitches) [92.306998] Starting subtest: unused-pitches [92.311558] Subtest unused-pitches: SUCCESS (0.000s) [92.442541] [091/171] (913s left) kms_busy (basic) [92.550855] Starting subtest: basic [92.553860] Starting dynamic subtest: flip [93.230330] Dynamic subtest flip: SUCCESS (0.679s) [93.240267] Starting dynamic subtest: modeset [93.824754] Dynamic subtest modeset: SUCCESS (0.595s) [93.827471] Subtest basic: SUCCESS (1.275s) [93.957259] [092/171] (912s left) kms_chamelium_hpd (dp-hpd-fast) [94.118176] Subtest dp-hpd-fast: SKIP (0.000s) [94.183531] [093/171] (911s left) kms_chamelium_edid (dp-edid-read) [94.344289] Subtest dp-edid-read: SKIP (0.000s) [94.411372] [094/171] (911s left) kms_chamelium_frames (dp-crc-fast) [94.585385] Subtest dp-crc-fast: SKIP (0.000s) [94.657165] [095/171] (911s left) kms_chamelium_hpd (hdmi-hpd-fast) [94.814895] Subtest hdmi-hpd-fast: SKIP (0.000s) [94.881988] [096/171] (911s left) kms_chamelium_edid (hdmi-edid-read) [95.045338] Subtest hdmi-edid-read: SKIP (0.000s) [95.115902] [097/171] (910s left) kms_chamelium_frames (hdmi-crc-fast) [95.289854] Subtest hdmi-crc-fast: SKIP (0.000s) [95.357705] [098/171] (910s left) kms_chamelium_hpd (vga-hpd-fast) [95.531397] Subtest vga-hpd-fast: SKIP (0.000s) [95.601100] [099/171] (910s left) kms_chamelium_edid (vga-edid-read) [95.774340] Subtest vga-edid-read: SKIP (0.000s) [95.846851] [100/171] (910s left) kms_prop_blob (basic) [95.911465] Starting subtest: basic [95.914136] Subtest basic: SUCCESS (0.000s) [95.963614] [101/171] (910s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic) [96.074836] Starting subtest: basic-busy-flip-before-cursor-atomic [96.080144] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s) [96.130280] [102/171] (910s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [96.239456] Starting subtest: basic-busy-flip-before-cursor-legacy [96.244925] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [96.296872] [103/171] (909s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [96.407133] Starting subtest: basic-flip-after-cursor-atomic [97.350774] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.944s) [97.463199] [104/171] (908s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [97.571498] Starting subtest: basic-flip-after-cursor-legacy [98.514592] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.943s) [98.629433] [105/171] (907s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size) [98.740523] Starting subtest: basic-flip-after-cursor-varying-size [99.697633] Subtest basic-flip-after-cursor-varying-size: SUCCESS (0.958s) [99.824838] [106/171] (906s left) kms_cursor_legacy (basic-flip-before-cursor-atomic) [99.936321] Starting subtest: basic-flip-before-cursor-atomic [100.876963] Subtest basic-flip-before-cursor-atomic: SUCCESS (0.941s) [100.998484] [107/171] (905s left) kms_cursor_legacy (basic-flip-before-cursor-legacy) [101.108711] Starting subtest: basic-flip-before-cursor-legacy [102.066908] Subtest basic-flip-before-cursor-legacy: SUCCESS (0.958s) [102.195156] [108/171] (904s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [102.307481] Starting subtest: basic-flip-before-cursor-varying-size [103.247399] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.940s) [103.372580] [109/171] (902s left) kms_flip (basic-flip-vs-dpms) [103.474117] Starting subtest: basic-flip-vs-dpms [103.477102] Starting dynamic subtest: A-HDMI-A1 [104.438763] Dynamic subtest A-HDMI-A1: SUCCESS (0.966s) [104.448209] Starting dynamic subtest: B-HDMI-A1 [105.334300] Dynamic subtest B-HDMI-A1: SUCCESS (0.895s) [105.343919] Starting dynamic subtest: C-HDMI-A1 [106.232845] Dynamic subtest C-HDMI-A1: SUCCESS (0.898s) [106.235585] Subtest basic-flip-vs-dpms: SUCCESS (2.763s) [106.367129] [110/171] (900s left) kms_flip (basic-flip-vs-modeset) [106.467039] Starting subtest: basic-flip-vs-modeset [106.469771] Starting dynamic subtest: A-HDMI-A1 [107.330220] Dynamic subtest A-HDMI-A1: SUCCESS (0.863s) [107.337943] Starting dynamic subtest: B-HDMI-A1 [108.128892] Dynamic subtest B-HDMI-A1: SUCCESS (0.798s) [108.136755] Starting dynamic subtest: C-HDMI-A1 [108.927770] Dynamic subtest C-HDMI-A1: SUCCESS (0.797s) [108.930791] Subtest basic-flip-vs-modeset: SUCCESS (2.464s) [109.058823] [111/171] (897s left) kms_flip (basic-flip-vs-wf_vblank) [109.163758] Starting subtest: basic-flip-vs-wf_vblank [109.166337] Starting dynamic subtest: A-HDMI-A1 [110.317011] Dynamic subtest A-HDMI-A1: SUCCESS (1.156s) [110.325039] Starting dynamic subtest: B-HDMI-A1 [111.456568] Dynamic subtest B-HDMI-A1: SUCCESS (1.138s) [111.464505] Starting dynamic subtest: C-HDMI-A1 [112.584905] Dynamic subtest C-HDMI-A1: SUCCESS (1.123s) [112.598539] Subtest basic-flip-vs-wf_vblank: SUCCESS (3.427s) [112.751876] [112/171] (893s left) kms_flip (basic-plain-flip) [112.849322] Starting subtest: basic-plain-flip [112.852319] Starting dynamic subtest: A-HDMI-A1 [113.801297] Dynamic subtest A-HDMI-A1: SUCCESS (0.862s) [113.866664] Starting dynamic subtest: B-HDMI-A1 [114.583535] Dynamic subtest B-HDMI-A1: SUCCESS (0.874s) [114.591657] Starting dynamic subtest: C-HDMI-A1 [115.422367] Dynamic subtest C-HDMI-A1: SUCCESS (0.838s) [115.425378] Subtest basic-plain-flip: SUCCESS (2.579s) [115.610478] [113/171] (890s left) kms_force_connector_basic (force-connector-state) [115.766738] Starting subtest: force-connector-state [116.147466] Subtest force-connector-state: SUCCESS (0.380s) [116.547905] [114/171] (889s left) kms_force_connector_basic (force-edid) [116.707045] Starting subtest: force-edid [116.847867] Subtest force-edid: SUCCESS (0.141s) [117.048796] [115/171] (889s left) kms_force_connector_basic (force-load-detect) [117.206653] Starting subtest: force-load-detect [117.212614] Subtest force-load-detect: SKIP (0.000s) [117.398443] [116/171] (889s left) kms_force_connector_basic (prune-stale-modes) [117.556885] Starting subtest: prune-stale-modes [117.691613] Subtest prune-stale-modes: SUCCESS (0.135s) [117.901461] [117/171] (888s left) kms_frontbuffer_tracking (basic) [118.034723] Starting subtest: basic [120.382574] Subtest basic: SUCCESS (2.358s) [120.489556] [118/171] (886s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24) [120.621446] Starting subtest: compare-crc-sanitycheck-xr24 [120.624465] Starting dynamic subtest: pipe-A-HDMI-A-1 [121.003149] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.381s) [121.013727] Starting dynamic subtest: pipe-B-HDMI-A-1 [121.369266] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.365s) [121.379370] Starting dynamic subtest: pipe-C-HDMI-A-1 [121.774125] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.404s) [121.777273] Subtest compare-crc-sanitycheck-xr24: SUCCESS (1.153s) [121.891057] [119/171] (884s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12) [122.003826] Starting subtest: compare-crc-sanitycheck-nv12 [122.006941] Starting dynamic subtest: pipe-A-HDMI-A-1 [122.409732] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.407s) [122.419397] Starting dynamic subtest: pipe-B-HDMI-A-1 [122.820190] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.409s) [122.828196] Starting dynamic subtest: pipe-C-HDMI-A-1 [122.834159] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s) [122.837194] Subtest compare-crc-sanitycheck-nv12: SUCCESS (0.820s) [122.947228] [120/171] (883s left) kms_pipe_crc_basic (hang-read-crc) [123.054149] Starting subtest: hang-read-crc [123.057026] Starting dynamic subtest: pipe-A-HDMI-A-1 [123.991516] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.937s) [123.999961] Starting dynamic subtest: pipe-B-HDMI-A-1 [124.988573] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.996s) [124.998812] Starting dynamic subtest: pipe-C-HDMI-A-1 [126.026970] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.037s) [126.029961] Subtest hang-read-crc: SUCCESS (2.973s) [126.129303] [121/171] (880s left) kms_pipe_crc_basic (nonblocking-crc) [126.238051] Starting subtest: nonblocking-crc [126.241162] Starting dynamic subtest: pipe-A-HDMI-A-1 [126.749757] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.510s) [126.758121] Starting dynamic subtest: pipe-B-HDMI-A-1 [127.277375] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.527s) [127.285239] Starting dynamic subtest: pipe-C-HDMI-A-1 [127.843314] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.565s) [127.846385] Subtest nonblocking-crc: SUCCESS (1.605s) [127.944945] [122/171] (878s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence) [128.051835] Starting subtest: nonblocking-crc-frame-sequence [128.054559] Starting dynamic subtest: pipe-A-HDMI-A-1 [128.566639] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.513s) [128.575047] Starting dynamic subtest: pipe-B-HDMI-A-1 [129.095388] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.528s) [129.104389] Starting dynamic subtest: pipe-C-HDMI-A-1 [129.660560] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.564s) [129.663664] Subtest nonblocking-crc-frame-sequence: SUCCESS (1.609s) [129.761923] [123/171] (876s left) kms_pipe_crc_basic (read-crc) [129.871169] Starting subtest: read-crc [129.874487] Starting dynamic subtest: pipe-A-HDMI-A-1 [130.315955] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.445s) [130.328598] Starting dynamic subtest: pipe-B-HDMI-A-1 [130.894134] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.478s) [130.959479] Starting dynamic subtest: pipe-C-HDMI-A-1 [131.414517] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.496s) [131.480340] Subtest read-crc: SUCCESS (1.422s) [131.710572] [124/171] (875s left) kms_pipe_crc_basic (read-crc-frame-sequence) [132.009474] Starting subtest: read-crc-frame-sequence [132.012632] Starting dynamic subtest: pipe-A-HDMI-A-1 [132.381640] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.468s) [132.390199] Starting dynamic subtest: pipe-B-HDMI-A-1 [132.841588] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.459s) [132.850971] Starting dynamic subtest: pipe-C-HDMI-A-1 [133.354490] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.512s) [133.357588] Subtest read-crc-frame-sequence: SUCCESS (1.442s) [133.455860] [125/171] (873s left) kms_psr (primary_page_flip) [133.521805] Subtest primary_page_flip: SKIP (0.000s) [133.542465] [126/171] (873s left) kms_psr (cursor_plane_move) [133.608266] Subtest cursor_plane_move: SKIP (0.000s) [133.659470] [127/171] (873s left) kms_psr (sprite_plane_onoff) [133.755173] Subtest sprite_plane_onoff: SKIP (0.000s) [133.779785] [128/171] (873s left) kms_psr (primary_mmap_gtt) [133.848834] Subtest primary_mmap_gtt: SKIP (0.000s) [133.890837] [129/171] (873s left) kms_setmode (basic-clone-single-crtc) [133.958192] Starting subtest: basic-clone-single-crtc [133.967548] Subtest basic-clone-single-crtc: SKIP (0.000s) [134.031273] [130/171] (872s left) i915_pm_backlight (basic-brightness) [134.179051] Subtest basic-brightness: SKIP (0.000s) [134.200505] [131/171] (872s left) i915_pm_rpm (basic-pci-d3-state) [135.746273] Starting subtest: basic-pci-d3-state [146.621152] Subtest basic-pci-d3-state: FAIL (10.810s) [146.882455] [132/171] (860s left) i915_pm_rpm (basic-rte) [146.945809] Starting subtest: basic-rte [159.231453] Subtest basic-rte: FAIL (12.036s) [170.175534] [133/171] (837s left) i915_pm_rps (basic-api) [170.666082] Starting subtest: basic-api [170.731476] Subtest basic-api: SUCCESS (0.002s) [171.027483] [134/171] (836s left) prime_self_import (basic-llseek-bad) [171.293575] Starting subtest: basic-llseek-bad [171.300487] Subtest basic-llseek-bad: SUCCESS (0.002s) [171.406976] [135/171] (836s left) prime_self_import (basic-llseek-size) [171.476115] Starting subtest: basic-llseek-size [171.483342] Subtest basic-llseek-size: SUCCESS (0.005s) [171.616509] [136/171] (836s left) prime_self_import (basic-with_fd_dup) [171.701812] Starting subtest: basic-with_fd_dup [171.708650] Subtest basic-with_fd_dup: SUCCESS (0.002s) [171.805176] [137/171] (835s left) prime_self_import (basic-with_one_bo) [171.901211] Starting subtest: basic-with_one_bo [171.908204] Subtest basic-with_one_bo: SUCCESS (0.002s) [171.968763] [138/171] (835s left) prime_self_import (basic-with_one_bo_two_files) [172.060987] Starting subtest: basic-with_one_bo_two_files [172.067514] Subtest basic-with_one_bo_two_files: SUCCESS (0.001s) [172.163270] [139/171] (835s left) prime_self_import (basic-with_two_bos) [172.235228] Starting subtest: basic-with_two_bos [172.242202] Subtest basic-with_two_bos: SUCCESS (0.002s) [172.353251] [140/171] (835s left) prime_vgem (basic-fence-flip) [172.457153] Starting subtest: basic-fence-flip [172.969412] Subtest basic-fence-flip: SUCCESS (0.380s) [173.267894] [141/171] (834s left) prime_vgem (basic-fence-mmap) [173.666250] Starting subtest: basic-fence-mmap [173.731788] Subtest basic-fence-mmap: SUCCESS (0.041s) [174.112752] [142/171] (834s left) prime_vgem (basic-fence-read) [174.207178] Starting subtest: basic-fence-read [174.229363] Subtest basic-fence-read: SUCCESS (0.025s) [174.345972] [143/171] (833s left) prime_vgem (basic-gtt) [174.436733] Starting subtest: basic-gtt [174.443343] Subtest basic-gtt: SUCCESS (0.007s) [174.554524] [144/171] (833s left) prime_vgem (basic-read) [174.640529] Starting subtest: basic-read [174.648438] Subtest basic-read: SUCCESS (0.011s) [174.745268] [145/171] (833s left) prime_vgem (basic-write) [174.840510] Starting subtest: basic-write [174.872873] Subtest basic-write: SUCCESS (0.033s) [174.979156] [146/171] (833s left) vgem_basic (setversion) [175.056678] Starting subtest: setversion [175.062616] Subtest setversion: SUCCESS (0.000s) [175.106046] [147/171] (833s left) vgem_basic (create) [175.190094] Starting subtest: create [175.193128] Subtest create: SUCCESS (0.001s) [175.233614] [148/171] (833s left) vgem_basic (debugfs) [175.320986] Starting subtest: debugfs [175.324270] Subtest debugfs: SUCCESS (0.000s) [175.382389] [149/171] (833s left) vgem_basic (dmabuf-export) [175.487663] Starting subtest: dmabuf-export [175.497806] Subtest dmabuf-export: SUCCESS (0.012s) [175.612211] [150/171] (832s left) vgem_basic (dmabuf-fence) [175.687764] Starting subtest: dmabuf-fence [175.691144] Subtest dmabuf-fence: SUCCESS (0.000s) [175.739784] [151/171] (832s left) vgem_basic (dmabuf-fence-before) [175.821192] Starting subtest: dmabuf-fence-before [175.824692] Subtest dmabuf-fence-before: SUCCESS (0.000s) [175.874955] [152/171] (832s left) vgem_basic (dmabuf-mmap) [175.970765] Starting subtest: dmabuf-mmap [175.977686] Subtest dmabuf-mmap: SUCCESS (0.009s) [176.017204] [153/171] (832s left) vgem_basic (mmap) [176.104752] Starting subtest: mmap [176.119276] Subtest mmap: SUCCESS (0.006s) [176.164093] [154/171] (832s left) vgem_basic (second-client) [176.288163] Starting subtest: second-client [176.321768] Subtest second-client: SUCCESS (0.033s) [176.410604] [155/171] (832s left) vgem_basic (sysfs) [176.524520] Starting subtest: sysfs [176.529328] Subtest sysfs: SUCCESS (0.002s) [176.592758] [156/171] (832s left) core_hotunplug (unbind-rebind) [176.803502] Starting subtest: unbind-rebind [177.808544] Subtest unbind-rebind: SUCCESS (1.007s) [177.829330] [157/171] (830s left) vgem_basic (unload) [177.892638] Starting subtest: unload [206.780799] Subtest unload: SUCCESS (28.888s) [206.861993] [158/171] (801s left) i915_module_load (reload) [206.928372] Starting subtest: reload [208.993785] Subtest reload: SUCCESS (2.068s) [209.020740] [159/171] (799s left) gem_lmem_swapping (basic) [209.109793] Subtest basic: SKIP (0.000s) [209.139537] [160/171] (799s left) gem_lmem_swapping (parallel-random-engines) [209.204006] Subtest parallel-random-engines: SKIP (0.000s) [209.222902] [161/171] (799s left) gem_lmem_swapping (random-engines) [209.293713] Subtest random-engines: SKIP (0.000s) [209.323122] [162/171] (799s left) gem_lmem_swapping (verify-random) [209.406235] Subtest verify-random: SKIP (0.000s) [209.423108] [163/171] (799s left) i915_pm_rpm (module-reload) [211.154777] Starting subtest: module-reload [229.552143] Subtest module-reload: FAIL (18.011s) [229.578334] [164/171] (779s left) i915_selftest (live) [230.488992] Starting subtest: live [230.554779] Starting dynamic subtest: sanitycheck [231.066974] Dynamic subtest sanitycheck: SUCCESS (0.562s) [231.134984] Starting dynamic subtest: uncore [231.529509] Dynamic subtest uncore: SUCCESS (0.517s) [231.537347] Starting dynamic subtest: workarounds [232.218881] Dynamic subtest workarounds: SUCCESS (0.688s) [232.225906] Starting dynamic subtest: gt_engines [233.250700] Dynamic subtest gt_engines: SUCCESS (1.031s) [233.258328] Starting dynamic subtest: gt_timelines [239.796288] Dynamic subtest gt_timelines: SUCCESS (6.545s) [239.803375] Starting dynamic subtest: gt_contexts [240.512686] Dynamic subtest gt_contexts: SUCCESS (0.715s) [240.519792] Starting dynamic subtest: gt_lrc [243.299620] Dynamic subtest gt_lrc: SUCCESS (2.786s) [243.307066] Starting dynamic subtest: gt_mocs [243.980879] Dynamic subtest gt_mocs: SUCCESS (0.680s) [243.988294] Starting dynamic subtest: gt_pm [246.422800] Dynamic subtest gt_pm: SUCCESS (2.441s) [246.433482] Starting dynamic subtest: gt_heartbeat [247.097474] Dynamic subtest gt_heartbeat: SUCCESS (0.674s) [247.105325] Starting dynamic subtest: gt_tlb [248.473707] Dynamic subtest gt_tlb: SUCCESS (1.375s) [248.481980] Starting dynamic subtest: requests [255.296151] Dynamic subtest requests: SUCCESS (6.821s) [255.303961] Starting dynamic subtest: migrate [258.646589] Dynamic subtest migrate: SUCCESS (3.350s) [258.656224] Starting dynamic subtest: active [259.198471] Dynamic subtest active: SUCCESS (0.551s) [259.207827] Starting dynamic subtest: objects [260.287422] Dynamic subtest objects: SUCCESS (1.088s) [260.294826] Starting dynamic subtest: mman [264.175409] Dynamic subtest mman: SUCCESS (3.887s) [264.182567] Starting dynamic subtest: dmabuf [264.823580] Dynamic subtest dmabuf: SUCCESS (0.647s) [264.831149] Starting dynamic subtest: vma [265.355679] Dynamic subtest vma: SUCCESS (0.531s) [265.365197] Starting dynamic subtest: coherency [266.516524] Dynamic subtest coherency: SUCCESS (1.160s) [266.523412] Starting dynamic subtest: gtt [274.904612] Dynamic subtest gtt: SUCCESS (8.387s) [274.911841] Starting dynamic subtest: gem [275.523402] Dynamic subtest gem: SUCCESS (0.618s) [275.530402] Starting dynamic subtest: evict [276.785592] Dynamic subtest evict: SUCCESS (1.261s) [276.793048] Starting dynamic subtest: hugepages [283.345533] Dynamic subtest hugepages: SUCCESS (6.559s) [283.352714] Starting dynamic subtest: gem_contexts [295.415589] Dynamic subtest gem_contexts: SUCCESS (12.069s) [295.425340] Starting dynamic subtest: client [296.018604] Dynamic subtest client: SUCCESS (0.602s) [296.026131] Starting dynamic subtest: gem_migrate [296.553513] Dynamic subtest gem_migrate: SUCCESS (0.534s) [296.561206] Starting dynamic subtest: reset [297.452675] Dynamic subtest reset: SUCCESS (0.898s) [297.460221] Starting dynamic subtest: memory_region [298.002634] Dynamic subtest memory_region: SUCCESS (0.549s) [298.010049] Starting dynamic subtest: hangcheck [321.490307] Dynamic subtest hangcheck: SUCCESS (23.487s) [321.497043] Starting dynamic subtest: execlists [329.811523] Dynamic subtest execlists: SUCCESS (8.320s) [329.819172] Starting dynamic subtest: ring_submission [330.322706] Dynamic subtest ring_submission: SUCCESS (0.510s) [330.330830] Starting dynamic subtest: perf [330.962562] Dynamic subtest perf: SUCCESS (0.639s) [330.969732] Starting dynamic subtest: slpc [331.491560] Dynamic subtest slpc: SUCCESS (0.528s) [331.499669] Starting dynamic subtest: guc [332.026633] Dynamic subtest guc: SUCCESS (0.534s) [332.036848] Starting dynamic subtest: guc_multi_lrc [332.560629] Dynamic subtest guc_multi_lrc: SUCCESS (0.533s) [332.571350] Starting dynamic subtest: guc_hang [333.152723] Dynamic subtest guc_hang: SUCCESS (0.591s) [333.161193] Starting dynamic subtest: late_gt_pm [333.723585] Dynamic subtest late_gt_pm: SUCCESS (0.570s) [333.727173] Subtest live: SUCCESS (103.276s) [333.937196] [165/171] (674s left) dmabuf (all-tests) [334.008838] Starting subtest: all-tests [334.013039] Starting dynamic subtest: sanitycheck [334.086931] Dynamic subtest sanitycheck: SUCCESS (0.080s) [334.098338] Starting dynamic subtest: dma_fence [334.271506] Dynamic subtest dma_fence: SUCCESS (0.182s) [334.278444] Starting dynamic subtest: dma_fence_chain [344.722434] Dynamic subtest dma_fence_chain: SUCCESS (10.450s) [344.732308] Starting dynamic subtest: dma_fence_unwrap [344.792579] Dynamic subtest dma_fence_unwrap: SUCCESS (0.068s) [344.810879] Starting dynamic subtest: dma_resv [344.870648] Dynamic subtest dma_resv: SUCCESS (0.076s) [344.874313] Subtest all-tests: SUCCESS (10.866s) [344.914351] [166/171] (664s left) i915_suspend (basic-s2idle-without-i915) [344.994397] Starting subtest: basic-s2idle-without-i915 [362.684217] Subtest basic-s2idle-without-i915: SUCCESS (2.428s) [367.856050] [167/171] (661s left) i915_suspend (basic-s3-without-i915) [367.923725] Starting subtest: basic-s3-without-i915 [385.885970] Subtest basic-s3-without-i915: SUCCESS (2.255s) [395.056740] [168/171] (658s left) gem_exec_suspend (basic-s0) [395.152596] Starting subtest: basic-S0 [395.155976] Starting dynamic subtest: smem [412.766077] Dynamic subtest smem: SUCCESS (1.822s) [412.769334] Subtest basic-S0: SUCCESS (1.823s) [421.917189] [169/171] (656s left) gem_exec_suspend (basic-s3) [421.986191] Starting subtest: basic-S3 [421.989686] Starting dynamic subtest: smem [439.872092] Dynamic subtest smem: SUCCESS (1.954s) [439.875168] Subtest basic-S3: SUCCESS (1.955s) [452.071401] [170/171] (654s left) kms_chamelium_hpd (common-hpd-after-suspend) [452.247358] Subtest common-hpd-after-suspend: SKIP (0.000s) [452.314668] [171/171] (654s left) kms_pipe_crc_basic (suspend-read-crc) [452.422252] Starting subtest: suspend-read-crc [452.425450] Starting dynamic subtest: pipe-A-HDMI-A-1 [470.978242] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.895s) [470.988595] Starting dynamic subtest: pipe-B-HDMI-A-1 [489.008297] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (1.882s) [489.019256] Starting dynamic subtest: pipe-C-HDMI-A-1 [507.040294] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.013s) [507.043472] Subtest suspend-read-crc: SUCCESS (5.793s) [514.114387] Closing watchdogs Done.