Revert "Revert "[Reporting/New Platform Migration] Use a new config s… #61873

tsullivan · 2020-03-30T18:05:00Z

…ervice on server-side (#55882)" (#61075)"

This reverts commit 427848c.

Summary

Summarize your PR. If it involves visual changes include a screenshot or gif.

Checklist

Delete any items that are not applicable to this PR.

Any text added follows EUI's writing guidelines, uses sentence case text and includes i18n support
Documentation was added for features that require explanation or tutorials
Unit or functional tests were updated or added to match the most common scenarios
This was checked for keyboard-only and screenreader accessibility
This renders correctly on smaller devices using a responsive layout. (You can test this in your browser
This was checked for cross-browser compatibility, including a check against IE11

For maintainers

This was checked for breaking API changes and was labeled appropriately

…ervice on server-side (elastic#55882)" (elastic#61075)" This reverts commit 427848c.

kibanamachine · 2020-03-30T19:40:47Z

💔 Build Failed

continuous-integration/kibana-ci/pull-request
Commit: d585284
Pipeline Steps (look for red circles / failed steps)
Interpreting CI Failures

Failed CI Steps

Test Failures

Kibana Pipeline / kibana-xpack-agent / Chrome X-Pack UI Functional Tests.x-pack/test/functional/apps/lens/lens_reporting·ts.lens app lens reporting should not cause PDF reports to fail

Link to Jenkins

Standard Out

Failed Tests Reporter:
  - Test has failed 11 times on tracked branches: https://github.com/elastic/kibana/issues/59229

[00:00:00]       │
[00:26:16]         └-: lens app
[00:26:16]           └-> "before all" hook
[00:26:16]           └-> "before all" hook
[00:26:16]             │ debg Starting lens before method
[00:26:16]             │ info [logstash_functional] Loading "mappings.json"
[00:26:16]             │ info [logstash_functional] Loading "data.json.gz"
[00:26:16]             │ info [logstash_functional] Skipped restore for existing index "logstash-2015.09.22"
[00:26:16]             │ info [logstash_functional] Skipped restore for existing index "logstash-2015.09.20"
[00:26:16]             │ info [logstash_functional] Skipped restore for existing index "logstash-2015.09.21"
[00:26:18]             │ info [lens/basic] Loading "mappings.json"
[00:26:18]             │ info [lens/basic] Loading "data.json.gz"
[00:26:18]             │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/VCWErOZwTCGm8Uz2mnKLBA] deleting index
[00:26:18]             │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1/EDuN2oBCQci1DFsk7Z0Zmw] deleting index
[00:26:18]             │ info [lens/basic] Deleted existing index [".kibana_2",".kibana_1"]
[00:26:18]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1] creating index, cause [api], templates [], shards [1]/[0], mappings [_doc]
[00:26:18]             │ info [lens/basic] Created index ".kibana_1"
[00:26:18]             │ debg [lens/basic] ".kibana_1" settings {"index":{"auto_expand_replicas":"0-1","number_of_replicas":"0","number_of_shards":"1"}}
[00:26:18]             │ info [lens/basic] Indexed 10 docs into ".kibana_1"
[00:26:18]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1/sK5h8OrbRhWTV0pFA8YYOg] update_mapping [_doc]
[00:26:18]             │ debg Migrating saved objects
[00:26:19]             │ proc [kibana]   log   [19:07:04.998] [info][savedobjects-service] Creating index .kibana_2.
[00:26:19]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:26:19]             │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.kibana_2]
[00:26:19]             │ proc [kibana]   log   [19:07:05.080] [info][savedobjects-service] Migrating .kibana_1 saved objects to .kibana_2
[00:26:19]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/PRqzf9suToG373dPneWy9w] update_mapping [_doc]
[00:26:19]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/PRqzf9suToG373dPneWy9w] update_mapping [_doc]
[00:26:19]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/PRqzf9suToG373dPneWy9w] update_mapping [_doc]
[00:26:19]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/PRqzf9suToG373dPneWy9w] update_mapping [_doc]
[00:26:19]             │ proc [kibana]   log   [19:07:05.292] [info][savedobjects-service] Pointing alias .kibana to .kibana_2.
[00:26:19]             │ proc [kibana]   log   [19:07:05.350] [info][savedobjects-service] Finished in 353ms.
[00:26:19]           └-: 
[00:26:19]             └-> "before all" hook
[00:29:05]             └-: lens reporting
[00:29:05]               └-> "before all" hook
[00:29:05]               └-> "before all" hook
[00:29:05]                 │ info [lens/reporting] Loading "mappings.json"
[00:29:05]                 │ info [lens/reporting] Loading "data.json.gz"
[00:29:05]                 │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1/sK5h8OrbRhWTV0pFA8YYOg] deleting index
[00:29:05]                 │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/PRqzf9suToG373dPneWy9w] deleting index
[00:29:05]                 │ info [lens/reporting] Deleted existing index [".kibana_2",".kibana_1"]
[00:29:05]                 │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1] creating index, cause [api], templates [], shards [1]/[0], mappings [_doc]
[00:29:06]                 │ info [lens/reporting] Created index ".kibana_1"
[00:29:06]                 │ debg [lens/reporting] ".kibana_1" settings {"index":{"auto_expand_replicas":"0-1","number_of_replicas":"0","number_of_shards":"1"}}
[00:29:06]                 │ info [lens/reporting] Indexed 13 docs into ".kibana_1"
[00:29:06]                 │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1/HBQUEgNATPqvDSLXE9EkwQ] update_mapping [_doc]
[00:29:06]                 │ debg Migrating saved objects
[00:29:07]                 │ proc [kibana]   log   [19:09:52.557] [info][savedobjects-service] Creating index .kibana_2.
[00:29:07]                 │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:29:07]                 │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.kibana_2]
[00:29:07]                 │ proc [kibana]   log   [19:09:52.649] [info][savedobjects-service] Migrating .kibana_1 saved objects to .kibana_2
[00:29:07]                 │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/rE0_L6RFQKOMW1K5RmSh2g] update_mapping [_doc]
[00:29:07]                 │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/rE0_L6RFQKOMW1K5RmSh2g] update_mapping [_doc]
[00:29:07]                 │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/rE0_L6RFQKOMW1K5RmSh2g] update_mapping [_doc]
[00:29:07]                 │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/rE0_L6RFQKOMW1K5RmSh2g] update_mapping [_doc]
[00:29:07]                 │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/rE0_L6RFQKOMW1K5RmSh2g] update_mapping [_doc]
[00:29:07]                 │ proc [kibana]   log   [19:09:52.931] [info][savedobjects-service] Pointing alias .kibana to .kibana_2.
[00:29:07]                 │ proc [kibana]   log   [19:09:52.989] [info][savedobjects-service] Finished in 435ms.
[00:29:07]               └-> should not cause PDF reports to fail
[00:29:07]                 └-> "before each" hook: global before each
[00:29:07]                 │ debg navigating to dashboard url: http://localhost:6141/app/kibana#/dashboards
[00:29:07]                 │ debg Navigate to: http://localhost:6141/app/kibana#/dashboards
[00:29:07]                 │ debg ... sleep(700) start
[00:29:07]                 │ debg browser[INFO] http://localhost:6141/app/kibana?_t=1585595392996#/dashboards 341 Refused to execute inline script because it violates the following Content Security Policy directive: "script-src 'unsafe-eval' 'self'". Either the 'unsafe-inline' keyword, a hash ('sha256-P5polb1UreUSOe5V/Pv7tc+yeZuJXiOi/3fqhGsU7BE='), or a nonce ('nonce-...') is required to enable inline execution.
[00:29:07]                 │
[00:29:07]                 │ debg browser[INFO] http://localhost:6141/bundles/app/kibana/bootstrap.js 9:19 "^ A single error about an inline script not firing due to content security policy is expected!"
[00:29:08]                 │ debg ... sleep(700) end
[00:29:08]                 │ debg returned from get, calling refresh
[00:29:08]                 │ debg browser[INFO] http://localhost:6141/app/kibana?_t=1585595392996#/dashboards 341 Refused to execute inline script because it violates the following Content Security Policy directive: "script-src 'unsafe-eval' 'self'". Either the 'unsafe-inline' keyword, a hash ('sha256-P5polb1UreUSOe5V/Pv7tc+yeZuJXiOi/3fqhGsU7BE='), or a nonce ('nonce-...') is required to enable inline execution.
[00:29:08]                 │
[00:29:08]                 │ debg browser[INFO] http://localhost:6141/bundles/app/kibana/bootstrap.js 9:19 "^ A single error about an inline script not firing due to content security policy is expected!"
[00:29:08]                 │ debg currentUrl = http://localhost:6141/app/kibana#/dashboards
[00:29:08]                 │          appUrl = http://localhost:6141/app/kibana#/dashboards
[00:29:08]                 │ debg TestSubjects.find(kibanaChrome)
[00:29:08]                 │ debg Find.findByCssSelector('[data-test-subj="kibanaChrome"]') with timeout=60000
[00:29:13]                 │ debg TestSubjects.find(kibanaChrome)
[00:29:13]                 │ debg Find.findByCssSelector('[data-test-subj="kibanaChrome"]') with timeout=10000
[00:29:13]                 │ debg browser[INFO] http://localhost:6141/bundles/plugin/data/data.plugin.js 96:139630 "INFO: 2020-03-30T19:09:58Z
[00:29:13]                 │        Adding connection to http://localhost:6141/elasticsearch
[00:29:13]                 │
[00:29:13]                 │      "
[00:29:14]                 │ debg ... sleep(501) start
[00:29:15]                 │ debg ... sleep(501) end
[00:29:15]                 │ debg in navigateTo url = http://localhost:6141/app/kibana#/dashboards?_g=(filters:!(),refreshInterval:(pause:!t,value:0),time:(from:now-15m,to:now))
[00:29:15]                 │ debg TestSubjects.exists(statusPageContainer)
[00:29:15]                 │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="statusPageContainer"]') with timeout=2500
[00:29:17]                 │ debg --- retry.tryForTime error: [data-test-subj="statusPageContainer"] is not displayed
[00:29:18]                 │ debg TestSubjects.click(dashboardListingTitleLink-Lens-reportz)
[00:29:18]                 │ debg Find.clickByCssSelector('[data-test-subj="dashboardListingTitleLink-Lens-reportz"]') with timeout=10000
[00:29:18]                 │ debg Find.findByCssSelector('[data-test-subj="dashboardListingTitleLink-Lens-reportz"]') with timeout=10000
[00:29:18]                 │ debg openPdfReportingPanel
[00:29:18]                 │ debg openShareMenuItem title:PDF Reports
[00:29:18]                 │ debg TestSubjects.exists(shareContextMenu)
[00:29:18]                 │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="shareContextMenu"]') with timeout=2500
[00:29:21]                 │ debg --- retry.tryForTime error: [data-test-subj="shareContextMenu"] is not displayed
[00:29:21]                 │ debg TestSubjects.click(shareTopNavButton)
[00:29:21]                 │ debg Find.clickByCssSelector('[data-test-subj="shareTopNavButton"]') with timeout=10000
[00:29:21]                 │ debg Find.findByCssSelector('[data-test-subj="shareTopNavButton"]') with timeout=10000
[00:29:21]                 │ debg Find.findByCssSelector('div.euiContextMenuPanel') with timeout=10000
[00:29:21]                 │ debg TestSubjects.click(sharePanel-PDFReports)
[00:29:21]                 │ debg Find.clickByCssSelector('[data-test-subj="sharePanel-PDFReports"]') with timeout=10000
[00:29:21]                 │ debg Find.findByCssSelector('[data-test-subj="sharePanel-PDFReports"]') with timeout=10000
[00:29:21]                 │ debg Find.waitForElementStale with timeout=10000
[00:29:22]                 │ debg TestSubjects.click(generateReportButton)
[00:29:22]                 │ debg Find.clickByCssSelector('[data-test-subj="generateReportButton"]') with timeout=10000
[00:29:22]                 │ debg Find.findByCssSelector('[data-test-subj="generateReportButton"]') with timeout=10000
[00:29:22]                 │ debg getReportURL
[00:29:22]                 │ debg TestSubjects.getAttribute(downloadCompletedReportButton, href)
[00:29:22]                 │ debg TestSubjects.find(downloadCompletedReportButton)
[00:29:22]                 │ debg Find.findByCssSelector('[data-test-subj="downloadCompletedReportButton"]') with timeout=60000
[00:29:22]                 │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.reporting-2020.03.29] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:29:22]                 │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.reporting-2020.03.29]
[00:29:22]                 │ proc [kibana]   log   [19:10:07.800] [info][queue-job][reporting] Successfully queued job: k8eukeom0b02cf8f9172uccl
[00:29:24]                 │ proc [kibana]   log   [19:10:09.936] [info][esqueue][queue-worker][reporting] k8etiiuq0b02cf8f91ey59op - Job marked as claimed: /.reporting-2020.03.29/k8eukeom0b02cf8f9172uccl
[00:29:24]                 │ proc [kibana]   log   [19:10:09.969] [info][esqueue][queue-worker][reporting] k8etiiuq0b02cf8f91ey59op - Starting job
[00:29:24]                 │ proc [kibana]   log   [19:10:10.003] [info][browser-driver][execute][k8eukeom0b02cf8f9172uccl][printable_pdf][reporting] Creating browser page driver
[00:29:24]                 │ proc [kibana]   log   [19:10:10.053] [error][execute][k8eukeom0b02cf8f9172uccl][printable_pdf][reporting] Error: Error spawning Chromium browser: [Error: Protocol error (Target.setDiscoverTargets): Target closed.]
[00:29:24]                 │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-4/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:124:24)
[00:29:24]                 │ proc [kibana]   log   [19:10:10.071] [error][error][esqueue][queue-worker][reporting] k8etiiuq0b02cf8f91ey59op - Failure occurred on job k8eukeom0b02cf8f9172uccl: Error: Error spawning Chromium browser: [Error: Protocol error (Target.setDiscoverTargets): Target closed.]
[00:29:24]                 │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-4/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:124:24)
[00:29:24]                 │ proc [kibana]   log   [19:10:10.071] [warning][esqueue][queue-worker][reporting] k8etiiuq0b02cf8f91ey59op - Failing job k8eukeom0b02cf8f9172uccl
[00:29:24]                 │ proc [kibana]  error  [19:10:10.076] [warning][process] UnhandledPromiseRejectionWarning: Error: Protocol error (Target.setDiscoverTargets): Target closed.
[00:29:24]                 │ proc [kibana]     at Promise (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Connection.js:74:56)
[00:29:24]                 │ proc [kibana]     at new Promise (<anonymous>)
[00:29:24]                 │ proc [kibana]     at Connection.send (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Connection.js:73:12)
[00:29:24]                 │ proc [kibana]     at Function.create (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Browser.js:34:22)
[00:29:24]                 │ proc [kibana]     at Launcher.launch (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Launcher.js:184:37)
[00:29:24]                 │ proc [kibana]     at module.exports.launch (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Puppeteer.js:37:27)
[00:29:24]                 │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-4/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:108:25)
[00:29:24]                 │ proc [kibana]     at Observable._trySubscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:44:25)
[00:29:24]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:30:22)
[00:29:24]                 │ proc [kibana]     at MergeMapOperator.call (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/operators/mergeMap.js:39:23)
[00:29:24]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:25:31)
[00:29:24]                 │ proc [kibana]     at TakeOperator.call (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/operators/take.js:38:23)
[00:29:24]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:25:31)
[00:29:24]                 │ proc [kibana]     at ThrowIfEmptyOperator.call (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/operators/throwIfEmpty.js:30:23)
[00:29:24]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:25:31)
[00:29:24]                 │ proc [kibana]     at Object.subscribeToResult (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/util/subscribeToResult.js:12:23)
[00:29:24]                 │ proc [kibana]     at emitWarning (internal/process/promises.js:97:15)
[00:29:24]                 │ proc [kibana]     at emitPromiseRejectionWarnings (internal/process/promises.js:143:7)
[00:29:24]                 │ proc [kibana]     at process._tickCallback (internal/process/next_tick.js:69:34)
[00:29:24]                 │ proc [kibana]  error  [19:10:10.077] [warning][process] Error: Protocol error (Target.setDiscoverTargets): Target closed.
[00:29:24]                 │ proc [kibana]     at Promise (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Connection.js:74:56)
[00:29:24]                 │ proc [kibana]     at new Promise (<anonymous>)
[00:29:24]                 │ proc [kibana]     at Connection.send (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Connection.js:73:12)
[00:29:24]                 │ proc [kibana]     at Function.create (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Browser.js:34:22)
[00:29:24]                 │ proc [kibana]     at Launcher.launch (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Launcher.js:184:37)
[00:29:24]                 │ proc [kibana]     at module.exports.launch (/dev/shm/workspace/install/kibana-4/node_modules/puppeteer-core/lib/Puppeteer.js:37:27)
[00:29:24]                 │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-4/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:108:25)
[00:29:24]                 │ proc [kibana]     at Observable._trySubscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:44:25)
[00:29:24]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:30:22)
[00:29:24]                 │ proc [kibana]     at MergeMapOperator.call (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/operators/mergeMap.js:39:23)
[00:29:24]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:25:31)
[00:29:24]                 │ proc [kibana]     at TakeOperator.call (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/operators/take.js:38:23)
[00:29:24]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:25:31)
[00:29:24]                 │ proc [kibana]     at ThrowIfEmptyOperator.call (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/operators/throwIfEmpty.js:30:23)
[00:29:24]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/Observable.js:25:31)
[00:29:24]                 │ proc [kibana]     at Object.subscribeToResult (/dev/shm/workspace/install/kibana-4/node_modules/rxjs/internal/util/subscribeToResult.js:12:23)
[00:29:24]                 │ proc [kibana]   log   [19:10:10.100] [info][esqueue][queue-worker][reporting] k8etiiuq0b02cf8f91ey59op - Job marked as failed: /.reporting-2020.03.29/k8eukeom0b02cf8f9172uccl
[00:30:23]                 │ debg --- retry.try error: Waiting for element to be located By(css selector, [data-test-subj="downloadCompletedReportButton"])
[00:30:23]                 │      Wait timed out after 61190ms
[00:30:23]                 │ debg TestSubjects.getAttribute(downloadCompletedReportButton, href)
[00:30:23]                 │ debg TestSubjects.find(downloadCompletedReportButton)
[00:30:23]                 │ debg Find.findByCssSelector('[data-test-subj="downloadCompletedReportButton"]') with timeout=60000
[00:31:25]                 │ debg --- retry.try error: Waiting for element to be located By(css selector, [data-test-subj="downloadCompletedReportButton"])
[00:31:25]                 │      Wait timed out after 61198ms
[00:31:25]                 │ info Taking screenshot "/dev/shm/workspace/kibana/x-pack/test/functional/screenshots/failure/lens app  lens reporting should not cause PDF reports to fail.png"
[00:31:25]                 │ info Current URL is: http://localhost:6141/app/kibana#/dashboard/c27849f0-e523-11e9-9af5-2b261e1eb063?_g=(filters:!(),refreshInterval:(pause:!t,value:0),time:(from:now-15m,to:now))&_a=(description:%27%27,filters:!(),fullScreenMode:!f,options:(hidePanelTitles:!f,useMargins:!t),panels:!((embeddableConfig:(),gridData:(h:15,i:e5966143-f050-40eb-b4e7-f94469c1426c,w:24,x:0,y:0),id:%2774b0f140-e523-11e9-9af5-2b261e1eb063%27,panelIndex:e5966143-f050-40eb-b4e7-f94469c1426c,type:lens,version:%278.0.0-SNAPSHOT%27),(embeddableConfig:(),gridData:(h:15,i:f9ff2513-2de9-4944-a8d1-a9fead4b020d,w:24,x:24,y:0),id:%2784320f00-e523-11e9-9af5-2b261e1eb063%27,panelIndex:f9ff2513-2de9-4944-a8d1-a9fead4b020d,type:lens,version:%278.0.0-SNAPSHOT%27),(embeddableConfig:(),gridData:(h:15,i:b62d7d36-83ca-415b-8971-34d891b09a1a,w:24,x:0,y:15),id:%279325b9d0-e523-11e9-9af5-2b261e1eb063%27,panelIndex:b62d7d36-83ca-415b-8971-34d891b09a1a,type:lens,version:%278.0.0-SNAPSHOT%27)),query:(language:kuery,query:%27%27),timeRestore:!f,title:%27Lens%20reportz%27,viewMode:view)
[00:31:25]                 │ info Saving page source to: /dev/shm/workspace/kibana/x-pack/test/functional/failure_debug/html/lens app  lens reporting should not cause PDF reports to fail.html
[00:31:25]                 └- ✖ fail: "lens app  lens reporting should not cause PDF reports to fail"
[00:31:25]                 │

Stack Trace

Error: retry.try timeout: TimeoutError: Waiting for element to be located By(css selector, [data-test-subj="downloadCompletedReportButton"])
Wait timed out after 61198ms
    at /dev/shm/workspace/kibana/node_modules/selenium-webdriver/lib/webdriver.js:841:17
    at process._tickCallback (internal/process/next_tick.js:68:7)
    at onFailure (/dev/shm/workspace/kibana/test/common/services/retry/retry_for_success.ts:28:9)
    at retryForSuccess (/dev/shm/workspace/kibana/test/common/services/retry/retry_for_success.ts:68:13)

Kibana Pipeline / kibana-xpack-agent / X-Pack Chromium API Reporting Tests.x-pack/test/reporting/api/usage·js.chromium reporting usage from new jobs posted preserve_layout pdf

Link to Jenkins

Standard Out

Failed Tests Reporter:
  - Test has failed 8 times on tracked branches: https://github.com/elastic/kibana/issues/61021

[00:00:00]       │
[00:00:00]         └-: chromium
[00:00:00]           └-> "before all" hook
[00:00:00]           └-> "before all" hook
[00:00:00]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/kibana] Loading "mappings.json"
[00:00:00]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/kibana] Loading "data.json.gz"
[00:00:00]             │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1/pnKw6ORQSX-fc8anRJkb1Q] deleting index
[00:00:00]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/kibana] Deleted existing index [".kibana_1"]
[00:00:00]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana] creating index, cause [api], templates [], shards [1]/[0], mappings [_doc]
[00:00:00]             │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] Cluster health status changed from [YELLOW] to [GREEN] (reason: [shards started [[.kibana][0]]]).
[00:00:00]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/kibana] Created index ".kibana"
[00:00:00]             │ debg [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/kibana] ".kibana" settings {"index":{"auto_expand_replicas":"0-1","number_of_replicas":"0","number_of_shards":"1"}}
[00:00:00]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana/pLcsKBvBQBeWF9IjAlrIqw] update_mapping [_doc]
[00:00:00]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/kibana] Indexed 84 docs into ".kibana"
[00:00:00]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana/pLcsKBvBQBeWF9IjAlrIqw] update_mapping [_doc]
[00:00:00]             │ debg Migrating saved objects
[00:00:01]             │ proc [kibana]   log   [19:05:21.880] [warning][actions][plugins][telemetry] Error executing actions telemetry task: [query_shard_exception] failed to create query: [nested] failed to find nested object under path [references], with { index_uuid="pLcsKBvBQBeWF9IjAlrIqw" & index=".kibana" } :: {"path":"/.kibana/_search","query":{"rest_total_hits_as_int":true},"body":"{\"query\":{\"bool\":{\"filter\":{\"bool\":{\"must\":{\"nested\":{\"path\":\"references\",\"query\":{\"bool\":{\"filter\":{\"bool\":{\"must\":[{\"term\":{\"references.type\":\"action\"}}]}}}}}}}}}},\"aggs\":{\"refs\":{\"nested\":{\"path\":\"references\"},\"aggs\":{\"actionRefIds\":{\"scripted_metric\":{\"init_script\":\"state.connectorIds = new HashMap(); state.total = 0;\",\"map_script\":\"\\n        String connectorId = doc['references.id'].value;\\n        String actionRef = doc['references.name'].value;\\n        if (state.connectorIds[connectorId] === null) {\\n          state.connectorIds[connectorId] = actionRef;\\n          state.total++;\\n        }\\n      \",\"combine_script\":\"return state\",\"reduce_script\":\"\\n          Map connectorIds = [:];\\n          long total = 0;\\n          for (state in states) {\\n            if (state !== null) {\\n              total += state.total;\\n              for (String k : state.connectorIds.keySet()) {\\n                connectorIds.put(k, connectorIds.containsKey(k) ? connectorIds.get(k) + state.connectorIds.get(k) : state.connectorIds.get(k));\\n              }\\n            }\\n          }\\n          Map result = new HashMap();\\n          result.total = total;\\n          result.connectorIds = connectorIds;\\n          return result;\\n      \"}}}}}}","statusCode":400,"response":"{\"error\":{\"root_cause\":[{\"type\":\"query_shard_exception\",\"reason\":\"failed to create query: [nested] failed to find nested object under path [references]\",\"index_uuid\":\"pLcsKBvBQBeWF9IjAlrIqw\",\"index\":\".kibana\"}],\"type\":\"search_phase_execution_exception\",\"reason\":\"all shards failed\",\"phase\":\"query\",\"grouped\":true,\"failed_shards\":[{\"shard\":0,\"index\":\".kibana\",\"node\":\"3LeKSQ6UQECgBdjm5_jO1g\",\"reason\":{\"type\":\"query_shard_exception\",\"reason\":\"failed to create query: [nested] failed to find nested object under path [references]\",\"index_uuid\":\"pLcsKBvBQBeWF9IjAlrIqw\",\"index\":\".kibana\",\"caused_by\":{\"type\":\"illegal_state_exception\",\"reason\":\"[nested] failed to find nested object under path [references]\"}}}]},\"status\":400}"}
[00:00:01]             │ proc [kibana]   log   [19:05:22.162] [info][savedobjects-service] Creating index .kibana_2.
[00:00:01]             │ proc [kibana]   log   [19:05:22.188] [warning][alerting][plugins][telemetry] Error executing alerting telemetry task: TypeError: Cannot read property 'value' of undefined
[00:00:01]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:00:01]             │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.kibana_2]
[00:00:01]             │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] Cluster health status changed from [YELLOW] to [GREEN] (reason: [shards started [[.kibana_2][0]]]).
[00:00:01]             │ proc [kibana]   log   [19:05:22.326] [info][savedobjects-service] Reindexing .kibana to .kibana_1
[00:00:01]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:00:01]             │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.kibana_1]
[00:00:01]             │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] Cluster health status changed from [YELLOW] to [GREEN] (reason: [shards started [[.kibana_1][0]]]).
[00:00:01]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.tasks] creating index, cause [auto(task api)], templates [], shards [1]/[1], mappings [_doc]
[00:00:01]             │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.tasks]
[00:00:01]             │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] Cluster health status changed from [YELLOW] to [GREEN] (reason: [shards started [[.tasks][0]]]).
[00:00:01]             │ info [o.e.t.LoggingTaskListener] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] 1048 finished with response BulkByScrollResponse[took=146.6ms,timed_out=false,sliceId=null,updated=0,created=85,deleted=0,batches=1,versionConflicts=0,noops=0,retries=0,throttledUntil=0s,bulk_failures=[],search_failures=[]]
[00:00:02]             │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana/pLcsKBvBQBeWF9IjAlrIqw] deleting index
[00:00:02]             │ proc [kibana]   log   [19:05:23.043] [info][savedobjects-service] Migrating .kibana_1 saved objects to .kibana_2
[00:00:02]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/VgcOe6-HTQibQI-sKKdhDg] update_mapping [_doc]
[00:00:02]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/VgcOe6-HTQibQI-sKKdhDg] update_mapping [_doc]
[00:00:02]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/VgcOe6-HTQibQI-sKKdhDg] update_mapping [_doc]
[00:00:02]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/VgcOe6-HTQibQI-sKKdhDg] update_mapping [_doc]
[00:00:02]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/VgcOe6-HTQibQI-sKKdhDg] update_mapping [_doc]
[00:00:02]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/VgcOe6-HTQibQI-sKKdhDg] update_mapping [_doc]
[00:00:02]             │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/VgcOe6-HTQibQI-sKKdhDg] update_mapping [_doc]
[00:00:03]             │ proc [kibana]   log   [19:05:23.827] [info][savedobjects-service] Pointing alias .kibana to .kibana_2.
[00:00:03]             │ proc [kibana]   log   [19:05:23.919] [info][savedobjects-service] Finished in 1760ms.
[00:00:03]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Loading "mappings.json"
[00:00:03]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Loading "data.json.gz"
[00:00:03]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [animals-dogs-2018-01-01] creating index, cause [api], templates [], shards [5]/[1], mappings [_doc]
[00:00:03]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Created index "animals-dogs-2018-01-01"
[00:00:03]             │ debg [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] "animals-dogs-2018-01-01" settings {"index":{"number_of_replicas":"1","number_of_shards":"5"}}
[00:00:03]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [animals-dogs-2018-04-10] creating index, cause [api], templates [], shards [5]/[1], mappings [_doc]
[00:00:03]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Created index "animals-dogs-2018-04-10"
[00:00:03]             │ debg [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] "animals-dogs-2018-04-10" settings {"index":{"number_of_replicas":"1","number_of_shards":"5"}}
[00:00:03]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [animals-cats-2018-01-01] creating index, cause [api], templates [], shards [5]/[1], mappings [_doc]
[00:00:03]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Created index "animals-cats-2018-01-01"
[00:00:03]             │ debg [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] "animals-cats-2018-01-01" settings {"index":{"number_of_replicas":"1","number_of_shards":"5"}}
[00:00:03]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [animals-cats-2018-04-10] creating index, cause [api], templates [], shards [5]/[1], mappings [_doc]
[00:00:03]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Created index "animals-cats-2018-04-10"
[00:00:03]             │ debg [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] "animals-cats-2018-04-10" settings {"index":{"number_of_replicas":"1","number_of_shards":"5"}}
[00:00:04]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [dogbreeds] creating index, cause [api], templates [], shards [5]/[1], mappings [_doc]
[00:00:04]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Created index "dogbreeds"
[00:00:04]             │ debg [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] "dogbreeds" settings {"index":{"number_of_replicas":"1","number_of_shards":"5"}}
[00:00:04]             │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [logstash-0] creating index, cause [api], templates [], shards [1]/[0], mappings [_doc]
[00:00:04]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Created index "logstash-0"
[00:00:04]             │ debg [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] "logstash-0" settings {"index":{"analysis":{"analyzer":{"makelogs_url":{"max_token_length":"1000","tokenizer":"uax_url_email","type":"standard"}}},"number_of_replicas":"0","number_of_shards":"1"}}
[00:00:13]             │ info progress: 9626
[00:00:16]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Indexed 6 docs into "animals-dogs-2018-01-01"
[00:00:16]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Indexed 6 docs into "animals-dogs-2018-04-10"
[00:00:16]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Indexed 6 docs into "animals-cats-2018-01-01"
[00:00:16]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Indexed 5 docs into "animals-cats-2018-04-10"
[00:00:16]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Indexed 6 docs into "dogbreeds"
[00:00:16]             │ info [/dev/shm/workspace/kibana/test/functional/fixtures/es_archiver/dashboard/current/data] Indexed 14005 docs into "logstash-0"
[00:00:16]             │ debg applying update to kibana config: {"defaultIndex":"0bf35f60-3dc9-11e8-8660-4d65aa086b3c"}
[00:00:17]           └-: reporting usage
[00:00:17]             └-> "before all" hook
[00:00:17]             └-> "before all" hook
[00:00:17]               │ debg ReportingAPI.deleteAllReportingIndexes
[00:00:39]             └-: from new jobs posted
[00:00:39]               └-> "before all" hook
[00:00:39]               └-> csv
[00:00:39]                 └-> "before each" hook: global before each
[00:00:39]                 │ debg ReportingAPI.postJob(/api/reporting/generate/csv?jobParams=(conflictedTypesFields:!(),fields:!(%27@timestamp%27,agent,bytes,clientip),indexPatternId:%270bf35f60-3dc9-11e8-8660-4d65aa086b3c%27,metaFields:!(_source,_id,_type,_index,_score),searchRequest:(body:(_source:(excludes:!(),includes:!(%27@timestamp%27,agent,bytes,clientip)),docvalue_fields:!(%27@timestamp%27),query:(bool:(filter:!((bool:(minimum_should_match:1,should:!((match:(clientip:%2773.14.212.83%27)))))),must:!((range:(bytes:(gte:100,lt:1000))),(range:(%27@timestamp%27:(format:epoch_millis,gte:1369165215770,lte:1526931615770)))),must_not:!(),should:!())),script_fields:(),sort:!((%27@timestamp%27:(order:desc,unmapped_type:boolean))),stored_fields:!(%27@timestamp%27,agent,bytes,clientip),version:!t),index:%27logstash-*%27),title:%27Bytes%20and%20kuery%20in%20saved%20search%20with%20filter%27,type:search))
[00:00:39]                 │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.reporting-2020.03.29] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:00:39]                 │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.reporting-2020.03.29]
[00:00:39]                 │ proc [kibana]   log   [19:06:00.246] [info][queue-job][reporting] Successfully queued job: k8euf3ne10zjcf8f91e0sva1
[00:00:39]                 │ debg Waiting for job to finish: /api/reporting/jobs/download/k8euf3ne10zjcf8f91e0sva1
[00:00:39]                 │ proc [kibana]   log   [19:06:00.352] [info][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Job marked as claimed: /.reporting-2020.03.29/k8euf3ne10zjcf8f91e0sva1
[00:00:39]                 │ proc [kibana]   log   [19:06:00.354] [info][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Starting job
[00:00:39]                 │ proc [kibana]   log   [19:06:00.431] [warning][csv][execute-job][reporting] Kibana Advanced Setting "dateFormat:tz" is set to "Browser". Dates will be formatted as UTC to avoid ambiguity.
[00:00:39]                 │ proc [kibana]   log   [19:06:00.494] [info][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Job execution completed successfully
[00:00:39]                 │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.reporting-2020.03.29/pwXdDggoSAyAHzjEwFgdmA] update_mapping [_doc]
[00:00:39]                 │ proc [kibana]   log   [19:06:00.574] [info][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Job data saved successfully: /.reporting-2020.03.29/k8euf3ne10zjcf8f91e0sva1
[00:00:41]                 │ debg Report at path /api/reporting/jobs/download/k8euf3ne10zjcf8f91e0sva1 returned code 200
[00:00:41]                 └- ✓ pass  (2.5s) "chromium reporting usage from new jobs posted csv"
[00:00:41]               └-> "after each" hook
[00:00:41]                 │ debg ReportingAPI.deleteAllReportingIndexes
[00:00:41]                 │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.reporting-2020.03.29/pwXdDggoSAyAHzjEwFgdmA] deleting index
[00:00:41]               └-> preserve_layout pdf
[00:00:41]                 └-> "before each" hook: global before each
[00:00:41]                 │ debg ReportingAPI.postJob(/api/reporting/generate/printablePdf?jobParams=(browserTimezone:America%2FNew_York,layout:(dimensions:(height:439,width:1362),id:preserve_layout),objectType:dashboard,relativeUrls:!(%27%2Fapp%2Fkibana%23%2Fdashboard%2F61c58ad0-3dd3-11e8-b2b9-5d5dc1715159%3F_g%3D(refreshInterval:(display:Off,pause:!!f,value:0),time:(from:!%27Mon%2BApr%2B09%2B2018%2B17:56:08%2BGMT-0400!%27,mode:absolute,to:!%27Wed%2BApr%2B11%2B2018%2B17:56:08%2BGMT-0400!%27))%26_a%3D(description:!%27!%27,filters:!!((!%27$state!%27:(store:appState),meta:(alias:!!n,disabled:!!f,index:a0f483a0-3dc9-11e8-8660-4d65aa086b3c,key:animal,negate:!!f,params:(query:dog,type:phrase),type:phrase,value:dog),query:(match:(animal:(query:dog,type:phrase))))),fullScreenMode:!!f,options:(hidePanelTitles:!!f,useMargins:!!t),panels:!!((embeddableConfig:(),gridData:(h:15,i:!%271!%27,w:24,x:0,y:0),id:!%2750643b60-3dd3-11e8-b2b9-5d5dc1715159!%27,panelIndex:!%271!%27,type:visualization,version:!%276.3.0!%27),(embeddableConfig:(),gridData:(h:15,i:!%272!%27,w:24,x:24,y:0),id:a16d1990-3dca-11e8-8660-4d65aa086b3c,panelIndex:!%272!%27,type:search,version:!%276.3.0!%27)),query:(language:lucene,query:!%27!%27),timeRestore:!!t,title:!%27dashboard%2Bwith%2Bfilter!%27,viewMode:view)%27),title:%27dashboard%20with%20filter%27))
[00:00:41]                 │ debg ReportingAPI.postJob(/api/reporting/generate/printablePdf?jobParams=(browserTimezone:America%2FNew_York,layout:(dimensions:(height:441,width:1002),id:preserve_layout),objectType:visualization,relativeUrls:!(%27%2Fapp%2Fkibana%23%2Fvisualize%2Fedit%2F3fe22200-3dcb-11e8-8660-4d65aa086b3c%3F_g%3D(refreshInterval:(display:Off,pause:!!f,value:0),time:(from:!%27Mon%2BApr%2B09%2B2018%2B17:56:08%2BGMT-0400!%27,mode:absolute,to:!%27Wed%2BApr%2B11%2B2018%2B17:56:08%2BGMT-0400!%27))%26_a%3D(filters:!!(),linked:!!f,query:(language:lucene,query:!%27!%27),uiState:(),vis:(aggs:!!((enabled:!!t,id:!%271!%27,params:(),schema:metric,type:count),(enabled:!!t,id:!%272!%27,params:(field:bytes,missingBucket:!!f,missingBucketLabel:Missing,order:desc,orderBy:!%271!%27,otherBucket:!!f,otherBucketLabel:Other,size:5),schema:segment,type:terms)),params:(addLegend:!!t,addTooltip:!!t,isDonut:!!t,labels:(last_level:!!t,show:!!f,truncate:100,values:!!t),legendPosition:right,type:pie),title:!%27Rendering%2BTest:%2Bpie!%27,type:pie))%27),title:%27Rendering%20Test:%20pie%27))
[00:00:41]                 │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.reporting-2020.03.29] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:00:41]                 │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.reporting-2020.03.29]
[00:00:41]                 │ proc [kibana]   log   [19:06:02.708] [info][queue-job][reporting] Successfully queued job: k8euf5ka10zjcf8f915f0y7b
[00:00:41]                 │ proc [kibana]   log   [19:06:02.710] [info][queue-job][reporting] Successfully queued job: k8euf5k210zjcf8f915ac4wb
[00:00:41]                 │ debg Waiting for job to finish: /api/reporting/jobs/download/k8euf5k210zjcf8f915ac4wb
[00:00:41]                 │ debg Waiting for job to finish: /api/reporting/jobs/download/k8euf5ka10zjcf8f915f0y7b
[00:00:42]                 │ proc [kibana]   log   [19:06:03.592] [info][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Job marked as claimed: /.reporting-2020.03.29/k8euf5k210zjcf8f915ac4wb
[00:00:42]                 │ proc [kibana]   log   [19:06:03.592] [info][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Starting job
[00:00:42]                 │ proc [kibana]   log   [19:06:03.633] [info][browser-driver][execute][k8euf5k210zjcf8f915ac4wb][printable_pdf][reporting] Creating browser page driver
[00:00:43]                 │ proc [kibana]   log   [19:06:03.759] [error][execute][k8euf5k210zjcf8f915ac4wb][printable_pdf][reporting] Error: Error spawning Chromium browser: [Error: Protocol error (Target.setDiscoverTargets): Target closed.]
[00:00:43]                 │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-2/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:124:24)
[00:00:43]                 │ proc [kibana]   log   [19:06:03.786] [error][error][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Failure occurred on job k8euf5k210zjcf8f915ac4wb: Error: Error spawning Chromium browser: [Error: Protocol error (Target.setDiscoverTargets): Target closed.]
[00:00:43]                 │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-2/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:124:24)
[00:00:43]                 │ proc [kibana]   log   [19:06:03.787] [warning][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Failing job k8euf5k210zjcf8f915ac4wb
[00:00:43]                 │ proc [kibana]  error  [19:06:03.795] [warning][process] UnhandledPromiseRejectionWarning: Error: Protocol error (Target.setDiscoverTargets): Target closed.
[00:00:43]                 │ proc [kibana]     at Promise (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Connection.js:74:56)
[00:00:43]                 │ proc [kibana]     at new Promise (<anonymous>)
[00:00:43]                 │ proc [kibana]     at Connection.send (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Connection.js:73:12)
[00:00:43]                 │ proc [kibana]     at Function.create (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Browser.js:34:22)
[00:00:43]                 │ proc [kibana]     at Launcher.launch (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Launcher.js:184:37)
[00:00:43]                 │ proc [kibana]     at module.exports.launch (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Puppeteer.js:37:27)
[00:00:43]                 │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-2/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:108:25)
[00:00:43]                 │ proc [kibana]     at Observable._trySubscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:44:25)
[00:00:43]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:30:22)
[00:00:43]                 │ proc [kibana]     at MergeMapOperator.call (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/operators/mergeMap.js:39:23)
[00:00:43]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:25:31)
[00:00:43]                 │ proc [kibana]     at TakeOperator.call (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/operators/take.js:38:23)
[00:00:43]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:25:31)
[00:00:43]                 │ proc [kibana]     at ThrowIfEmptyOperator.call (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/operators/throwIfEmpty.js:30:23)
[00:00:43]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:25:31)
[00:00:43]                 │ proc [kibana]     at Object.subscribeToResult (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/util/subscribeToResult.js:12:23)
[00:00:43]                 │ proc [kibana]     at emitWarning (internal/process/promises.js:97:15)
[00:00:43]                 │ proc [kibana]     at emitPromiseRejectionWarnings (internal/process/promises.js:143:7)
[00:00:43]                 │ proc [kibana]     at process._tickCallback (internal/process/next_tick.js:69:34)
[00:00:43]                 │ proc [kibana]  error  [19:06:03.797] [warning][process] Error: Protocol error (Target.setDiscoverTargets): Target closed.
[00:00:43]                 │ proc [kibana]     at Promise (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Connection.js:74:56)
[00:00:43]                 │ proc [kibana]     at new Promise (<anonymous>)
[00:00:43]                 │ proc [kibana]     at Connection.send (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Connection.js:73:12)
[00:00:43]                 │ proc [kibana]     at Function.create (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Browser.js:34:22)
[00:00:43]                 │ proc [kibana]     at Launcher.launch (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Launcher.js:184:37)
[00:00:43]                 │ proc [kibana]     at module.exports.launch (/dev/shm/workspace/install/kibana-2/node_modules/puppeteer-core/lib/Puppeteer.js:37:27)
[00:00:43]                 │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-2/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:108:25)
[00:00:43]                 │ proc [kibana]     at Observable._trySubscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:44:25)
[00:00:43]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:30:22)
[00:00:43]                 │ proc [kibana]     at MergeMapOperator.call (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/operators/mergeMap.js:39:23)
[00:00:43]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:25:31)
[00:00:43]                 │ proc [kibana]     at TakeOperator.call (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/operators/take.js:38:23)
[00:00:43]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:25:31)
[00:00:43]                 │ proc [kibana]     at ThrowIfEmptyOperator.call (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/operators/throwIfEmpty.js:30:23)
[00:00:43]                 │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/Observable.js:25:31)
[00:00:43]                 │ proc [kibana]     at Object.subscribeToResult (/dev/shm/workspace/install/kibana-2/node_modules/rxjs/internal/util/subscribeToResult.js:12:23)
[00:00:43]                 │ proc [kibana]   log   [19:06:03.798] [info][esqueue][queue-worker][reporting] k8eue7c710zjcf8f91g2w2me - Job marked as failed: /.reporting-2020.03.29/k8euf5k210zjcf8f915ac4wb
[00:00:43]                 │ debg Report at path /api/reporting/jobs/download/k8euf5ka10zjcf8f915f0y7b returned code 503
[00:00:43]                 │ debg Report at path /api/reporting/jobs/download/k8euf5k210zjcf8f915ac4wb returned code 503
[00:00:45]                 │ proc [kibana]   log   [19:06:05.768] [error][reporting] Report k8euf5k210zjcf8f915ac4wb has failed: {"message":"Reporting generation failed","reason":"Error: Error spawning Chromium browser: [Error: Protocol error (Target.setDiscoverTargets): Target closed.]"}
[00:00:45]                 │ debg Report at path /api/reporting/jobs/download/k8euf5k210zjcf8f915ac4wb returned code 500
[00:00:45]                 └- ✖ fail: "chromium reporting usage from new jobs posted preserve_layout pdf"
[00:00:45]                 │

Stack Trace

Error: expected 500 to equal 200
    at Assertion.assert (/dev/shm/workspace/kibana/packages/kbn-expect/expect.js:100:11)
    at Assertion.be.Assertion.equal (/dev/shm/workspace/kibana/packages/kbn-expect/expect.js:227:8)
    at Assertion.be (/dev/shm/workspace/kibana/packages/kbn-expect/expect.js:69:22)
    at Object.waitForJobToFinish (test/reporting/services/reporting_api.js:38:29)

Kibana Pipeline / kibana-xpack-agent / X-Pack Chromium Functional Reporting Tests.x-pack/test/reporting/functional/reporting·js.reporting app Reporting Dashboard Print Layout downloads a PDF file

Link to Jenkins

Standard Out

Failed Tests Reporter:
  - Test has failed 9 times on tracked branches: https://github.com/elastic/kibana/issues/61022

[00:00:00]       │
[00:00:00]         └-: reporting app
[00:00:00]           └-> "before all" hook
[00:00:00]           └-: Reporting
[00:00:00]             └-> "before all" hook
[00:00:00]             └-> "before all" hook: initialize tests
[00:00:00]               │ debg ReportingPage:initTests
[00:00:00]               │ debg navigating to settings url: http://localhost:6161/app/kibana#/management
[00:00:00]               │ debg Navigate to: http://localhost:6161/app/kibana#/management
[00:00:00]               │ debg ... sleep(700) start
[00:00:00]               │ debg browser[INFO] http://localhost:6161/login?next=%2Fapp%2Fkibana%3F_t%3D1585595898859#/management 341 Refused to execute inline script because it violates the following Content Security Policy directive: "script-src 'unsafe-eval' 'self'". Either the 'unsafe-inline' keyword, a hash ('sha256-P5polb1UreUSOe5V/Pv7tc+yeZuJXiOi/3fqhGsU7BE='), or a nonce ('nonce-...') is required to enable inline execution.
[00:00:00]               │
[00:00:00]               │ debg browser[INFO] http://localhost:6161/bundles/app/core/bootstrap.js 9:19 "^ A single error about an inline script not firing due to content security policy is expected!"
[00:00:01]               │ debg ... sleep(700) end
[00:00:01]               │ debg returned from get, calling refresh
[00:00:01]               │ debg browser[INFO] http://localhost:6161/login?next=%2Fapp%2Fkibana%3F_t%3D1585595898859#/management 341 Refused to execute inline script because it violates the following Content Security Policy directive: "script-src 'unsafe-eval' 'self'". Either the 'unsafe-inline' keyword, a hash ('sha256-P5polb1UreUSOe5V/Pv7tc+yeZuJXiOi/3fqhGsU7BE='), or a nonce ('nonce-...') is required to enable inline execution.
[00:00:01]               │
[00:00:01]               │ debg browser[INFO] http://localhost:6161/bundles/app/core/bootstrap.js 9:19 "^ A single error about an inline script not firing due to content security policy is expected!"
[00:00:01]               │ debg currentUrl = http://localhost:6161/login?next=%2Fapp%2Fkibana%3F_t%3D1585595898859#/management
[00:00:01]               │          appUrl = http://localhost:6161/app/kibana#/management
[00:00:01]               │ debg TestSubjects.find(kibanaChrome)
[00:00:01]               │ debg Find.findByCssSelector('[data-test-subj="kibanaChrome"]') with timeout=60000
[00:00:08]               │ debg browser[INFO] http://localhost:6161/bundles/plugin/data/data.plugin.js 96:139630 "INFO: 2020-03-30T19:18:27Z
[00:00:08]               │        Adding connection to http://localhost:6161/elasticsearch
[00:00:08]               │
[00:00:08]               │      "
[00:00:08]               │ debg Found login page
[00:00:08]               │ debg TestSubjects.setValue(loginUsername, elastic)
[00:00:08]               │ debg TestSubjects.click(loginUsername)
[00:00:08]               │ debg Find.clickByCssSelector('[data-test-subj="loginUsername"]') with timeout=10000
[00:00:08]               │ debg Find.findByCssSelector('[data-test-subj="loginUsername"]') with timeout=10000
[00:00:08]               │ debg TestSubjects.setValue(loginPassword, changeme)
[00:00:08]               │ debg TestSubjects.click(loginPassword)
[00:00:08]               │ debg Find.clickByCssSelector('[data-test-subj="loginPassword"]') with timeout=10000
[00:00:08]               │ debg Find.findByCssSelector('[data-test-subj="loginPassword"]') with timeout=10000
[00:00:08]               │ debg TestSubjects.click(loginSubmit)
[00:00:08]               │ debg Find.clickByCssSelector('[data-test-subj="loginSubmit"]') with timeout=10000
[00:00:08]               │ debg Find.findByCssSelector('[data-test-subj="loginSubmit"]') with timeout=10000
[00:00:09]               │ debg Find.findByCssSelector('[data-test-subj="kibanaChrome"] nav:not(.ng-hide)') with timeout=60000
[00:00:09]               │ debg browser[INFO] http://localhost:6161/app/kibana?_t=1585595898859#/management 341 Refused to execute inline script because it violates the following Content Security Policy directive: "script-src 'unsafe-eval' 'self'". Either the 'unsafe-inline' keyword, a hash ('sha256-P5polb1UreUSOe5V/Pv7tc+yeZuJXiOi/3fqhGsU7BE='), or a nonce ('nonce-...') is required to enable inline execution.
[00:00:09]               │
[00:00:09]               │ debg browser[INFO] http://localhost:6161/bundles/app/kibana/bootstrap.js 9:19 "^ A single error about an inline script not firing due to content security policy is expected!"
[00:00:13]               │ debg browser[INFO] http://localhost:6161/bundles/plugin/data/data.plugin.js 96:139630 "INFO: 2020-03-30T19:18:32Z
[00:00:13]               │        Adding connection to http://localhost:6161/elasticsearch
[00:00:13]               │
[00:00:13]               │      "
[00:00:16]               │ debg browser[INFO] http://localhost:6161/app/kibana?_t=1585595914601#/management 341 Refused to execute inline script because it violates the following Content Security Policy directive: "script-src 'unsafe-eval' 'self'". Either the 'unsafe-inline' keyword, a hash ('sha256-P5polb1UreUSOe5V/Pv7tc+yeZuJXiOi/3fqhGsU7BE='), or a nonce ('nonce-...') is required to enable inline execution.
[00:00:16]               │
[00:00:16]               │ debg browser[INFO] http://localhost:6161/bundles/app/kibana/bootstrap.js 9:19 "^ A single error about an inline script not firing due to content security policy is expected!"
[00:00:16]               │ debg Finished login process currentUrl = http://localhost:6161/app/kibana#/management
[00:00:16]               │ debg TestSubjects.find(kibanaChrome)
[00:00:16]               │ debg Find.findByCssSelector('[data-test-subj="kibanaChrome"]') with timeout=10000
[00:00:19]               │ debg browser[INFO] http://localhost:6161/bundles/plugin/data/data.plugin.js 96:139630 "INFO: 2020-03-30T19:18:38Z
[00:00:19]               │        Adding connection to http://localhost:6161/elasticsearch
[00:00:19]               │
[00:00:19]               │      "
[00:00:20]               │ debg ... sleep(501) start
[00:00:21]               │ debg ... sleep(501) end
[00:00:21]               │ debg in navigateTo url = http://localhost:6161/app/kibana#/management?_g=()
[00:00:21]               │ debg TestSubjects.exists(statusPageContainer)
[00:00:21]               │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="statusPageContainer"]') with timeout=2500
[00:00:23]               │ debg --- retry.tryForTime error: [data-test-subj="statusPageContainer"] is not displayed
[00:00:24]               │ info [../../functional/es_archives/logstash_functional] Loading "mappings.json"
[00:00:24]               │ info [../../functional/es_archives/logstash_functional] Loading "data.json.gz"
[00:00:24]               │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [logstash-2015.09.22] creating index, cause [api], templates [], shards [1]/[0], mappings [_doc]
[00:00:24]               │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] Cluster health status changed from [YELLOW] to [GREEN] (reason: [shards started [[logstash-2015.09.22][0]]]).
[00:00:24]               │ info [../../functional/es_archives/logstash_functional] Created index "logstash-2015.09.22"
[00:00:24]               │ debg [../../functional/es_archives/logstash_functional] "logstash-2015.09.22" settings {"index":{"analysis":{"analyzer":{"url":{"max_token_length":"1000","tokenizer":"uax_url_email","type":"standard"}}},"number_of_replicas":"0","number_of_shards":"1"}}
[00:00:24]               │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [logstash-2015.09.20] creating index, cause [api], templates [], shards [1]/[0], mappings [_doc]
[00:00:24]               │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] Cluster health status changed from [YELLOW] to [GREEN] (reason: [shards started [[logstash-2015.09.20][0]]]).
[00:00:24]               │ info [../../functional/es_archives/logstash_functional] Created index "logstash-2015.09.20"
[00:00:24]               │ debg [../../functional/es_archives/logstash_functional] "logstash-2015.09.20" settings {"index":{"analysis":{"analyzer":{"url":{"max_token_length":"1000","tokenizer":"uax_url_email","type":"standard"}}},"number_of_replicas":"0","number_of_shards":"1"}}
[00:00:24]               │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [logstash-2015.09.21] creating index, cause [api], templates [], shards [1]/[0], mappings [_doc]
[00:00:24]               │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] Cluster health status changed from [YELLOW] to [GREEN] (reason: [shards started [[logstash-2015.09.21][0]]]).
[00:00:24]               │ info [../../functional/es_archives/logstash_functional] Created index "logstash-2015.09.21"
[00:00:24]               │ debg [../../functional/es_archives/logstash_functional] "logstash-2015.09.21" settings {"index":{"analysis":{"analyzer":{"url":{"max_token_length":"1000","tokenizer":"uax_url_email","type":"standard"}}},"number_of_replicas":"0","number_of_shards":"1"}}
[00:00:34]               │ info progress: 11640
[00:00:35]               │ info [../../functional/es_archives/logstash_functional] Indexed 4634 docs into "logstash-2015.09.22"
[00:00:35]               │ info [../../functional/es_archives/logstash_functional] Indexed 4757 docs into "logstash-2015.09.20"
[00:00:35]               │ info [../../functional/es_archives/logstash_functional] Indexed 4614 docs into "logstash-2015.09.21"
[00:00:36]               │ info [reporting/historic] Loading "mappings.json"
[00:00:36]               │ info [reporting/historic] Loading "data.json.gz"
[00:00:36]               │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1/wrWv9zGqSNS5NQw9M9Srlw] deleting index
[00:00:36]               │ info [reporting/historic] Deleted existing index [".kibana_1"]
[00:00:36]               │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:00:36]               │ info [reporting/historic] Created index ".kibana"
[00:00:36]               │ debg [reporting/historic] ".kibana" settings {"index":{"number_of_replicas":"1","number_of_shards":"1"}}
[00:00:36]               │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.reporting-2018.03.11] creating index, cause [api], templates [], shards [1]/[0], mappings [_doc]
[00:00:36]               │ info [reporting/historic] Created index ".reporting-2018.03.11"
[00:00:36]               │ debg [reporting/historic] ".reporting-2018.03.11" settings {"index":{"auto_expand_replicas":"0-1","number_of_replicas":"0","number_of_shards":"1"}}
[00:00:36]               │ info [reporting/historic] Indexed 10 docs into ".kibana"
[00:00:36]               │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana/WahVqOXfRbGygut5fUpO6A] update_mapping [_doc]
[00:00:36]               │ debg Migrating saved objects
[00:00:37]               │ proc [kibana]   log   [19:18:56.524] [info][savedobjects-service] Creating index .kibana_2.
[00:00:37]               │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:00:37]               │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.kibana_2]
[00:00:37]               │ proc [kibana]   log   [19:18:56.620] [info][savedobjects-service] Reindexing .kibana to .kibana_1
[00:00:37]               │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_1] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:00:37]               │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.kibana_1]
[00:00:37]               │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.tasks] creating index, cause [auto(task api)], templates [], shards [1]/[1], mappings [_doc]
[00:00:37]               │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.tasks]
[00:00:38]               │ info [o.e.t.LoggingTaskListener] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] 2131 finished with response BulkByScrollResponse[took=46.6ms,timed_out=false,sliceId=null,updated=0,created=11,deleted=0,batches=1,versionConflicts=0,noops=0,retries=0,throttledUntil=0s,bulk_failures=[],search_failures=[]]
[00:00:38]               │ info [o.e.c.m.MetaDataDeleteIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana/WahVqOXfRbGygut5fUpO6A] deleting index
[00:00:38]               │ proc [kibana]   log   [19:18:57.069] [info][savedobjects-service] Migrating .kibana_1 saved objects to .kibana_2
[00:00:38]               │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/jDDpa_LdSe-7ax-SXi_afg] update_mapping [_doc]
[00:00:38]               │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/jDDpa_LdSe-7ax-SXi_afg] update_mapping [_doc]
[00:00:38]               │ info [o.e.c.m.MetaDataMappingService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.kibana_2/jDDpa_LdSe-7ax-SXi_afg] update_mapping [_doc]
[00:00:38]               │ proc [kibana]   log   [19:18:57.321] [info][savedobjects-service] Pointing alias .kibana to .kibana_2.
[00:00:38]               │ proc [kibana]   log   [19:18:57.395] [info][savedobjects-service] Finished in 874ms.
[00:00:38]               │ debg replacing kibana config doc: {"defaultIndex":"logstash-*"}
[00:00:38]             └-: Dashboard
[00:00:38]               └-> "before all" hook
[00:01:30]               └-: Print Layout
[00:01:30]                 └-> "before all" hook
[00:01:30]                 └-> downloads a PDF file
[00:01:30]                   └-> "before each" hook: global before each
[00:01:30]                   └-> "before each" hook
[00:01:30]                     │ debg TestSubjects.findAll(toastCloseButton)
[00:01:30]                     │ debg Find.allByCssSelector('[data-test-subj="toastCloseButton"]') with timeout=10000
[00:01:40]                   │ debg navigating to dashboard url: http://localhost:6161/app/kibana#/dashboards
[00:01:40]                   │ debg Navigate to: http://localhost:6161/app/kibana#/dashboards
[00:01:40]                   │ debg ... sleep(700) start
[00:01:40]                   │ debg browser[INFO] http://localhost:6161/app/kibana?_t=1585595998934#/dashboards 341 Refused to execute inline script because it violates the following Content Security Policy directive: "script-src 'unsafe-eval' 'self'". Either the 'unsafe-inline' keyword, a hash ('sha256-P5polb1UreUSOe5V/Pv7tc+yeZuJXiOi/3fqhGsU7BE='), or a nonce ('nonce-...') is required to enable inline execution.
[00:01:40]                   │
[00:01:40]                   │ debg browser[INFO] http://localhost:6161/bundles/app/kibana/bootstrap.js 9:19 "^ A single error about an inline script not firing due to content security policy is expected!"
[00:01:41]                   │ debg ... sleep(700) end
[00:01:41]                   │ debg returned from get, calling refresh
[00:01:41]                   │ debg browser[INFO] http://localhost:6161/app/kibana?_t=1585595998934#/dashboards 341 Refused to execute inline script because it violates the following Content Security Policy directive: "script-src 'unsafe-eval' 'self'". Either the 'unsafe-inline' keyword, a hash ('sha256-P5polb1UreUSOe5V/Pv7tc+yeZuJXiOi/3fqhGsU7BE='), or a nonce ('nonce-...') is required to enable inline execution.
[00:01:41]                   │
[00:01:41]                   │ debg browser[INFO] http://localhost:6161/bundles/app/kibana/bootstrap.js 9:19 "^ A single error about an inline script not firing due to content security policy is expected!"
[00:01:41]                   │ debg currentUrl = http://localhost:6161/app/kibana#/dashboards
[00:01:41]                   │          appUrl = http://localhost:6161/app/kibana#/dashboards
[00:01:41]                   │ debg TestSubjects.find(kibanaChrome)
[00:01:41]                   │ debg Find.findByCssSelector('[data-test-subj="kibanaChrome"]') with timeout=60000
[00:01:48]                   │ debg TestSubjects.find(kibanaChrome)
[00:01:48]                   │ debg Find.findByCssSelector('[data-test-subj="kibanaChrome"]') with timeout=10000
[00:01:48]                   │ debg browser[INFO] http://localhost:6161/bundles/plugin/data/data.plugin.js 96:139630 "INFO: 2020-03-30T19:20:05Z
[00:01:48]                   │        Adding connection to http://localhost:6161/elasticsearch
[00:01:48]                   │
[00:01:48]                   │      "
[00:01:48]                   │ debg ... sleep(501) start
[00:01:49]                   │ debg ... sleep(501) end
[00:01:49]                   │ debg in navigateTo url = http://localhost:6161/app/kibana#/dashboards?_g=(filters:!(),refreshInterval:(pause:!t,value:0),time:(from:now-15m,to:now))
[00:01:49]                   │ debg --- retry.try error: URL changed, waiting for it to settle
[00:01:49]                   │ debg ... sleep(501) start
[00:01:50]                   │ debg ... sleep(501) end
[00:01:50]                   │ debg in navigateTo url = http://localhost:6161/app/kibana#/dashboards?_g=(filters:!(),refreshInterval:(pause:!t,value:0),time:(from:now-15m,to:now))
[00:01:50]                   │ debg TestSubjects.exists(statusPageContainer)
[00:01:50]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="statusPageContainer"]') with timeout=2500
[00:01:52]                   │ debg --- retry.tryForTime error: [data-test-subj="statusPageContainer"] is not displayed
[00:01:53]                   │ debg Load Saved Dashboard My PDF Dashboard
[00:01:53]                   │ debg gotoDashboardLandingPage
[00:01:53]                   │ debg onDashboardLandingPage
[00:01:53]                   │ debg TestSubjects.exists(dashboardLandingPage)
[00:01:53]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardLandingPage"]') with timeout=5000
[00:01:53]                   │ debg searchForItemWithName: My PDF Dashboard
[00:01:53]                   │ debg Find.allByCssSelector('.euiFieldSearch') with timeout=10000
[00:01:53]                   │ debg isGlobalLoadingIndicatorVisible
[00:01:53]                   │ debg TestSubjects.exists(globalLoadingIndicator)
[00:01:53]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="globalLoadingIndicator"]') with timeout=1500
[00:01:54]                   │ debg TestSubjects.exists(globalLoadingIndicator-hidden)
[00:01:54]                   │ debg Find.existsByCssSelector('[data-test-subj="globalLoadingIndicator-hidden"]') with timeout=100000
[00:01:54]                   │ debg TestSubjects.click(dashboardListingTitleLink-My-PDF-Dashboard)
[00:01:54]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardListingTitleLink-My-PDF-Dashboard"]') with timeout=10000
[00:01:54]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardListingTitleLink-My-PDF-Dashboard"]') with timeout=10000
[00:01:54]                   │ debg isGlobalLoadingIndicatorVisible
[00:01:54]                   │ debg TestSubjects.exists(globalLoadingIndicator)
[00:01:54]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="globalLoadingIndicator"]') with timeout=1500
[00:01:54]                   │ debg TestSubjects.exists(globalLoadingIndicator-hidden)
[00:01:54]                   │ debg Find.existsByCssSelector('[data-test-subj="globalLoadingIndicator-hidden"]') with timeout=100000
[00:01:54]                   │ debg TestSubjects.missingOrFail(dashboardLandingPage)
[00:01:54]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="dashboardLandingPage"]') with timeout=10000
[00:01:55]                   │ debg Switching to edit mode
[00:01:55]                   │ debg TestSubjects.click(dashboardEditMode)
[00:01:55]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardEditMode"]') with timeout=10000
[00:01:55]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardEditMode"]') with timeout=10000
[00:01:55]                   │ debg Waiting up to 20000ms for in edit mode...
[00:01:55]                   │ debg TestSubjects.findAll(embeddablePanel)
[00:01:55]                   │ debg Find.allByCssSelector('[data-test-subj="embeddablePanel"]') with timeout=2500
[00:01:58]                   │ debg TestSubjects.findAll(embeddablePanelToggleMenuIcon)
[00:01:58]                   │ debg Find.allByCssSelector('[data-test-subj="embeddablePanelToggleMenuIcon"]') with timeout=2500
[00:02:00]                   │ debg Reporting:setTimepickerInDataRange
[00:02:00]                   │ debg Setting absolute range to Sep 19, 2015 @ 06:31:44.000 to Sep 19, 2015 @ 18:01:44.000
[00:02:00]                   │ debg TestSubjects.exists(superDatePickerToggleQuickMenuButton)
[00:02:00]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="superDatePickerToggleQuickMenuButton"]') with timeout=20000
[00:02:00]                   │ debg TestSubjects.exists(superDatePickerShowDatesButton)
[00:02:00]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="superDatePickerShowDatesButton"]') with timeout=2500
[00:02:00]                   │ debg TestSubjects.click(superDatePickerShowDatesButton)
[00:02:00]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerShowDatesButton"]') with timeout=10000
[00:02:00]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerShowDatesButton"]') with timeout=10000
[00:02:00]                   │ debg TestSubjects.exists(superDatePickerstartDatePopoverButton)
[00:02:00]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="superDatePickerstartDatePopoverButton"]') with timeout=2500
[00:02:00]                   │ debg TestSubjects.click(superDatePickerendDatePopoverButton)
[00:02:00]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerendDatePopoverButton"]') with timeout=10000
[00:02:00]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerendDatePopoverButton"]') with timeout=10000
[00:02:00]                   │ debg Find.findByCssSelector('div.euiPopover__panel-isOpen') with timeout=10000
[00:02:00]                   │ debg TestSubjects.click(superDatePickerAbsoluteTab)
[00:02:00]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerAbsoluteTab"]') with timeout=10000
[00:02:00]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerAbsoluteTab"]') with timeout=10000
[00:02:00]                   │ debg TestSubjects.click(superDatePickerAbsoluteDateInput)
[00:02:00]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerAbsoluteDateInput"]') with timeout=10000
[00:02:00]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerAbsoluteDateInput"]') with timeout=10000
[00:02:01]                   │ debg TestSubjects.setValue(superDatePickerAbsoluteDateInput, Sep 19, 2015 @ 18:01:44.000)
[00:02:01]                   │ debg TestSubjects.click(superDatePickerAbsoluteDateInput)
[00:02:01]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerAbsoluteDateInput"]') with timeout=10000
[00:02:01]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerAbsoluteDateInput"]') with timeout=10000
[00:02:01]                   │ debg ... sleep(500) start
[00:02:02]                   │ debg ... sleep(500) end
[00:02:02]                   │ debg TestSubjects.click(superDatePickerstartDatePopoverButton)
[00:02:02]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerstartDatePopoverButton"]') with timeout=10000
[00:02:02]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerstartDatePopoverButton"]') with timeout=10000
[00:02:02]                   │ debg Find.waitForElementStale with timeout=10000
[00:02:02]                   │ debg Find.findByCssSelector('div.euiPopover__panel-isOpen') with timeout=10000
[00:02:02]                   │ debg TestSubjects.click(superDatePickerAbsoluteTab)
[00:02:02]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerAbsoluteTab"]') with timeout=10000
[00:02:02]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerAbsoluteTab"]') with timeout=10000
[00:02:02]                   │ debg TestSubjects.click(superDatePickerAbsoluteDateInput)
[00:02:02]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerAbsoluteDateInput"]') with timeout=10000
[00:02:02]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerAbsoluteDateInput"]') with timeout=10000
[00:02:02]                   │ debg TestSubjects.setValue(superDatePickerAbsoluteDateInput, Sep 19, 2015 @ 06:31:44.000)
[00:02:02]                   │ debg TestSubjects.click(superDatePickerAbsoluteDateInput)
[00:02:02]                   │ debg Find.clickByCssSelector('[data-test-subj="superDatePickerAbsoluteDateInput"]') with timeout=10000
[00:02:02]                   │ debg Find.findByCssSelector('[data-test-subj="superDatePickerAbsoluteDateInput"]') with timeout=10000
[00:02:03]                   │ debg TestSubjects.exists(superDatePickerApplyTimeButton)
[00:02:03]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="superDatePickerApplyTimeButton"]') with timeout=2500
[00:02:05]                   │ debg --- retry.tryForTime error: [data-test-subj="superDatePickerApplyTimeButton"] is not displayed
[00:02:06]                   │ debg TestSubjects.click(querySubmitButton)
[00:02:06]                   │ debg Find.clickByCssSelector('[data-test-subj="querySubmitButton"]') with timeout=10000
[00:02:06]                   │ debg Find.findByCssSelector('[data-test-subj="querySubmitButton"]') with timeout=10000
[00:02:06]                   │ debg Find.waitForElementStale with timeout=10000
[00:02:06]                   │ debg TestSubjects.exists(globalLoadingIndicator-hidden)
[00:02:06]                   │ debg Find.existsByCssSelector('[data-test-subj="globalLoadingIndicator-hidden"]') with timeout=100000
[00:02:06]                   │ debg DashboardAddPanel.addVisualizations
[00:02:06]                   │ debg DashboardAddPanel.addEmbeddable, name: Visualization PieChart, type: visualization
[00:02:06]                   │ debg DashboardAddPanel.ensureAddPanelIsShowing
[00:02:06]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:06]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:06]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:09]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:09]                   │ debg DashboardAddPanel.clickOpenAddPanel
[00:02:09]                   │ debg TestSubjects.click(dashboardAddPanelButton)
[00:02:09]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:09]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:09]                   │ debg ... sleep(500) start
[00:02:10]                   │ debg ... sleep(500) end
[00:02:10]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:10]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:10]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:10]                   │ debg DashboardAddPanel.addToFilter(visualization)
[00:02:10]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:11]                   │ debg DashboardAddPanel.toggleFilter
[00:02:11]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:11]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:11]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:11]                   │ debg TestSubjects.click(savedObjectFinderFilter-visualization)
[00:02:11]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:11]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:11]                   │ debg DashboardAddPanel.toggleFilter
[00:02:11]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:11]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:11]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:11]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:11]                   │ debg TestSubjects.setValue(savedObjectFinderSearchInput, "Visualization PieChart")
[00:02:11]                   │ debg TestSubjects.click(savedObjectFinderSearchInput)
[00:02:11]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:11]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:12]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:12]                   │ debg TestSubjects.click(savedObjectTitleVisualization-PieChart)
[00:02:12]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectTitleVisualization-PieChart"]') with timeout=10000
[00:02:12]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectTitleVisualization-PieChart"]') with timeout=10000
[00:02:12]                   │ debg TestSubjects.exists(addObjectToDashboardSuccess)
[00:02:12]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="addObjectToDashboardSuccess"]') with timeout=2500
[00:02:15]                   │ debg --- retry.tryForTime error: [data-test-subj="addObjectToDashboardSuccess"] is not displayed
[00:02:15]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:15]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:15]                   │ debg Closing flyout dashboardAddPanel
[00:02:15]                   │ debg TestSubjects.find(dashboardAddPanel)
[00:02:15]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=10000
[00:02:15]                   │ debg Waiting up to 20000ms for flyout closed...
[00:02:15]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:15]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:17]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:17]                   │ debg DashboardAddPanel.addEmbeddable, name: Visualization☺ VerticalBarChart, type: visualization
[00:02:17]                   │ debg DashboardAddPanel.ensureAddPanelIsShowing
[00:02:17]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:17]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:17]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:20]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:20]                   │ debg DashboardAddPanel.clickOpenAddPanel
[00:02:20]                   │ debg TestSubjects.click(dashboardAddPanelButton)
[00:02:20]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:20]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:20]                   │ debg ... sleep(500) start
[00:02:21]                   │ debg ... sleep(500) end
[00:02:21]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:21]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:21]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:21]                   │ debg DashboardAddPanel.addToFilter(visualization)
[00:02:21]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:21]                   │ debg DashboardAddPanel.toggleFilter
[00:02:21]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:21]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:21]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:21]                   │ debg TestSubjects.click(savedObjectFinderFilter-visualization)
[00:02:21]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:21]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:21]                   │ debg DashboardAddPanel.toggleFilter
[00:02:21]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:21]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:21]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:21]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:22]                   │ debg TestSubjects.setValue(savedObjectFinderSearchInput, "Visualization☺ VerticalBarChart")
[00:02:22]                   │ debg TestSubjects.click(savedObjectFinderSearchInput)
[00:02:22]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:22]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:22]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:23]                   │ debg TestSubjects.click(savedObjectTitleVisualization☺-VerticalBarChart)
[00:02:23]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectTitleVisualization☺-VerticalBarChart"]') with timeout=10000
[00:02:23]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectTitleVisualization☺-VerticalBarChart"]') with timeout=10000
[00:02:23]                   │ debg TestSubjects.exists(addObjectToDashboardSuccess)
[00:02:23]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="addObjectToDashboardSuccess"]') with timeout=2500
[00:02:26]                   │ debg --- retry.tryForTime error: [data-test-subj="addObjectToDashboardSuccess"] is not displayed
[00:02:26]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:26]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:26]                   │ debg Closing flyout dashboardAddPanel
[00:02:26]                   │ debg TestSubjects.find(dashboardAddPanel)
[00:02:26]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=10000
[00:02:26]                   │ debg Waiting up to 20000ms for flyout closed...
[00:02:26]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:26]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:27]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:28]                   │ debg DashboardAddPanel.addEmbeddable, name: Visualization漢字 AreaChart, type: visualization
[00:02:28]                   │ debg DashboardAddPanel.ensureAddPanelIsShowing
[00:02:28]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:28]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:28]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:30]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:31]                   │ debg DashboardAddPanel.clickOpenAddPanel
[00:02:31]                   │ debg TestSubjects.click(dashboardAddPanelButton)
[00:02:31]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:31]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:31]                   │ debg ... sleep(500) start
[00:02:32]                   │ debg ... sleep(500) end
[00:02:32]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:32]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:32]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:32]                   │ debg DashboardAddPanel.addToFilter(visualization)
[00:02:32]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:32]                   │ debg DashboardAddPanel.toggleFilter
[00:02:32]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:32]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:32]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:32]                   │ debg TestSubjects.click(savedObjectFinderFilter-visualization)
[00:02:32]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:32]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:32]                   │ debg DashboardAddPanel.toggleFilter
[00:02:32]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:32]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:32]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:32]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:33]                   │ debg TestSubjects.setValue(savedObjectFinderSearchInput, "Visualization漢字 AreaChart")
[00:02:33]                   │ debg TestSubjects.click(savedObjectFinderSearchInput)
[00:02:33]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:33]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:33]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:34]                   │ debg TestSubjects.click(savedObjectTitleVisualization漢字-AreaChart)
[00:02:34]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectTitleVisualization漢字-AreaChart"]') with timeout=10000
[00:02:34]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectTitleVisualization漢字-AreaChart"]') with timeout=10000
[00:02:34]                   │ debg TestSubjects.exists(addObjectToDashboardSuccess)
[00:02:34]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="addObjectToDashboardSuccess"]') with timeout=2500
[00:02:37]                   │ debg --- retry.tryForTime error: [data-test-subj="addObjectToDashboardSuccess"] is not displayed
[00:02:37]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:37]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:37]                   │ debg Closing flyout dashboardAddPanel
[00:02:37]                   │ debg TestSubjects.find(dashboardAddPanel)
[00:02:37]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=10000
[00:02:37]                   │ debg Waiting up to 20000ms for flyout closed...
[00:02:37]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:37]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:38]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:39]                   │ debg DashboardAddPanel.addEmbeddable, name: Visualization☺漢字 DataTable, type: visualization
[00:02:39]                   │ debg DashboardAddPanel.ensureAddPanelIsShowing
[00:02:39]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:39]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:39]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:41]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:42]                   │ debg DashboardAddPanel.clickOpenAddPanel
[00:02:42]                   │ debg TestSubjects.click(dashboardAddPanelButton)
[00:02:42]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:42]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:42]                   │ debg ... sleep(500) start
[00:02:42]                   │ debg ... sleep(500) end
[00:02:42]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:42]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:42]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:42]                   │ debg DashboardAddPanel.addToFilter(visualization)
[00:02:42]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:43]                   │ debg DashboardAddPanel.toggleFilter
[00:02:43]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:43]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:43]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:43]                   │ debg TestSubjects.click(savedObjectFinderFilter-visualization)
[00:02:43]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:43]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:43]                   │ debg DashboardAddPanel.toggleFilter
[00:02:43]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:43]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:43]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:43]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:44]                   │ debg TestSubjects.setValue(savedObjectFinderSearchInput, "Visualization☺漢字 DataTable")
[00:02:44]                   │ debg TestSubjects.click(savedObjectFinderSearchInput)
[00:02:44]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:44]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:44]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:44]                   │ debg TestSubjects.click(savedObjectTitleVisualization☺漢字-DataTable)
[00:02:44]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectTitleVisualization☺漢字-DataTable"]') with timeout=10000
[00:02:44]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectTitleVisualization☺漢字-DataTable"]') with timeout=10000
[00:02:45]                   │ debg TestSubjects.exists(addObjectToDashboardSuccess)
[00:02:45]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="addObjectToDashboardSuccess"]') with timeout=2500
[00:02:47]                   │ debg --- retry.tryForTime error: [data-test-subj="addObjectToDashboardSuccess"] is not displayed
[00:02:48]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:48]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:48]                   │ debg Closing flyout dashboardAddPanel
[00:02:48]                   │ debg TestSubjects.find(dashboardAddPanel)
[00:02:48]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=10000
[00:02:48]                   │ debg Waiting up to 20000ms for flyout closed...
[00:02:48]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:48]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:49]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:49]                   │ debg DashboardAddPanel.addEmbeddable, name: Visualization漢字 LineChart, type: visualization
[00:02:49]                   │ debg DashboardAddPanel.ensureAddPanelIsShowing
[00:02:49]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:49]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:49]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:52]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:02:52]                   │ debg DashboardAddPanel.clickOpenAddPanel
[00:02:52]                   │ debg TestSubjects.click(dashboardAddPanelButton)
[00:02:52]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:52]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:02:52]                   │ debg ... sleep(500) start
[00:02:53]                   │ debg ... sleep(500) end
[00:02:53]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:02:53]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:53]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:02:53]                   │ debg DashboardAddPanel.addToFilter(visualization)
[00:02:53]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:53]                   │ debg DashboardAddPanel.toggleFilter
[00:02:53]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:53]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:53]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:54]                   │ debg TestSubjects.click(savedObjectFinderFilter-visualization)
[00:02:54]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:54]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:02:54]                   │ debg DashboardAddPanel.toggleFilter
[00:02:54]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:02:54]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:54]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:02:54]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:54]                   │ debg TestSubjects.setValue(savedObjectFinderSearchInput, "Visualization漢字 LineChart")
[00:02:54]                   │ debg TestSubjects.click(savedObjectFinderSearchInput)
[00:02:54]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:54]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:02:55]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:02:55]                   │ debg TestSubjects.click(savedObjectTitleVisualization漢字-LineChart)
[00:02:55]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectTitleVisualization漢字-LineChart"]') with timeout=10000
[00:02:55]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectTitleVisualization漢字-LineChart"]') with timeout=10000
[00:02:55]                   │ debg TestSubjects.exists(addObjectToDashboardSuccess)
[00:02:55]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="addObjectToDashboardSuccess"]') with timeout=2500
[00:02:58]                   │ debg --- retry.tryForTime error: [data-test-subj="addObjectToDashboardSuccess"] is not displayed
[00:02:58]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:58]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:58]                   │ debg Closing flyout dashboardAddPanel
[00:02:58]                   │ debg TestSubjects.find(dashboardAddPanel)
[00:02:58]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=10000
[00:02:58]                   │ debg Waiting up to 20000ms for flyout closed...
[00:02:58]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:02:58]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:02:59]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:03:00]                   │ debg DashboardAddPanel.addEmbeddable, name: Visualization MetricChart, type: visualization
[00:03:00]                   │ debg DashboardAddPanel.ensureAddPanelIsShowing
[00:03:00]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:03:00]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:03:00]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:03:02]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:03:03]                   │ debg DashboardAddPanel.clickOpenAddPanel
[00:03:03]                   │ debg TestSubjects.click(dashboardAddPanelButton)
[00:03:03]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:03:03]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanelButton"]') with timeout=10000
[00:03:03]                   │ debg ... sleep(500) start
[00:03:04]                   │ debg ... sleep(500) end
[00:03:04]                   │ debg DashboardAddPanel.isAddPanelOpen
[00:03:04]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:03:04]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=2500
[00:03:04]                   │ debg DashboardAddPanel.addToFilter(visualization)
[00:03:04]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:03:04]                   │ debg DashboardAddPanel.toggleFilter
[00:03:04]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:03:04]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:03:04]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:03:04]                   │ debg TestSubjects.click(savedObjectFinderFilter-visualization)
[00:03:04]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:03:04]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilter-visualization"]') with timeout=10000
[00:03:04]                   │ debg DashboardAddPanel.toggleFilter
[00:03:04]                   │ debg TestSubjects.click(savedObjectFinderFilterButton)
[00:03:04]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:03:04]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderFilterButton"]') with timeout=10000
[00:03:04]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:03:05]                   │ debg TestSubjects.setValue(savedObjectFinderSearchInput, "Visualization MetricChart")
[00:03:05]                   │ debg TestSubjects.click(savedObjectFinderSearchInput)
[00:03:05]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:03:05]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectFinderSearchInput"]') with timeout=10000
[00:03:05]                   │ debg Find.waitForDeletedByCssSelector('[data-test-subj="savedObjectFinderLoadingIndicator"]') with timeout=10000
[00:03:06]                   │ debg TestSubjects.click(savedObjectTitleVisualization-MetricChart)
[00:03:06]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectTitleVisualization-MetricChart"]') with timeout=10000
[00:03:06]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectTitleVisualization-MetricChart"]') with timeout=10000
[00:03:06]                   │ debg TestSubjects.exists(addObjectToDashboardSuccess)
[00:03:06]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="addObjectToDashboardSuccess"]') with timeout=2500
[00:03:08]                   │ debg --- retry.tryForTime error: [data-test-subj="addObjectToDashboardSuccess"] is not displayed
[00:03:09]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:03:09]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:03:09]                   │ debg Closing flyout dashboardAddPanel
[00:03:09]                   │ debg TestSubjects.find(dashboardAddPanel)
[00:03:09]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=10000
[00:03:09]                   │ debg Waiting up to 20000ms for flyout closed...
[00:03:09]                   │ debg TestSubjects.exists(dashboardAddPanel)
[00:03:09]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="dashboardAddPanel"]') with timeout=1000
[00:03:10]                   │ debg --- retry.tryForTime error: [data-test-subj="dashboardAddPanel"] is not displayed
[00:03:11]                   │ debg TestSubjects.click(dashboardSaveMenuItem)
[00:03:11]                   │ debg Find.clickByCssSelector('[data-test-subj="dashboardSaveMenuItem"]') with timeout=10000
[00:03:11]                   │ debg Find.findByCssSelector('[data-test-subj="dashboardSaveMenuItem"]') with timeout=10000
[00:03:11]                   │ debg TestSubjects.find(savedObjectSaveModal)
[00:03:11]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectSaveModal"]') with timeout=10000
[00:03:11]                   │ debg entering new title
[00:03:11]                   │ debg TestSubjects.setValue(savedObjectTitle, report test)
[00:03:11]                   │ debg TestSubjects.click(savedObjectTitle)
[00:03:11]                   │ debg Find.clickByCssSelector('[data-test-subj="savedObjectTitle"]') with timeout=10000
[00:03:11]                   │ debg Find.findByCssSelector('[data-test-subj="savedObjectTitle"]') with timeout=10000
[00:03:11]                   │ debg DashboardPage.clickSave
[00:03:11]                   │ debg TestSubjects.click(confirmSaveSavedObjectButton)
[00:03:11]                   │ debg Find.clickByCssSelector('[data-test-subj="confirmSaveSavedObjectButton"]') with timeout=10000
[00:03:11]                   │ debg Find.findByCssSelector('[data-test-subj="confirmSaveSavedObjectButton"]') with timeout=10000
[00:03:11]                   │ debg Find.waitForElementStale with timeout=10000
[00:03:12]                   │ debg TestSubjects.exists(saveDashboardSuccess)
[00:03:12]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="saveDashboardSuccess"]') with timeout=120000
[00:03:12]                   │ debg Find.findByCssSelector('.euiToast') with timeout=20000
[00:03:12]                   │ debg Find.findByCssSelector('.euiToastHeader__title') with timeout=10000
[00:03:12]                   │ debg Toast title: Dashboard 'report test' was saved
[00:03:12]                   │ debg Find.clickByCssSelector('.euiToast__closeButton') with timeout=10000
[00:03:12]                   │ debg Find.findByCssSelector('.euiToast__closeButton') with timeout=10000
[00:03:12]                   │ debg isGlobalLoadingIndicatorVisible
[00:03:12]                   │ debg TestSubjects.exists(globalLoadingIndicator)
[00:03:12]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="globalLoadingIndicator"]') with timeout=1500
[00:03:13]                   │ debg --- retry.tryForTime error: [data-test-subj="globalLoadingIndicator"] is not displayed
[00:03:14]                   │ debg TestSubjects.exists(globalLoadingIndicator-hidden)
[00:03:14]                   │ debg Find.existsByCssSelector('[data-test-subj="globalLoadingIndicator-hidden"]') with timeout=100000
[00:03:14]                   │ debg Waiting for save modal to close
[00:03:14]                   │ debg TestSubjects.exists(savedObjectSaveModal)
[00:03:14]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="savedObjectSaveModal"]') with timeout=2500
[00:03:16]                   │ debg --- retry.tryForTime error: [data-test-subj="savedObjectSaveModal"] is not displayed
[00:03:17]                   │ debg openPdfReportingPanel
[00:03:17]                   │ debg openShareMenuItem title:PDF Reports
[00:03:17]                   │ debg TestSubjects.exists(shareContextMenu)
[00:03:17]                   │ debg Find.existsByDisplayedByCssSelector('[data-test-subj="shareContextMenu"]') with timeout=2500
[00:03:19]                   │ debg --- retry.tryForTime error: [data-test-subj="shareContextMenu"] is not displayed
[00:03:20]                   │ debg TestSubjects.click(shareTopNavButton)
[00:03:20]                   │ debg Find.clickByCssSelector('[data-test-subj="shareTopNavButton"]') with timeout=10000
[00:03:20]                   │ debg Find.findByCssSelector('[data-test-subj="shareTopNavButton"]') with timeout=10000
[00:03:20]                   │ debg Find.findByCssSelector('div.euiContextMenuPanel') with timeout=10000
[00:03:20]                   │ debg TestSubjects.click(sharePanel-PDFReports)
[00:03:20]                   │ debg Find.clickByCssSelector('[data-test-subj="sharePanel-PDFReports"]') with timeout=10000
[00:03:20]                   │ debg Find.findByCssSelector('[data-test-subj="sharePanel-PDFReports"]') with timeout=10000
[00:03:20]                   │ debg Find.waitForElementStale with timeout=10000
[00:03:20]                   │ debg TestSubjects.click(usePrintLayout)
[00:03:20]                   │ debg Find.clickByCssSelector('[data-test-subj="usePrintLayout"]') with timeout=10000
[00:03:20]                   │ debg Find.findByCssSelector('[data-test-subj="usePrintLayout"]') with timeout=10000
[00:03:20]                   │ debg TestSubjects.click(generateReportButton)
[00:03:20]                   │ debg Find.clickByCssSelector('[data-test-subj="generateReportButton"]') with timeout=10000
[00:03:20]                   │ debg Find.findByCssSelector('[data-test-subj="generateReportButton"]') with timeout=10000
[00:03:21]                   │ debg getReportURL
[00:03:21]                   │ debg TestSubjects.getAttribute(downloadCompletedReportButton, href)
[00:03:21]                   │ debg TestSubjects.find(downloadCompletedReportButton)
[00:03:21]                   │ debg Find.findByCssSelector('[data-test-subj="downloadCompletedReportButton"]') with timeout=60000
[00:03:21]                   │ info [o.e.c.m.MetaDataCreateIndexService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] [.reporting-2020.03.29] creating index, cause [api], templates [], shards [1]/[1], mappings [_doc]
[00:03:21]                   │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] updating number_of_replicas to [0] for indices [.reporting-2020.03.29]
[00:03:21]                   │ info [o.e.c.r.a.AllocationService] [kibana-ci-immutable-centos-tests-xl-1585591529310224482] Cluster health status changed from [YELLOW] to [GREEN] (reason: [shards started [[.reporting-2020.03.29][0]]]).
[00:03:21]                   │ proc [kibana]   log   [19:21:40.042] [info][queue-job][reporting] Successfully queued job: k8euz8tf1c3ycf8f91b00mbd
[00:03:23]                   │ proc [kibana]   log   [19:21:42.122] [info][esqueue][queue-worker][reporting] k8euuwp61c3ycf8f915jwmn8 - Job marked as claimed: /.reporting-2020.03.29/k8euz8tf1c3ycf8f91b00mbd
[00:03:23]                   │ proc [kibana]   log   [19:21:42.123] [info][esqueue][queue-worker][reporting] k8euuwp61c3ycf8f915jwmn8 - Starting job
[00:03:23]                   │ proc [kibana]   log   [19:21:42.168] [info][browser-driver][execute][k8euz8tf1c3ycf8f91b00mbd][printable_pdf][reporting] Creating browser page driver
[00:03:23]                   │ proc [kibana]   log   [19:21:42.295] [error][execute][k8euz8tf1c3ycf8f91b00mbd][printable_pdf][reporting] Error: Error spawning Chromium browser: [Error: Protocol error (Target.setDiscoverTargets): Target closed.]
[00:03:23]                   │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-6/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:124:24)
[00:03:23]                   │ proc [kibana]   log   [19:21:42.322] [error][error][esqueue][queue-worker][reporting] k8euuwp61c3ycf8f915jwmn8 - Failure occurred on job k8euz8tf1c3ycf8f91b00mbd: Error: Error spawning Chromium browser: [Error: Protocol error (Target.setDiscoverTargets): Target closed.]
[00:03:23]                   │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-6/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:124:24)
[00:03:23]                   │ proc [kibana]   log   [19:21:42.323] [warning][esqueue][queue-worker][reporting] k8euuwp61c3ycf8f915jwmn8 - Failing job k8euz8tf1c3ycf8f91b00mbd
[00:03:23]                   │ proc [kibana]  error  [19:21:42.341] [warning][process] UnhandledPromiseRejectionWarning: Error: Protocol error (Target.setDiscoverTargets): Target closed.
[00:03:23]                   │ proc [kibana]     at Promise (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Connection.js:74:56)
[00:03:23]                   │ proc [kibana]     at new Promise (<anonymous>)
[00:03:23]                   │ proc [kibana]     at Connection.send (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Connection.js:73:12)
[00:03:23]                   │ proc [kibana]     at Function.create (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Browser.js:34:22)
[00:03:23]                   │ proc [kibana]     at Launcher.launch (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Launcher.js:184:37)
[00:03:23]                   │ proc [kibana]     at module.exports.launch (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Puppeteer.js:37:27)
[00:03:23]                   │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-6/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:108:25)
[00:03:23]                   │ proc [kibana]     at Observable._trySubscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:44:25)
[00:03:23]                   │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:30:22)
[00:03:23]                   │ proc [kibana]     at MergeMapOperator.call (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/operators/mergeMap.js:39:23)
[00:03:23]                   │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:25:31)
[00:03:23]                   │ proc [kibana]     at TakeOperator.call (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/operators/take.js:38:23)
[00:03:23]                   │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:25:31)
[00:03:23]                   │ proc [kibana]     at ThrowIfEmptyOperator.call (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/operators/throwIfEmpty.js:30:23)
[00:03:23]                   │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:25:31)
[00:03:23]                   │ proc [kibana]     at Object.subscribeToResult (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/util/subscribeToResult.js:12:23)
[00:03:23]                   │ proc [kibana]     at emitWarning (internal/process/promises.js:97:15)
[00:03:23]                   │ proc [kibana]     at emitPromiseRejectionWarnings (internal/process/promises.js:143:7)
[00:03:23]                   │ proc [kibana]     at process._tickCallback (internal/process/next_tick.js:69:34)
[00:03:23]                   │ proc [kibana]  error  [19:21:42.343] [warning][process] Error: Protocol error (Target.setDiscoverTargets): Target closed.
[00:03:23]                   │ proc [kibana]     at Promise (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Connection.js:74:56)
[00:03:23]                   │ proc [kibana]     at new Promise (<anonymous>)
[00:03:23]                   │ proc [kibana]     at Connection.send (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Connection.js:73:12)
[00:03:23]                   │ proc [kibana]     at Function.create (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Browser.js:34:22)
[00:03:23]                   │ proc [kibana]     at Launcher.launch (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Launcher.js:184:37)
[00:03:23]                   │ proc [kibana]     at module.exports.launch (/dev/shm/workspace/install/kibana-6/node_modules/puppeteer-core/lib/Puppeteer.js:37:27)
[00:03:23]                   │ proc [kibana]     at Observable.Rx.Observable.create [as _subscribe] (/dev/shm/workspace/install/kibana-6/x-pack/legacy/plugins/reporting/server/browsers/chromium/driver_factory/index.js:108:25)
[00:03:23]                   │ proc [kibana]     at Observable._trySubscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:44:25)
[00:03:23]                   │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:30:22)
[00:03:23]                   │ proc [kibana]     at MergeMapOperator.call (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/operators/mergeMap.js:39:23)
[00:03:23]                   │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:25:31)
[00:03:23]                   │ proc [kibana]     at TakeOperator.call (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/operators/take.js:38:23)
[00:03:23]                   │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:25:31)
[00:03:23]                   │ proc [kibana]     at ThrowIfEmptyOperator.call (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/operators/throwIfEmpty.js:30:23)
[00:03:23]                   │ proc [kibana]     at Observable.subscribe (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/Observable.js:25:31)
[00:03:23]                   │ proc [kibana]     at Object.subscribeToResult (/dev/shm/workspace/install/kibana-6/node_modules/rxjs/internal/util/subscribeToResult.js:12:23)
[00:03:23]                   │ proc [kibana]   log   [19:21:42.354] [info][esqueue][queue-worker][reporting] k8euuwp61c3ycf8f915jwmn8 - Job marked as failed: /.reporting-2020.03.29/k8euz8tf1c3ycf8f91b00mbd
[00:04:22]                   │ debg --- retry.try error: Waiting for element to be located By(css selector, [data-test-subj="downloadCompletedReportButton"])
[00:04:22]                   │      Wait timed out after 61215ms
[00:04:22]                   │ debg TestSubjects.getAttribute(downloadCompletedReportButton, href)
[00:04:22]                   │ debg TestSubjects.find(downloadCompletedReportButton)
[00:04:22]                   │ debg Find.findByCssSelector('[data-test-subj="downloadCompletedReportButton"]') with timeout=60000
[00:05:23]                   │ debg --- retry.try error: Waiting for element to be located By(css selector, [data-test-subj="downloadCompletedReportButton"])
[00:05:23]                   │      Wait timed out after 61137ms
[00:05:24]                   │ info Taking screenshot "/dev/shm/workspace/kibana/x-pack/test/functional/screenshots/failure/reporting app Reporting Dashboard Print Layout downloads a PDF file.png"
[00:05:24]                   │ info Current URL is: http://localhost:6161/app/kibana#/dashboard/667a3fc0-72bb-11ea-8100-2f361124f759?_g=(filters:!(),refreshInterval:(pause:!t,value:0),time:(from:%272015-09-19T06:31:44.000Z%27,to:%272015-09-19T18:01:44.000Z%27))&_a=(description:%27%27,filters:!(),fullScreenMode:!f,options:(hidePanelTitles:!f,useMargins:!t),panels:!((embeddableConfig:(),gridData:(h:15,i:feb538aa-8a49-4067-b93e-5f8033559432,w:24,x:0,y:0),id:Visualization-PieChart,panelIndex:feb538aa-8a49-4067-b93e-5f8033559432,type:visualization,version:%278.0.0-SNAPSHOT%27),(embeddableConfig:(),gridData:(h:15,i:%2742c97cd6-1a60-45f7-b834-a0f7f102d5fb%27,w:24,x:24,y:0),id:Visualization%E2%98%BA-VerticalBarChart,panelIndex:%2742c97cd6-1a60-45f7-b834-a0f7f102d5fb%27,type:visualization,version:%278.0.0-SNAPSHOT%27),(embeddableConfig:(),gridData:(h:15,i:e01a297f-3aac-4e1c-ac41-2c954b6fa04f,w:24,x:0,y:15),id:Visualization%E6%BC%A2%E5%AD%97-AreaChart,panelIndex:e01a297f-3aac-4e1c-ac41-2c954b6fa04f,type:visualization,version:%278.0.0-SNAPSHOT%27),(embeddableConfig:(vis:(params:(sort:(columnIndex:!n,direction:!n)))),gridData:(h:15,i:%27543762fd-3f37-4d46-92c2-c5218b06035b%27,w:24,x:24,y:15),id:Visualization%E2%98%BA%E6%BC%A2%E5%AD%97-DataTable,panelIndex:%27543762fd-3f37-4d46-92c2-c5218b06035b%27,type:visualization,version:%278.0.0-SNAPSHOT%27),(embeddableConfig:(),gridData:(h:15,i:%276f385ac4-0f64-4c87-9b4c-feaed3638c91%27,w:24,x:0,y:30),id:Visualization%E6%BC%A2%E5%AD%97-LineChart,panelIndex:%276f385ac4-0f64-4c87-9b4c-feaed3638c91%27,type:visualization,version:%278.0.0-SNAPSHOT%27),(embeddableConfig:(),gridData:(h:15,i:%2712072e72-11d6-4b6a-a8cd-c51084857d19%27,w:24,x:24,y:30),id:Visualization-MetricChart,panelIndex:%2712072e72-11d6-4b6a-a8cd-c51084857d19%27,type:visualization,version:%278.0.0-SNAPSHOT%27)),query:(language:kuery,query:%27%27),timeRestore:!f,title:%27report%20test%27,viewMode:view)
[00:05:24]                   │ info Saving page source to: /dev/shm/workspace/kibana/x-pack/test/reporting/configs/failure_debug/html/reporting app Reporting Dashboard Print Layout downloads a PDF file.html
[00:05:24]                   └- ✖ fail: "reporting app Reporting Dashboard Print Layout downloads a PDF file"
[00:05:24]                   │

Stack Trace

Error: retry.try timeout: TimeoutError: Waiting for element to be located By(css selector, [data-test-subj="downloadCompletedReportButton"])
Wait timed out after 61137ms
    at /dev/shm/workspace/kibana/node_modules/selenium-webdriver/lib/webdriver.js:841:17
    at process._tickCallback (internal/process/next_tick.js:68:7)
    at onFailure (/dev/shm/workspace/kibana/test/common/services/retry/retry_for_success.ts:28:9)
    at retryForSuccess (/dev/shm/workspace/kibana/test/common/services/retry/retry_for_success.ts:68:13)

and 1 more failures, only showing the first 3.

To update your PR or re-run it, just comment with:
@elasticmachine merge upstream

Revert "Revert "[Reporting/New Platform Migration] Use a new config s…

d585284

…ervice on server-side (elastic#55882)" (elastic#61075)" This reverts commit 427848c.

tsullivan closed this Mar 30, 2020

tsullivan deleted the reporting/np-server-config-2 branch March 30, 2020 18:07

Provide feedback

Saved searches

Use saved searches to filter your results more quickly

Revert "Revert "[Reporting/New Platform Migration] Use a new config s… #61873

Revert "Revert "[Reporting/New Platform Migration] Use a new config s… #61873

tsullivan commented Mar 30, 2020

kibanamachine commented Mar 30, 2020

Standard Out

Stack Trace

Standard Out

Stack Trace

Standard Out

Stack Trace

Revert "Revert "[Reporting/New Platform Migration] Use a new config s… #61873

Revert "Revert "[Reporting/New Platform Migration] Use a new config s… #61873

Conversation

tsullivan commented Mar 30, 2020

Summary

Checklist

For maintainers

kibanamachine commented Mar 30, 2020

💔 Build Failed

Failed CI Steps

Test Failures

Standard Out

Stack Trace

Standard Out

Stack Trace

Standard Out

Stack Trace