search

opendevstack / ods-document-generation-svc

Document Generation Service used by the jenkins shared library to generate compliance documentes
Apache License 2.0
0 stars 3 forks source link

Github template store does NOT work in a corp proxy environment #40

Closed segator closed 3 years ago

segator commented 4 years ago

when running ods-quickstarter tests, docgen jenkinsfile is executed and tests seems fails. this is the output log

OpenShift Build unitt-cd/run-unitt-docgen-unitt-3x-2 from https://bitbucket/scm/unitt/unitt-docgen.git
Started by user aymerich
Replayed #1-92bf9719
Checking out git https://bitbucket/scm/unitt/unitt-docgen.git into /var/lib/jenkins/jobs/unitt-cd/jobs/unitt-cd-run-unitt-docgen-unitt-3x/workspace@script to read Jenkinsfile
using credential unitt-cd-cd-user-with-password
 > git rev-parse --is-inside-work-tree # timeout=10
Fetching changes from the remote Git repository
 > git config remote.origin.url https://bitbucket/scm/unitt/unitt-docgen.git # timeout=10
Fetching upstream changes from https://bitbucket/scm/unitt/unitt-docgen.git
 > git --version # timeout=10
using GIT_ASKPASS to set credentials unitt-cd-cd-user-with-password
Setting http proxy: http://proxy
 > git fetch --tags --progress https://bitbucket/scm/unitt/unitt-docgen.git +refs/heads/*:refs/remotes/origin/* # timeout=10
 > git rev-parse origin/3.x^{commit} # timeout=10
Checking out Revision 92bf9719067e84e286b8e26284c18b125c15536a (origin/3.x)
 > git config core.sparsecheckout # timeout=10
 > git checkout -f 92bf9719067e84e286b8e26284c18b125c15536a # timeout=10
Commit message: "Merge pull request #38 from BIX-Digital/feature/finalize-release"
 > git rev-list --no-walk 92bf9719067e84e286b8e26284c18b125c15536a # timeout=10
Running in Durability level: MAX_SURVIVABILITY
[Pipeline] Start of Pipeline
[Pipeline] node
Running on Jenkins in /var/lib/jenkins/jobs/unitt-cd/jobs/unitt-cd-run-unitt-docgen-unitt-3x/workspace
[Pipeline] {
[Pipeline] }
[Pipeline] // node
[Pipeline] library
Loading library ods-jenkins-shared-library@3.x
Attempting to resolve 3.x from remote references...
 > git --version # timeout=10
using GIT_ASKPASS to set credentials unitt-cd-cd-user-with-password
Setting http proxy: proxy
 > git ls-remote -h https://bitbucket/scm/opendevstack/ods-jenkins-shared-library.git # timeout=10
Found match: refs/heads/3.x revision d05d650627a1af84a88fb90481bd995cd0ed72e2
using credential unitt-cd-cd-user-with-password
 > git rev-parse --is-inside-work-tree # timeout=10
Fetching changes from the remote Git repository
 > git config remote.origin.url https://bitbucket/scm/opendevstack/ods-jenkins-shared-library.git # timeout=10
Fetching without tags
Fetching upstream changes from https://bitbucket/scm/opendevstack/ods-jenkins-shared-library.git
 > git --version # timeout=10
using GIT_ASKPASS to set credentials unitt-cd-cd-user-with-password
Setting http proxy: proxy
 > git fetch --no-tags --progress https://bitbucket/scm/opendevstack/ods-jenkins-shared-library.git +refs/heads/*:refs/remotes/origin/* # timeout=10
Checking out Revision d05d650627a1af84a88fb90481bd995cd0ed72e2 (3.x)
 > git config core.sparsecheckout # timeout=10
 > git checkout -f d05d650627a1af84a88fb90481bd995cd0ed72e2 # timeout=10
Commit message: "Merge pull request #438 from tobnee/bug/fix-snyk-branch-matching"
 > git rev-list --no-walk d05d650627a1af84a88fb90481bd995cd0ed72e2 # timeout=10
[Pipeline] echo
DEBUG: -> ODS Component pipeline setup, debug mode? true
[Pipeline] echo
DEBUG: Amending project / component name based on Git origin URL
[Pipeline] node
Running on Jenkins in /var/lib/jenkins/jobs/unitt-cd/jobs/unitt-cd-run-unitt-docgen-unitt-3x/workspace
[Pipeline] {
[Pipeline] sh (Get Git URL of remote 'origin')
+ git config --get remote.origin.url
[Pipeline] echo
DEBUG: Retrieved Git origin URL from filesystem: https://bitbucket/scm/unitt/unitt-docgen.git
[Pipeline] echo
DEBUG: Project- / component-name config: unitt / docgen
[Pipeline] }
[Pipeline] // node
[Pipeline] echo
[docgen] ***** Starting ODS Component Pipeline *****
[Pipeline] echo
***** Continuing on node 'master' *****
[Pipeline] node
Running on Jenkins in /var/lib/jenkins/jobs/unitt-cd/jobs/unitt-cd-run-unitt-docgen-unitt-3x/workspace
[Pipeline] {
[Pipeline] wrap
[Pipeline] {
[Pipeline] checkout
using credential unitt-cd-cd-user-with-password
 > git rev-parse --is-inside-work-tree # timeout=10
Fetching changes from the remote Git repository
 > git config remote.origin.url https://bitbucket/scm/unitt/unitt-docgen.git # timeout=10
Fetching upstream changes from https://bitbucket/scm/unitt/unitt-docgen.git
 > git --version # timeout=10
using GIT_ASKPASS to set credentials unitt-cd-cd-user-with-password
Setting http proxy: proxy
 > git fetch --tags --progress https://bitbucket/scm/unitt/unitt-docgen.git +refs/heads/*:refs/remotes/origin/* # timeout=10
 > git rev-parse origin/3.x^{commit} # timeout=10
Checking out Revision 92bf9719067e84e286b8e26284c18b125c15536a (origin/3.x)
 > git config core.sparsecheckout # timeout=10
 > git checkout -f 92bf9719067e84e286b8e26284c18b125c15536a # timeout=10
Commit message: "Merge pull request #38 from BIX-Digital/feature/finalize-release"
[Pipeline] stage
[Pipeline] { (odsPipeline start)
[Pipeline] echo
DEBUG: Validating input ...
[Pipeline] echo
DEBUG: Collecting environment variables ...
[Pipeline] sh (getting extension environment labels)
+ env
+ grep ods.build.
+ true
[Pipeline] echo
DEBUG: Got external build labels: [:]
[Pipeline] sh (getting ODS shared lib version)
+ env
+ grep library.ods-jenkins-shared-library.version
+ cut -d= -f2
[Pipeline] echo
DEBUG: Validating environment variables ...
[Pipeline] echo
DEBUG: Deriving configuration from input ...
[Pipeline] echo
DEBUG: Setting defaults ...
[Pipeline] echo
DEBUG: Retrieving Git information ...
[Pipeline] sh (getting GIT url)
+ git config --get remote.origin.url
[Pipeline] sh (getting GIT branch to build)
+ oc get bc/run-unitt-docgen-unitt-3x -n unitt-cd -o 'jsonpath={.spec.source.git.ref}'
[Pipeline] echo
DEBUG: resolved branch 3.x
[Pipeline] sh (getting GIT commit)
+ git rev-parse HEAD
[Pipeline] sh (getting GIT commit author)
+ git --no-pager show -s '--format=%an (%ae)' HEAD
[Pipeline] sh (getting GIT commit message)
+ git log -1 --pretty=%B HEAD
[Pipeline] sh (getting GIT commit date/time)
+ git show -s --format=%ci HEAD
[Pipeline] echo
DEBUG: Setting target OCP environment ...
[Pipeline] sh (check if OCP environment test exists)
+ oc project test
[Pipeline] echo
DEBUG: Target env: test, clone src: null
[Pipeline] echo
DEBUG: Assembled configuration: [testResults:, podServiceAccount:jenkins, imagePromotionSequences:[dev->test, test->prod], groupId:org.opendevstack.unitt, branchToEnvironmentMapping:[*:dev, 3.x:test], globalExtensionImageLabels:[:], dockerDir:docker, buildNumber:2, odsSharedLibVersion:3.x, resourceRequestCpu:100m, buildUrl:https://jenkins-unitt-cd.inh-odsapps.base.domain.com/job/unitt-cd/job/unitt-cd-run-unitt-docgen-unitt-3x/2/, nexusUsername:****, jobName:unitt-cd/unitt-cd-run-unitt-docgen-unitt-3x, image:docker-registry.default.svc:5000/ods/jenkins-agent-maven:3.0.0, buildTime:2020-08-31T08:32:46+0000, openshiftBuildTimeout:15, targetProject:unitt-test, bitbucketUrl:https://bitbucket, cloneProjectScriptBranch:master, gitCommitTime:2020-08-11 17:12:05 +0200, resourceLimitCpu:1, environmentLimit:5, alwaysPullImage:true, podVolumes:[], failOnSnykScanVulnerabilities:true, projectId:unitt, tagversion:2-92bf9719, componentId:docgen, openshiftRolloutTimeout:5, sonarQubeEdition:community, openshiftHost:https://openshift.default.svc.cluster.local, credentialsId:unitt-cd-cd-user-with-password, odsBitbucketProject:opendevstack, openshiftProjectId:unitt-cd, gitBranch:3.x, debug:true, autoCloneEnvironmentsFromSourceMapping:[:], resourceRequestMemory:1Gi, repoName:unitt-docgen, resourceLimitMemory:2Gi, imageStreamTag:ods/jenkins-agent-maven:3.0.0, nexusUrl:https://nexus-ods.inh-odsapps.base.domain.com, environment:test, nexusPassword:****, gitCommit:92bf9719067e84e286b8e26284c18b125c15536a, cloneSourceEnv:null, buildTag:jenkins-unitt-cd-unitt-cd-run-unitt-docgen-unitt-3x-2, podLabel:pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f, gitCommitAuthor:renedupont (39172761+renedupont@users.noreply.github.com), gitCommitMessage:Merge pull request #38 from BIX-Digital/feature/finalize-release

set date and version in changelog, gitUrl:https://bitbucket/scm/unitt/unitt-docgen.git]
[Pipeline] echo
DEBUG: -> Registering & loading global services
[Pipeline] echo
DEBUG: Registering GitService
[Pipeline] echo
DEBUG: Registering BitbucketService
[Pipeline] echo
DEBUG: Registering OpenShiftService
[Pipeline] echo
DEBUG: Registering JenkinsService
[Pipeline] echo
DEBUG: Registering NexusService
[Pipeline] }
[Pipeline] // stage
[Pipeline] sh (check skip CI?)
+ git show --pretty=%s%b -s
[Pipeline] }
[Pipeline] // wrap
[Pipeline] }
[Pipeline] // node
[Pipeline] echo
***** Continuing on node 'pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f' based on image 'docker-registry.default.svc:5000/ods/jenkins-agent-maven:3.0.0' *****
[Pipeline] podTemplate
[Pipeline] {
[Pipeline] node
Still waiting to schedule task
‘Jenkins’ doesn’t have label ‘pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f’
Created Pod: unitt-cd/pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602
[Normal][unitt-cd/pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602][Scheduled] Successfully assigned unitt-cd/pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602 to inhas71256.base.domain.com
[Normal][unitt-cd/pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602][Pulling] pulling image "docker-registry.default.svc:5000/ods/jenkins-agent-maven:3.0.0"
[Normal][unitt-cd/pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602][Pulled] Successfully pulled image "docker-registry.default.svc:5000/ods/jenkins-agent-maven:3.0.0"
[Normal][unitt-cd/pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602][Created] Created container
[Normal][unitt-cd/pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602][Started] Started container
Agent pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602 is provisioned from template pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz
---
apiVersion: "v1"
kind: "Pod"
metadata:
  annotations:
    buildUrl: "http://jenkins.unitt-cd.svc:80/job/unitt-cd/job/unitt-cd-run-unitt-docgen-unitt-3x/2/"
    runUrl: "job/unitt-cd/job/unitt-cd-run-unitt-docgen-unitt-3x/2/"
  labels:
    jenkins: "slave"
    jenkins/label: "pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f"
  name: "pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602"
spec:
  containers:
  - args:
    - "********"
    - "pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602"
    env:
    - name: "JENKINS_SECRET"
      value: "********"
    - name: "JENKINS_TUNNEL"
      value: "jenkins-jnlp.unitt-cd.svc:50000"
    - name: "JENKINS_AGENT_NAME"
      value: "pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602"
    - name: "JENKINS_NAME"
      value: "pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602"
    - name: "JENKINS_AGENT_WORKDIR"
      value: "/tmp"
    - name: "JENKINS_URL"
      value: "http://jenkins.unitt-cd.svc:80/"
    image: "docker-registry.default.svc:5000/ods/jenkins-agent-maven:3.0.0"
    imagePullPolicy: "Always"
    name: "jnlp"
    resources:
      limits:
        memory: "2Gi"
        cpu: "1"
      requests:
        memory: "1Gi"
        cpu: "100m"
    securityContext:
      privileged: false
    tty: false
    volumeMounts:
    - mountPath: "/tmp"
      name: "workspace-volume"
      readOnly: false
    workingDir: "/tmp"
  nodeSelector:
    beta.kubernetes.io/os: "linux"
  restartPolicy: "Never"
  securityContext: {}
  serviceAccount: "jenkins"
  volumes:
  - emptyDir:
      medium: ""
    name: "workspace-volume"

Running on pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f-2q8wz-c1602 in /tmp/workspace/unitt-cd/unitt-cd-run-unitt-docgen-unitt-3x
[Pipeline] {
[Pipeline] echo
DEBUG: [pod-fd4e631e-b793-46fa-8ea0-ddd31ff5720f]  (took 58354 ms)
[Pipeline] echo
DEBUG: [buildstatus-92bf9719-INPROGRESS] Setting Bitbucket build status to 'INPROGRESS' on commit '92bf9719067e84e286b8e26284c18b125c15536a' / 'https://jenkins-unitt-cd.inh-odsapps.base.domain.com/job/unitt-cd/job/unitt-cd-run-unitt-docgen-unitt-3x/2/'
[Pipeline] withCredentials
Masking supported pattern matches of $USERNAME or $TOKEN
[Pipeline] {
[Pipeline] }
[Pipeline] // withCredentials
[Pipeline] echo
DEBUG: Secret cd-user-bitbucket-token exists and is synced.
[Pipeline] withCredentials
Masking supported pattern matches of $USERNAME or $TOKEN
[Pipeline] {
[Pipeline] sh (Set bitbucket build status via API)
+ curl --fail --silent --request POST --header 'Authorization: Bearer ****' --header 'Content-Type: application/json' --data '{"state":"INPROGRESS","key":"92bf9719","name":"92bf9719","url":"https://jenkins-unitt-cd.inh-odsapps.base.domain.com/job/unitt-cd/job/unitt-cd-run-unitt-docgen-unitt-3x/2/"}' https://bitbucket/rest/build-status/1.0/commits/92bf9719067e84e286b8e26284c18b125c15536a
[Pipeline] }
[Pipeline] // withCredentials
[Pipeline] echo
DEBUG: [buildstatus-92bf9719-INPROGRESS]  (took 6053 ms)
[Pipeline] wrap
[Pipeline] {
[Pipeline] sh (Check if Git LFS is enabled)
+ git lfs
[Pipeline] checkout
using credential unitt-cd-cd-user-with-password
Cloning the remote Git repository
Cloning repository https://bitbucket/scm/unitt/unitt-docgen.git
 > git init /tmp/workspace/unitt-cd/unitt-cd-run-unitt-docgen-unitt-3x # timeout=10
Fetching upstream changes from https://bitbucket/scm/unitt/unitt-docgen.git
 > git --version # timeout=10
using GIT_ASKPASS to set credentials unitt-cd-cd-user-with-password
Setting http proxy: proxy
 > git fetch --tags --progress https://bitbucket/scm/unitt/unitt-docgen.git +refs/heads/*:refs/remotes/origin/* # timeout=10
 > git config remote.origin.url https://bitbucket/scm/unitt/unitt-docgen.git # timeout=10
 > git config --add remote.origin.fetch +refs/heads/*:refs/remotes/origin/* # timeout=10
 > git config remote.origin.url https://bitbucket/scm/unitt/unitt-docgen.git # timeout=10
Fetching upstream changes from https://bitbucket/scm/unitt/unitt-docgen.git
using GIT_ASKPASS to set credentials unitt-cd-cd-user-with-password
Setting http proxy: proxy
 > git fetch --tags --progress https://bitbucket/scm/unitt/unitt-docgen.git +refs/heads/*:refs/remotes/origin/* # timeout=10
Checking out Revision 92bf9719067e84e286b8e26284c18b125c15536a (detached)
Enabling Git LFS pull
 > git rev-parse 92bf9719067e84e286b8e26284c18b125c15536a^{commit} # timeout=10
 > git config core.sparsecheckout # timeout=10
 > git checkout -f 92bf9719067e84e286b8e26284c18b125c15536a # timeout=10
 > git config --get remote.origin.url # timeout=10
using GIT_ASKPASS to set credentials unitt-cd-cd-user-with-password
Setting http proxy: proxy
 > git lfs pull origin # timeout=10
Commit message: "Merge pull request #38 from BIX-Digital/feature/finalize-release"
[Pipeline] stage
[Pipeline] { (Build and Unit Test)
[Pipeline] withEnv
[Pipeline] {
[Pipeline] sh (get and install wkhtml)
+ curl -kLO https://github.com/wkhtmltopdf/wkhtmltopdf/releases/download/0.12.4/wkhtmltox-0.12.4_linux-generic-amd64.tar.xz
  % Total    % Received % Xferd  Average Speed   Time    Time     Time  Current
                                 Dload  Upload   Total   Spent    Left  Speed

  0     0    0     0    0     0      0      0 --:--:-- --:--:-- --:--:--     0
100   663  100   663    0     0   2323      0 --:--:-- --:--:-- --:--:--  2326
  0     0    0     0    0     0      0      0 --:--:-- --:--:-- --:--:--     0
  0 13.8M    0  101k    0     0  74363      0  0:03:15  0:00:01  0:03:14  109k
  2 13.8M    2  322k    0     0   135k      0  0:01:45  0:00:02  0:01:43  168k
  4 13.8M    4  627k    0     0   186k      0  0:01:16  0:00:03  0:01:13  216k
  7 13.8M    7 1002k    0     0   230k      0  0:01:01  0:00:04  0:00:57  258k
 10 13.8M   10 1495k    0     0   279k      0  0:00:50  0:00:05  0:00:45  306k
 14 13.8M   14 2106k    0     0   328k      0  0:00:43  0:00:06  0:00:37  399k
 19 13.8M   19 2753k    0     0   372k      0  0:00:38  0:00:07  0:00:31  485k
 26 13.8M   26 3704k    0     0   441k      0  0:00:32  0:00:08  0:00:24  613k
 36 13.8M   36 5200k    0     0   554k      0  0:00:25  0:00:09  0:00:16  836k
 52 13.8M   52 7478k    0     0   721k      0  0:00:19  0:00:10  0:00:09 1192k
 75 13.8M   75 10.5M    0     0   948k      0  0:00:14  0:00:11  0:00:03 1752k
100 13.8M  100 13.8M    0     0  1176k      0  0:00:12  0:00:12 --:--:-- 2449k
+ tar vxf wkhtmltox-0.12.4_linux-generic-amd64.tar.xz
wkhtmltox/
wkhtmltox/lib/
wkhtmltox/lib/libwkhtmltox.so.0.12.4
wkhtmltox/lib/libwkhtmltox.so.0
wkhtmltox/lib/libwkhtmltox.so.0.12
wkhtmltox/lib/libwkhtmltox.so
wkhtmltox/include/
wkhtmltox/include/wkhtmltox/
wkhtmltox/include/wkhtmltox/image.h
wkhtmltox/include/wkhtmltox/dllbegin.inc
wkhtmltox/include/wkhtmltox/pdf.h
wkhtmltox/include/wkhtmltox/dllend.inc
wkhtmltox/bin/
wkhtmltox/bin/wkhtmltoimage
wkhtmltox/bin/wkhtmltopdf
wkhtmltox/share/
wkhtmltox/share/man/
wkhtmltox/share/man/man1/
wkhtmltox/share/man/man1/wkhtmltopdf.1.gz
wkhtmltox/share/man/man1/wkhtmltoimage.1.gz
+ mv wkhtmltox/bin/wkhtmltoimage wkhtmltox/bin/wkhtmltopdf /usr/bin
[Pipeline] sh (gradle build)
+ ./gradlew clean test shadowJar --stacktrace --no-daemon
Picked up JAVA_TOOL_OPTIONS: -XX:+UnlockExperimentalVMOptions -Dsun.zip.disableMemoryMapping=true
Downloading https://services.gradle.org/distributions/gradle-5.4.1-bin.zip
...................................................................................
Welcome to Gradle 5.4.1!

Here are the highlights of this release:
 - Run builds with JDK12
 - New API for Incremental Tasks
 - Updates to native projects, including Swift 5 support

For more details see https://docs.gradle.org/5.4.1/release-notes.html

WARNING: An illegal reflective access operation has occurred
WARNING: Illegal reflective access by org.codehaus.groovy.vmplugin.v7.Java7$1 (file:/home/jenkins/.gradle/wrapper/dists/gradle-5.4.1-bin/e75iq110yv9r9wt1a6619x2xm/gradle-5.4.1/lib/groovy-all-1.0-2.5.4.jar) to constructor java.lang.invoke.MethodHandles$Lookup(java.lang.Class,int)
WARNING: Please consider reporting this to the maintainers of org.codehaus.groovy.vmplugin.v7.Java7$1
WARNING: Use --illegal-access=warn to enable warnings of further illegal reflective access operations
WARNING: All illegal access operations will be denied in a future release
> Configure project :
using nexus repositories
using nexus repositories
> Task :clean UP-TO-DATE
> Task :compileJava NO-SOURCE

> Task :compileGroovy
Picked up JAVA_TOOL_OPTIONS: -XX:+UnlockExperimentalVMOptions -Dsun.zip.disableMemoryMapping=true
> Task :processResources
> Task :classes
> Task :compileTestJava NO-SOURCE
> Task :compileTestGroovy
Errors occurred while build effective model from /home/jenkins/.gradle/caches/modules-2/files-2.1/com.sun.xml.bind/jaxb-osgi/2.2.10/c926a537af564ec047ec6308df1d0d2a03364a86/jaxb-osgi-2.2.10.pom:
    'dependencyManagement.dependencies.dependency.systemPath' for com.sun:tools:jar must specify an absolute path but is ${tools.jar} in com.sun.xml.bind:jaxb-osgi:2.2.10
> Task :processTestResources
> Task :testClasses
> Task :test
Picked up JAVA_TOOL_OPTIONS: -XX:+UnlockExperimentalVMOptions -Dsun.zip.disableMemoryMapping=true
WARNING: An illegal reflective access operation has occurred
WARNING: Illegal reflective access by org.codehaus.groovy.vmplugin.v7.Java7$1 (file:/home/jenkins/.gradle/caches/modules-2/files-2.1/org.codehaus.groovy/groovy/2.5.7/99907efe4b69f800c42584386f5d668e4d952bd5/groovy-2.5.7.jar) to constructor java.lang.invoke.MethodHandles$Lookup(java.lang.Class,int)
WARNING: Please consider reporting this to the maintainers of org.codehaus.groovy.vmplugin.v7.Java7$1
WARNING: Use --illegal-access=warn to enable warnings of further illegal reflective access operations
WARNING: All illegal access operations will be denied in a future release
app.SpecHelper STANDARD_OUT
    [2020-08-31 08:35:47,217]-[Test worker] INFO  app.App - [test@netty]: Server started in 4013ms

      POST /document    [application/json]     [application/json]    (/anonymous)
      GET  /health                   [*/*]     [application/json]    (/anonymous)

    listening on:
      http://localhost:9000/

    [2020-08-31 08:35:47,232]-[Test worker] INFO  app.App - Stopped

app.AppSpec STANDARD_OUT
    [2020-08-31 08:35:47,628]-[Test worker] INFO  app.App - [test@netty]: Server started in 313ms

      POST /document    [application/json]     [application/json]    (/anonymous)
      GET  /health                   [*/*]     [application/json]    (/anonymous)

    listening on:
      http://localhost:9000/

app.AppSpec > POST /document STANDARD_OUT
    [2020-08-31 08:35:48,923]-[Test worker] INFO  org.eclipse.jetty.util.log - Logging initialized @11889ms
    [2020-08-31 08:35:49,012]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@66ea8e71{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:49,238]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:49,321]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@1e5d144c{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:49,322]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@124e0ec6{/,null,AVAILABLE}
    [2020-08-31 08:35:49,339]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@66ea8e71{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:49,340]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @12306ms
    Using templates @http://localhost:9001/rest/api/latest/projects/myProject/repos/myRepo/archive?at=refs%2Fheads%2Frelease%2Fv1.0&format=zip
    [2020-08-31 08:35:53,129]-[qtp1004405545-26] INFO  / - RequestHandlerClass from context returned com.github.tomakehurst.wiremock.http.StubRequestHandler. Normalized mapped under returned 'null'
    [INFO]: executing cmd: [wkhtmltopdf, --encoding, UTF-8, --no-outline, --print-media-type, -T, 40, -R, 25, -B, 25, -L, 25, --header-center, h
    e, --header-font-size, 10, --header-spacing, 10, --footer-center, Page [page] of [topage], --footer-font-size, 10, /tmp/InstallationReport-v1.011815835379931110269/templates/InstallationReport.html, /tmp/document13612127932597480319.pdf]
    [2020-08-31 08:35:57,018]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@66ea8e71{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:57,021]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@124e0ec6{/,null,UNAVAILABLE}
    [2020-08-31 08:35:57,021]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@1e5d144c{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:35:57,022]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1004405545{STOPPING,8<=8<=10,i=8,q=8} Couldn't stop Thread[qtp1004405545-28,5,main]
    [2020-08-31 08:35:57,023]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1004405545{STOPPING,8<=8<=10,i=8,q=8} Couldn't stop Thread[qtp1004405545-26,5,main]
    [2020-08-31 08:35:57,023]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1004405545{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1004405545-25,5,main]
    [2020-08-31 08:35:57,023]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1004405545{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1004405545-23,5,main]
    [2020-08-31 08:35:57,023]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1004405545{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1004405545-27,5,main]
    [2020-08-31 08:35:57,024]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1004405545{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1004405545-24,5,main]
    [2020-08-31 08:35:57,024]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1004405545{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1004405545-22,5,main]

app.AppSpec > POST /document without parameter 'metadata.type' STANDARD_OUT
    [2020-08-31 08:35:57,034]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@2e7bf42{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:57,102]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:57,114]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@372f7b18{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:57,115]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@2f47c2a6{/,null,AVAILABLE}
    [2020-08-31 08:35:57,115]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@2e7bf42{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:57,116]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @20082ms
    [2020-08-31 08:35:57,223]-[netty task-7-2] ERROR org.jooby.Err - execution of: POST/document resulted in exception
    Route:
          | Method | Path      | Source     | Name       | Pattern   | Consumes           | Produces           |
          |--------|-----------|------------|------------|-----------|--------------------|--------------------|
          | POST   | /document | app.App:22 | /anonymous | /document | [application/json] | [application/json] |

    Stacktrace:
    org.jooby.Err: Bad Request(400)
        at org.jooby.internal.HttpHandlerImpl.handleErr(HttpHandlerImpl.java:589)
        at org.jooby.internal.HttpHandlerImpl.cleanup(HttpHandlerImpl.java:562)
        at org.jooby.internal.HttpHandlerImpl.handle(HttpHandlerImpl.java:504)
        at org.jooby.internal.netty.NettyHandler.channelRead0(NettyHandler.java:274)
        at io.netty.channel.SimpleChannelInboundHandler.channelRead(SimpleChannelInboundHandler.java:99)
        at io.netty.channel.AbstractChannelHandlerContext.invokeChannelRead(AbstractChannelHandlerContext.java:374)
        at io.netty.channel.AbstractChannelHandlerContext.access$600(AbstractChannelHandlerContext.java:56)
        at io.netty.channel.AbstractChannelHandlerContext$7.run(AbstractChannelHandlerContext.java:365)
        at io.netty.util.concurrent.DefaultEventExecutor.run(DefaultEventExecutor.java:66)
        at io.netty.util.concurrent.SingleThreadEventExecutor$6.run(SingleThreadEventExecutor.java:1050)
        at io.netty.util.internal.ThreadExecutorMap$2.run(ThreadExecutorMap.java:74)
        at io.netty.util.concurrent.FastThreadLocalRunnable.run(FastThreadLocalRunnable.java:30)
        at java.base/java.lang.Thread.run(Thread.java:834)
    Caused by: java.lang.IllegalArgumentException: missing argument 'metadata.type'
        at java.base/jdk.internal.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
        at java.base/jdk.internal.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:45)
        at java.base/java.lang.reflect.Constructor.newInstance(Constructor.java:490)
        at org.codehaus.groovy.reflection.CachedConstructor.invoke(CachedConstructor.java:80)
        at org.codehaus.groovy.runtime.callsite.ConstructorSite$ConstructorSiteNoUnwrapNoCoerce.callConstructor(ConstructorSite.java:105)
        at org.codehaus.groovy.runtime.callsite.CallSiteArray.defaultCallConstructor(CallSiteArray.java:59)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callConstructor(AbstractCallSite.java:237)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callConstructor(AbstractCallSite.java:249)
        at app.App.validateRequestParams(App.groovy:79)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at org.codehaus.groovy.runtime.callsite.StaticMetaMethodSite$StaticMetaMethodSiteNoUnwrapNoCoerce.invoke(StaticMetaMethodSite.java:149)
        at org.codehaus.groovy.runtime.callsite.StaticMetaMethodSite.callStatic(StaticMetaMethodSite.java:100)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callStatic(AbstractCallSite.java:208)
        at app.App$_closure1.doCall(App.groovy:24)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at groovy.lang.MetaMethod.doMethodInvoke(MetaMethod.java:323)
        at org.codehaus.groovy.runtime.metaclass.ClosureMetaClass.invokeMethod(ClosureMetaClass.java:263)
        at groovy.lang.MetaClassImpl.invokeMethod(MetaClassImpl.java:1041)
        at org.codehaus.groovy.runtime.callsite.PogoMetaClassSite.call(PogoMetaClassSite.java:37)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.call(AbstractCallSite.java:135)
        at org.jooby.JoobyExtension$_toHandler_closure3.doCall(JoobyExtension.groovy:17)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at groovy.lang.MetaMethod.doMethodInvoke(MetaMethod.java:323)
        at org.codehaus.groovy.runtime.metaclass.ClosureMetaClass.invokeMethod(ClosureMetaClass.java:263)
        at groovy.lang.MetaClassImpl.invokeMethod(MetaClassImpl.java:1041)
        at groovy.lang.Closure.call(Closure.java:405)
        at org.codehaus.groovy.runtime.ConvertedClosure.invokeCustom(ConvertedClosure.java:50)
        at org.codehaus.groovy.runtime.ConversionHandler.invoke(ConversionHandler.java:122)
        at com.sun.proxy.$Proxy23.handle(Unknown Source)
        at org.jooby.Route$Handler.handle(Route.java:1760)
        at java.base/java.lang.invoke.MethodHandle.invokeWithArguments(MethodHandle.java:710)
        at org.codehaus.groovy.vmplugin.v7.Java7.invokeHandle(Java7.java:106)
        at org.codehaus.groovy.runtime.ConversionHandler.invoke(ConversionHandler.java:110)
        at com.sun.proxy.$Proxy23.handle(Unknown Source)
        at org.jooby.internal.RouteImpl.handle(RouteImpl.java:280)
        at org.jooby.internal.RouteChain.next(RouteChain.java:262)
        at org.jooby.Route$Chain.next(Route.java:2163)
        at org.jooby.internal.HttpHandlerImpl.handle(HttpHandlerImpl.java:496)
        ... 10 common frames omitted
    [2020-08-31 08:35:57,309]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@2e7bf42{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:57,309]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@2f47c2a6{/,null,UNAVAILABLE}
    [2020-08-31 08:35:57,310]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@372f7b18{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:35:57,310]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1523739662{STOPPING,8<=8<=10,i=6,q=8} Couldn't stop Thread[qtp1523739662-81,5,main]
    [2020-08-31 08:35:57,310]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1523739662{STOPPING,8<=8<=10,i=5,q=7} Couldn't stop Thread[qtp1523739662-79,5,main]
    [2020-08-31 08:35:57,310]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1523739662{STOPPING,8<=8<=10,i=4,q=7} Couldn't stop Thread[qtp1523739662-80,5,]
    [2020-08-31 08:35:57,310]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1523739662{STOPPING,8<=8<=10,i=1,q=6} Couldn't stop Thread[qtp1523739662-77,5,main]
    [2020-08-31 08:35:57,311]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1523739662{STOPPING,8<=8<=10,i=0,q=5} Couldn't stop Thread[qtp1523739662-78-selector-ServerConnectorManager@207dbfb4/1,5,main]

app.AppSpec > POST /document without parameter 'metadata.version' STANDARD_OUT
    [2020-08-31 08:35:57,316]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@28cda87a{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:57,317]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:57,320]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@7654522e{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:57,320]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@776104d2{/,null,AVAILABLE}
    [2020-08-31 08:35:57,321]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@28cda87a{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:57,321]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @20288ms
    [2020-08-31 08:35:57,429]-[netty task-7-3] ERROR org.jooby.Err - execution of: POST/document resulted in exception
    Route:
          | Method | Path      | Source     | Name       | Pattern   | Consumes           | Produces           |
          |--------|-----------|------------|------------|-----------|--------------------|--------------------|
          | POST   | /document | app.App:22 | /anonymous | /document | [application/json] | [application/json] |

    Stacktrace:
    org.jooby.Err: Bad Request(400)
        at org.jooby.internal.HttpHandlerImpl.handleErr(HttpHandlerImpl.java:589)
        at org.jooby.internal.HttpHandlerImpl.cleanup(HttpHandlerImpl.java:562)
        at org.jooby.internal.HttpHandlerImpl.handle(HttpHandlerImpl.java:504)
        at org.jooby.internal.netty.NettyHandler.channelRead0(NettyHandler.java:274)
        at io.netty.channel.SimpleChannelInboundHandler.channelRead(SimpleChannelInboundHandler.java:99)
        at io.netty.channel.AbstractChannelHandlerContext.invokeChannelRead(AbstractChannelHandlerContext.java:374)
        at io.netty.channel.AbstractChannelHandlerContext.access$600(AbstractChannelHandlerContext.java:56)
        at io.netty.channel.AbstractChannelHandlerContext$7.run(AbstractChannelHandlerContext.java:365)
        at io.netty.util.concurrent.DefaultEventExecutor.run(DefaultEventExecutor.java:66)
        at io.netty.util.concurrent.SingleThreadEventExecutor$6.run(SingleThreadEventExecutor.java:1050)
        at io.netty.util.internal.ThreadExecutorMap$2.run(ThreadExecutorMap.java:74)
        at io.netty.util.concurrent.FastThreadLocalRunnable.run(FastThreadLocalRunnable.java:30)
        at java.base/java.lang.Thread.run(Thread.java:834)
    Caused by: java.lang.IllegalArgumentException: missing argument 'metadata.version'
        at java.base/jdk.internal.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
        at java.base/jdk.internal.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:45)
        at java.base/java.lang.reflect.Constructor.newInstance(Constructor.java:490)
        at org.codehaus.groovy.reflection.CachedConstructor.invoke(CachedConstructor.java:80)
        at org.codehaus.groovy.runtime.callsite.ConstructorSite$ConstructorSiteNoUnwrapNoCoerce.callConstructor(ConstructorSite.java:105)
        at org.codehaus.groovy.runtime.callsite.CallSiteArray.defaultCallConstructor(CallSiteArray.java:59)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callConstructor(AbstractCallSite.java:237)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callConstructor(AbstractCallSite.java:249)
        at app.App.validateRequestParams(App.groovy:83)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at org.codehaus.groovy.runtime.callsite.StaticMetaMethodSite$StaticMetaMethodSiteNoUnwrapNoCoerce.invoke(StaticMetaMethodSite.java:149)
        at org.codehaus.groovy.runtime.callsite.StaticMetaMethodSite.callStatic(StaticMetaMethodSite.java:100)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callStatic(AbstractCallSite.java:208)
        at app.App$_closure1.doCall(App.groovy:24)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at groovy.lang.MetaMethod.doMethodInvoke(MetaMethod.java:323)
        at org.codehaus.groovy.runtime.metaclass.ClosureMetaClass.invokeMethod(ClosureMetaClass.java:263)
        at groovy.lang.MetaClassImpl.invokeMethod(MetaClassImpl.java:1041)
        at org.codehaus.groovy.runtime.callsite.PogoMetaClassSite.call(PogoMetaClassSite.java:37)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.call(AbstractCallSite.java:135)
        at org.jooby.JoobyExtension$_toHandler_closure3.doCall(JoobyExtension.groovy:17)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at groovy.lang.MetaMethod.doMethodInvoke(MetaMethod.java:323)
        at org.codehaus.groovy.runtime.metaclass.ClosureMetaClass.invokeMethod(ClosureMetaClass.java:263)
        at groovy.lang.MetaClassImpl.invokeMethod(MetaClassImpl.java:1041)
        at groovy.lang.Closure.call(Closure.java:405)
        at org.codehaus.groovy.runtime.ConvertedClosure.invokeCustom(ConvertedClosure.java:50)
        at org.codehaus.groovy.runtime.ConversionHandler.invoke(ConversionHandler.java:122)
        at com.sun.proxy.$Proxy23.handle(Unknown Source)
        at org.jooby.Route$Handler.handle(Route.java:1760)
        at java.base/java.lang.invoke.MethodHandle.invokeWithArguments(MethodHandle.java:710)
        at org.codehaus.groovy.vmplugin.v7.Java7.invokeHandle(Java7.java:106)
        at org.codehaus.groovy.runtime.ConversionHandler.invoke(ConversionHandler.java:110)
        at com.sun.proxy.$Proxy23.handle(Unknown Source)
        at org.jooby.internal.RouteImpl.handle(RouteImpl.java:280)
        at org.jooby.internal.RouteChain.next(RouteChain.java:262)
        at org.jooby.Route$Chain.next(Route.java:2163)
        at org.jooby.internal.HttpHandlerImpl.handle(HttpHandlerImpl.java:496)
        ... 10 common frames omitted
    [2020-08-31 08:35:57,516]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@28cda87a{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:57,517]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@776104d2{/,null,UNAVAILABLE}
    [2020-08-31 08:35:57,517]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@7654522e{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:35:57,518]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp2108034249{STOPPING,8<=8<=10,i=3,q=5} Couldn't stop Thread[qtp2108034249-95,5,]
    [2020-08-31 08:35:57,518]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp2108034249{STOPPING,8<=8<=10,i=0,q=3} Couldn't stop Thread[qtp2108034249-98,5,]

app.AppSpec > POST /document without parameter 'data' STANDARD_OUT
    [2020-08-31 08:35:57,523]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@6811db47{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:57,525]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:57,527]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@44e92b98{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:57,528]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@3c31ea9d{/,null,AVAILABLE}
    [2020-08-31 08:35:57,603]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@6811db47{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:57,604]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @20570ms
    [2020-08-31 08:35:57,703]-[netty task-7-4] ERROR org.jooby.Err - execution of: POST/document resulted in exception
    Route:
          | Method | Path      | Source     | Name       | Pattern   | Consumes           | Produces           |
          |--------|-----------|------------|------------|-----------|--------------------|--------------------|
          | POST   | /document | app.App:22 | /anonymous | /document | [application/json] | [application/json] |

    Stacktrace:
    org.jooby.Err: Bad Request(400)
        at org.jooby.internal.HttpHandlerImpl.handleErr(HttpHandlerImpl.java:589)
        at org.jooby.internal.HttpHandlerImpl.cleanup(HttpHandlerImpl.java:562)
        at org.jooby.internal.HttpHandlerImpl.handle(HttpHandlerImpl.java:504)
        at org.jooby.internal.netty.NettyHandler.channelRead0(NettyHandler.java:274)
        at io.netty.channel.SimpleChannelInboundHandler.channelRead(SimpleChannelInboundHandler.java:99)
        at io.netty.channel.AbstractChannelHandlerContext.invokeChannelRead(AbstractChannelHandlerContext.java:374)
        at io.netty.channel.AbstractChannelHandlerContext.access$600(AbstractChannelHandlerContext.java:56)
        at io.netty.channel.AbstractChannelHandlerContext$7.run(AbstractChannelHandlerContext.java:365)
        at io.netty.util.concurrent.DefaultEventExecutor.run(DefaultEventExecutor.java:66)
        at io.netty.util.concurrent.SingleThreadEventExecutor$6.run(SingleThreadEventExecutor.java:1050)
        at io.netty.util.internal.ThreadExecutorMap$2.run(ThreadExecutorMap.java:74)
        at io.netty.util.concurrent.FastThreadLocalRunnable.run(FastThreadLocalRunnable.java:30)
        at java.base/java.lang.Thread.run(Thread.java:834)
    Caused by: java.lang.IllegalArgumentException: missing argument 'data'
        at java.base/jdk.internal.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method)
        at java.base/jdk.internal.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:45)
        at java.base/java.lang.reflect.Constructor.newInstance(Constructor.java:490)
        at org.codehaus.groovy.reflection.CachedConstructor.invoke(CachedConstructor.java:80)
        at org.codehaus.groovy.runtime.callsite.ConstructorSite$ConstructorSiteNoUnwrapNoCoerce.callConstructor(ConstructorSite.java:105)
        at org.codehaus.groovy.runtime.callsite.CallSiteArray.defaultCallConstructor(CallSiteArray.java:59)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callConstructor(AbstractCallSite.java:237)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callConstructor(AbstractCallSite.java:249)
        at app.App.validateRequestParams(App.groovy:87)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at org.codehaus.groovy.runtime.callsite.StaticMetaMethodSite$StaticMetaMethodSiteNoUnwrapNoCoerce.invoke(StaticMetaMethodSite.java:149)
        at org.codehaus.groovy.runtime.callsite.StaticMetaMethodSite.callStatic(StaticMetaMethodSite.java:100)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.callStatic(AbstractCallSite.java:208)
        at app.App$_closure1.doCall(App.groovy:24)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at groovy.lang.MetaMethod.doMethodInvoke(MetaMethod.java:323)
        at org.codehaus.groovy.runtime.metaclass.ClosureMetaClass.invokeMethod(ClosureMetaClass.java:263)
        at groovy.lang.MetaClassImpl.invokeMethod(MetaClassImpl.java:1041)
        at org.codehaus.groovy.runtime.callsite.PogoMetaClassSite.call(PogoMetaClassSite.java:37)
        at org.codehaus.groovy.runtime.callsite.AbstractCallSite.call(AbstractCallSite.java:135)
        at org.jooby.JoobyExtension$_toHandler_closure3.doCall(JoobyExtension.groovy:17)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.base/java.lang.reflect.Method.invoke(Method.java:566)
        at org.codehaus.groovy.reflection.CachedMethod.invoke(CachedMethod.java:101)
        at groovy.lang.MetaMethod.doMethodInvoke(MetaMethod.java:323)
        at org.codehaus.groovy.runtime.metaclass.ClosureMetaClass.invokeMethod(ClosureMetaClass.java:263)
        at groovy.lang.MetaClassImpl.invokeMethod(MetaClassImpl.java:1041)
        at groovy.lang.Closure.call(Closure.java:405)
        at org.codehaus.groovy.runtime.ConvertedClosure.invokeCustom(ConvertedClosure.java:50)
        at org.codehaus.groovy.runtime.ConversionHandler.invoke(ConversionHandler.java:122)
        at com.sun.proxy.$Proxy23.handle(Unknown Source)
        at org.jooby.Route$Handler.handle(Route.java:1760)
        at java.base/java.lang.invoke.MethodHandle.invokeWithArguments(MethodHandle.java:710)
        at org.codehaus.groovy.vmplugin.v7.Java7.invokeHandle(Java7.java:106)
        at org.codehaus.groovy.runtime.ConversionHandler.invoke(ConversionHandler.java:110)
        at com.sun.proxy.$Proxy23.handle(Unknown Source)
        at org.jooby.internal.RouteImpl.handle(RouteImpl.java:280)
        at org.jooby.internal.RouteChain.next(RouteChain.java:262)
        at org.jooby.Route$Chain.next(Route.java:2163)
        at org.jooby.internal.HttpHandlerImpl.handle(HttpHandlerImpl.java:496)
        ... 10 common frames omitted
    [2020-08-31 08:35:57,714]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@6811db47{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:57,715]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@3c31ea9d{/,null,UNAVAILABLE}
    [2020-08-31 08:35:57,715]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@44e92b98{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:35:57,716]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp50787429{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp50787429-107,5,main]
    [2020-08-31 08:35:57,717]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp50787429{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp50787429-106,5,main]
    [2020-08-31 08:35:57,717]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp50787429{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp50787429-100,5,main]
    [2020-08-31 08:35:57,717]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp50787429{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp50787429-105,5,main]
    [2020-08-31 08:35:57,717]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp50787429{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp50787429-102,5,main]
    [2020-08-31 08:35:57,717]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp50787429{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp50787429-104,5,main]
    [2020-08-31 08:35:57,717]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp50787429{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp50787429-101,5,main]

app.AppSpec STANDARD_OUT
    [2020-08-31 08:35:57,718]-[Test worker] INFO  app.App - Stopped

app.BitBucketDocumentTemplatesStoreSpec STANDARD_OUT
    [2020-08-31 08:35:58,117]-[Test worker] INFO  app.App - [test@netty]: Server started in 389ms

      POST /document    [application/json]     [application/json]    (/anonymous)
      GET  /health                   [*/*]     [application/json]    (/anonymous)

    listening on:
      http://localhost:9000/

app.BitBucketDocumentTemplatesStoreSpec > getTemplatesForVersion STANDARD_OUT
    [2020-08-31 08:35:58,125]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@3f62b4ff{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:58,127]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:58,130]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@2fbbe06f{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:58,130]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@f50d303{/,null,AVAILABLE}
    [2020-08-31 08:35:58,131]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@3f62b4ff{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:58,131]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @21097ms
    [2020-08-31 08:35:58,206]-[qtp1981807287-118] INFO  / - RequestHandlerClass from context returned com.github.tomakehurst.wiremock.http.StubRequestHandler. Normalized mapped under returned 'null'
    [2020-08-31 08:35:58,230]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@3f62b4ff{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:58,231]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@f50d303{/,null,UNAVAILABLE}
    [2020-08-31 08:35:58,231]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@2fbbe06f{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:35:58,232]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1981807287{STOPPING,8<=8<=10,i=8,q=8} Couldn't stop Thread[qtp1981807287-121,5,main]
    [2020-08-31 08:35:58,232]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1981807287{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1981807287-123,5,main]
    [2020-08-31 08:35:58,232]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1981807287{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1981807287-115,5,main]
    [2020-08-31 08:35:58,232]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1981807287{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1981807287-119,5,main]
    [2020-08-31 08:35:58,232]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1981807287{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp1981807287-114,5,main]
    [2020-08-31 08:35:58,233]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1981807287{STOPPING,8<=8<=10,i=5,q=7} Couldn't stop Thread[qtp1981807287-118,5,main]
    [2020-08-31 08:35:58,233]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1981807287{STOPPING,8<=8<=10,i=5,q=7} Couldn't stop Thread[qtp1981807287-124,5,main]

app.BitBucketDocumentTemplatesStoreSpec > getTemplatesForVersionNonExistantBranch400 STANDARD_OUT
    [2020-08-31 08:35:58,303]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@1c7fe1e1{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:58,305]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:58,307]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@54a60bc1{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:58,307]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@6ba2e344{/,null,AVAILABLE}
    [2020-08-31 08:35:58,308]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@1c7fe1e1{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:58,308]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @21275ms
    [2020-08-31 08:35:58,321]-[qtp1133573725-131] INFO  / - RequestHandlerClass from context returned com.github.tomakehurst.wiremock.http.StubRequestHandler. Normalized mapped under returned 'null'
    [2020-08-31 08:35:58,421]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@1c7fe1e1{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:58,422]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@6ba2e344{/,null,UNAVAILABLE}
    [2020-08-31 08:35:58,422]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@54a60bc1{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:35:58,422]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-135,5,main]
    [2020-08-31 08:35:58,423]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-131,5,main]
    [2020-08-31 08:35:58,423]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-126,5,main]
    [2020-08-31 08:35:58,423]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-132,5,main]
    [2020-08-31 08:35:58,423]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-127,5,main]
    [2020-08-31 08:35:58,423]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-129,5,main]
    [2020-08-31 08:35:58,423]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-138,5,main]
    [2020-08-31 08:35:58,423]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-133,5,main]
    [2020-08-31 08:35:58,424]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-134,5,main]
    [2020-08-31 08:35:58,424]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp1133573725{STOPPING,8<=10<=10,i=10,q=10} Couldn't stop Thread[qtp1133573725-136,5,main]

app.BitBucketDocumentTemplatesStoreSpec > getTemplatesForVersionNonExistantBranch401 STANDARD_OUT
    [2020-08-31 08:35:58,429]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@736ea87d{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:58,431]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:58,434]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@b95ec37{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:58,434]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@5892185{/,null,AVAILABLE}
    [2020-08-31 08:35:58,435]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@736ea87d{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:58,501]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @21468ms
    [2020-08-31 08:35:58,511]-[qtp277131493-144] INFO  / - RequestHandlerClass from context returned com.github.tomakehurst.wiremock.http.StubRequestHandler. Normalized mapped under returned 'null'
    [2020-08-31 08:35:58,527]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@736ea87d{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:58,529]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@5892185{/,null,UNAVAILABLE}
    [2020-08-31 08:35:58,530]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@b95ec37{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:35:58,531]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp277131493{STOPPING,8<=8<=10,i=6,q=6} Couldn't stop Thread[qtp277131493-140,5,main]
    [2020-08-31 08:35:58,531]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp277131493{STOPPING,8<=8<=10,i=6,q=6} Couldn't stop Thread[qtp277131493-145,5,main]
    [2020-08-31 08:35:58,531]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp277131493{STOPPING,8<=8<=10,i=6,q=6} Couldn't stop Thread[qtp277131493-141,5,main]
    [2020-08-31 08:35:58,532]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp277131493{STOPPING,8<=8<=10,i=6,q=6} Couldn't stop Thread[qtp277131493-147,5,main]
    [2020-08-31 08:35:58,532]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp277131493{STOPPING,8<=8<=10,i=6,q=6} Couldn't stop Thread[qtp277131493-146,5,main]
    [2020-08-31 08:35:58,532]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp277131493{STOPPING,8<=8<=10,i=6,q=6} Couldn't stop Thread[qtp277131493-149,5,main]

app.BitBucketDocumentTemplatesStoreSpec > getTemplatesForVersionNonExistantBranch500 STANDARD_OUT
    [2020-08-31 08:35:58,603]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@72ebf6d1{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:58,606]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:58,608]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@3aa4f19a{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:58,609]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@521d23a0{/,null,AVAILABLE}
    [2020-08-31 08:35:58,609]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@72ebf6d1{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:58,610]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @21576ms
    [2020-08-31 08:35:58,623]-[qtp1360268331-155] INFO  / - RequestHandlerClass from context returned com.github.tomakehurst.wiremock.http.StubRequestHandler. Normalized mapped under returned 'null'
    [2020-08-31 08:35:58,705]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@72ebf6d1{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:58,707]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@521d23a0{/,null,UNAVAILABLE}
    [2020-08-31 08:35:58,707]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@3aa4f19a{/__admin,null,UNAVAILABLE}

app.BitBucketDocumentTemplatesStoreSpec STANDARD_OUT
    [2020-08-31 08:35:58,709]-[Test worker] INFO  app.App - Stopped

app.DocGenSpec STANDARD_OUT
    [2020-08-31 08:35:59,007]-[Test worker] INFO  app.App - [test@netty]: Server started in 290ms

      POST /document    [application/json]     [application/json]    (/anonymous)
      GET  /health                   [*/*]     [application/json]    (/anonymous)

    listening on:
      http://localhost:9000/

app.DocGenSpec > Util.convertHtmlToPDF STANDARD_OUT
    [INFO]: executing cmd: [wkhtmltopdf, --encoding, UTF-8, --no-outline, --print-media-type, -T, 40, -R, 25, -B, 25, -L, 25, --header-center, h
    e, --header-font-size, 10, --header-spacing, 10, --footer-center, Page [page] of [topage], --footer-font-size, 10, /tmp/document8355910983107419284.html, /tmp/document14055271708814787473.pdf]
app.DocGenSpec > generate STANDARD_OUT
    [2020-08-31 08:35:59,255]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@4413253d{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:35:59,257]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:35:59,259]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@32b63ea2{/__admin,null,AVAILABLE}
    [2020-08-31 08:35:59,260]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@3591d047{/,null,AVAILABLE}
    [2020-08-31 08:35:59,260]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@4413253d{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:59,260]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @22227ms
    Using templates @http://localhost:9001/rest/api/latest/projects/myProject/repos/myRepo/archive?at=refs%2Fheads%2Frelease%2Fv1.0&format=zip
    [2020-08-31 08:35:59,269]-[qtp900322546-168] INFO  / - RequestHandlerClass from context returned com.github.tomakehurst.wiremock.http.StubRequestHandler. Normalized mapped under returned 'null'
    [INFO]: executing cmd: [wkhtmltopdf, --encoding, UTF-8, --no-outline, --print-media-type, -T, 40, -R, 25, -B, 25, -L, 25, --header-center, h
    e, --header-font-size, 10, --header-spacing, 10, --footer-center, Page [page] of [topage], --footer-font-size, 10, /tmp/InstallationReport-v1.02983497965576594273/templates/InstallationReport.html, /tmp/document15827589810195642410.pdf]
    [2020-08-31 08:35:59,871]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@4413253d{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:35:59,872]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@3591d047{/,null,UNAVAILABLE}
    [2020-08-31 08:35:59,873]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@32b63ea2{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:35:59,873]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp900322546{STOPPING,8<=8<=10,i=8,q=8} Couldn't stop Thread[qtp900322546-170,5,main]
    [2020-08-31 08:35:59,873]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp900322546{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp900322546-164,5,main]
    [2020-08-31 08:35:59,873]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp900322546{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp900322546-165,5,main]
    [2020-08-31 08:35:59,873]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp900322546{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp900322546-167,5,main]
    [2020-08-31 08:35:59,874]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp900322546{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp900322546-168,5,main]
    [2020-08-31 08:35:59,874]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp900322546{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp900322546-166,5,main]
    [2020-08-31 08:35:59,874]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp900322546{STOPPING,8<=8<=10,i=7,q=7} Couldn't stop Thread[qtp900322546-169,5,main]

app.DocGenSpec STANDARD_OUT
    [2020-08-31 08:35:59,874]-[Test worker] INFO  app.App - Stopped

app.GithubDocumentTemplatesStoreSpec STANDARD_OUT
    [2020-08-31 08:36:00,102]-[Test worker] INFO  app.App - [test@netty]: Server started in 200ms

      POST /document    [application/json]     [application/json]    (/anonymous)
      GET  /health                   [*/*]     [application/json]    (/anonymous)

    listening on:
      http://localhost:9000/

app.GithubDocumentTemplatesStoreSpec > getTemplatesForVersionMock STANDARD_OUT
    [2020-08-31 08:36:00,113]-[Test worker] WARN  org.eclipse.jetty.server.NetworkTrafficServerConnector - Acceptors should be <= availableProcessors: NetworkTrafficServerConnector@79948978{HTTP/1.1}{0.0.0.0:0}
    [2020-08-31 08:36:00,115]-[Test worker] INFO  org.eclipse.jetty.server.Server - jetty-9.2.26.v20180806
    [2020-08-31 08:36:00,116]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@30aa134d{/__admin,null,AVAILABLE}
    [2020-08-31 08:36:00,116]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.s.ServletContextHandler@1a96118e{/,null,AVAILABLE}
    [2020-08-31 08:36:00,117]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Started NetworkTrafficServerConnector@79948978{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:36:00,117]-[Test worker] INFO  org.eclipse.jetty.server.Server - Started @23084ms
    [2020-08-31 08:36:00,129]-[qtp135385968-183] INFO  / - RequestHandlerClass from context returned com.github.tomakehurst.wiremock.http.StubRequestHandler. Normalized mapped under returned 'null'
    [2020-08-31 08:36:00,335]-[Test worker] INFO  org.eclipse.jetty.server.NetworkTrafficServerConnector - Stopped NetworkTrafficServerConnector@79948978{HTTP/1.1}{0.0.0.0:9001}
    [2020-08-31 08:36:00,336]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@1a96118e{/,null,UNAVAILABLE}
    [2020-08-31 08:36:00,337]-[Test worker] INFO  org.eclipse.jetty.server.handler.ContextHandler - Stopped o.e.j.s.ServletContextHandler@30aa134d{/__admin,null,UNAVAILABLE}
    [2020-08-31 08:36:00,338]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp135385968{STOPPING,8<=8<=10,i=6,q=7} Couldn't stop Thread[qtp135385968-185,5,main]
    [2020-08-31 08:36:00,338]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp135385968{STOPPING,8<=8<=10,i=6,q=7} Couldn't stop Thread[qtp135385968-180,5,main]
    [2020-08-31 08:36:00,338]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp135385968{STOPPING,8<=8<=10,i=6,q=7} Couldn't stop Thread[qtp135385968-182,5,main]
    [2020-08-31 08:36:00,338]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp135385968{STOPPING,8<=8<=10,i=6,q=7} Couldn't stop Thread[qtp135385968-184,5,main]
    [2020-08-31 08:36:00,338]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp135385968{STOPPING,8<=8<=10,i=6,q=7} Couldn't stop Thread[qtp135385968-181,5,main]
    [2020-08-31 08:36:00,338]-[Test worker] WARN  org.eclipse.jetty.util.thread.QueuedThreadPool - qtp135385968{STOPPING,8<=8<=10,i=6,q=7} Couldn't stop Thread[qtp135385968-183,5,main]
app.GithubDocumentTemplatesStoreSpec > getTemplatesForVersion FAILED
    feign.RetryableException at GithubDocumentTemplatesStoreSpec.groovy:44
        Caused by: javax.net.ssl.SSLException at GithubDocumentTemplatesStoreSpec.groovy:44
            Caused by: java.net.SocketException at GithubDocumentTemplatesStoreSpec.groovy:44

app.GithubDocumentTemplatesStoreSpec STANDARD_OUT
    [2020-08-31 08:36:02,012]-[Test worker] INFO  app.App - Stopped
14 tests completed, 1 failed

> Task :test FAILED
> Task :jacocoTestReport

FAILURE: Build failed with an exception.

* What went wrong:
Execution failed for task ':test'.
> There were failing tests. See the report at: file:///tmp/workspace/unitt-cd/unitt-cd-run-unitt-docgen-unitt-3x/build/reports/tests/test/index.html

* Try:
Run with --info or --debug option to get more log output. Run with --scan to get full insights.

* Exception is:
org.gradle.api.tasks.TaskExecutionException: Execution failed for task ':test'.
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter$3.accept(ExecuteActionsTaskExecuter.java:151)
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter$3.accept(ExecuteActionsTaskExecuter.java:148)
    at org.gradle.internal.Try$Failure.ifSuccessfulOrElse(Try.java:191)
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter.execute(ExecuteActionsTaskExecuter.java:141)
    at org.gradle.api.internal.tasks.execution.ResolveBeforeExecutionStateTaskExecuter.execute(ResolveBeforeExecutionStateTaskExecuter.java:75)
    at org.gradle.api.internal.tasks.execution.ValidatingTaskExecuter.execute(ValidatingTaskExecuter.java:62)
    at org.gradle.api.internal.tasks.execution.SkipEmptySourceFilesTaskExecuter.execute(SkipEmptySourceFilesTaskExecuter.java:108)
    at org.gradle.api.internal.tasks.execution.ResolveBeforeExecutionOutputsTaskExecuter.execute(ResolveBeforeExecutionOutputsTaskExecuter.java:67)
    at org.gradle.api.internal.tasks.execution.ResolveAfterPreviousExecutionStateTaskExecuter.execute(ResolveAfterPreviousExecutionStateTaskExecuter.java:46)
    at org.gradle.api.internal.tasks.execution.CleanupStaleOutputsExecuter.execute(CleanupStaleOutputsExecuter.java:94)
    at org.gradle.api.internal.tasks.execution.FinalizePropertiesTaskExecuter.execute(FinalizePropertiesTaskExecuter.java:46)
    at org.gradle.api.internal.tasks.execution.ResolveTaskExecutionModeExecuter.execute(ResolveTaskExecutionModeExecuter.java:95)
    at org.gradle.api.internal.tasks.execution.SkipTaskWithNoActionsExecuter.execute(SkipTaskWithNoActionsExecuter.java:57)
    at org.gradle.api.internal.tasks.execution.SkipOnlyIfTaskExecuter.execute(SkipOnlyIfTaskExecuter.java:56)
    at org.gradle.api.internal.tasks.execution.CatchExceptionTaskExecuter.execute(CatchExceptionTaskExecuter.java:36)
    at org.gradle.api.internal.tasks.execution.EventFiringTaskExecuter$1.executeTask(EventFiringTaskExecuter.java:73)
    at org.gradle.api.internal.tasks.execution.EventFiringTaskExecuter$1.call(EventFiringTaskExecuter.java:52)
    at org.gradle.api.internal.tasks.execution.EventFiringTaskExecuter$1.call(EventFiringTaskExecuter.java:49)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$CallableBuildOperationWorker.execute(DefaultBuildOperationExecutor.java:416)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$CallableBuildOperationWorker.execute(DefaultBuildOperationExecutor.java:406)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$1.execute(DefaultBuildOperationExecutor.java:165)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.execute(DefaultBuildOperationExecutor.java:250)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.execute(DefaultBuildOperationExecutor.java:158)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.call(DefaultBuildOperationExecutor.java:102)
    at org.gradle.internal.operations.DelegatingBuildOperationExecutor.call(DelegatingBuildOperationExecutor.java:36)
    at org.gradle.api.internal.tasks.execution.EventFiringTaskExecuter.execute(EventFiringTaskExecuter.java:49)
    at org.gradle.execution.plan.LocalTaskNodeExecutor.execute(LocalTaskNodeExecutor.java:43)
    at org.gradle.execution.taskgraph.DefaultTaskExecutionGraph$InvokeNodeExecutorsAction.execute(DefaultTaskExecutionGraph.java:355)
    at org.gradle.execution.taskgraph.DefaultTaskExecutionGraph$InvokeNodeExecutorsAction.execute(DefaultTaskExecutionGraph.java:343)
    at org.gradle.execution.taskgraph.DefaultTaskExecutionGraph$BuildOperationAwareExecutionAction.execute(DefaultTaskExecutionGraph.java:336)
    at org.gradle.execution.taskgraph.DefaultTaskExecutionGraph$BuildOperationAwareExecutionAction.execute(DefaultTaskExecutionGraph.java:322)
    at org.gradle.execution.plan.DefaultPlanExecutor$ExecutorWorker$1.execute(DefaultPlanExecutor.java:134)
    at org.gradle.execution.plan.DefaultPlanExecutor$ExecutorWorker$1.execute(DefaultPlanExecutor.java:129)
    at org.gradle.execution.plan.DefaultPlanExecutor$ExecutorWorker.execute(DefaultPlanExecutor.java:202)
    at org.gradle.execution.plan.DefaultPlanExecutor$ExecutorWorker.executeNextNode(DefaultPlanExecutor.java:193)
    at org.gradle.execution.plan.DefaultPlanExecutor$ExecutorWorker.run(DefaultPlanExecutor.java:129)
    at org.gradle.execution.plan.DefaultPlanExecutor.process(DefaultPlanExecutor.java:74)
    at org.gradle.execution.taskgraph.DefaultTaskExecutionGraph.executeWithServices(DefaultTaskExecutionGraph.java:178)
    at org.gradle.execution.taskgraph.DefaultTaskExecutionGraph.execute(DefaultTaskExecutionGraph.java:154)
    at org.gradle.execution.SelectedTaskExecutionAction.execute(SelectedTaskExecutionAction.java:41)
    at org.gradle.execution.DefaultBuildExecuter.execute(DefaultBuildExecuter.java:40)
    at org.gradle.execution.DefaultBuildExecuter.access$000(DefaultBuildExecuter.java:24)
    at org.gradle.execution.DefaultBuildExecuter$1.proceed(DefaultBuildExecuter.java:46)
    at org.gradle.execution.DryRunBuildExecutionAction.execute(DryRunBuildExecutionAction.java:49)
    at org.gradle.execution.DefaultBuildExecuter.execute(DefaultBuildExecuter.java:40)
    at org.gradle.execution.DefaultBuildExecuter.execute(DefaultBuildExecuter.java:33)
    at org.gradle.initialization.DefaultGradleLauncher$ExecuteTasks.run(DefaultGradleLauncher.java:383)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$RunnableBuildOperationWorker.execute(DefaultBuildOperationExecutor.java:402)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$RunnableBuildOperationWorker.execute(DefaultBuildOperationExecutor.java:394)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$1.execute(DefaultBuildOperationExecutor.java:165)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.execute(DefaultBuildOperationExecutor.java:250)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.execute(DefaultBuildOperationExecutor.java:158)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.run(DefaultBuildOperationExecutor.java:92)
    at org.gradle.internal.operations.DelegatingBuildOperationExecutor.run(DelegatingBuildOperationExecutor.java:31)
    at org.gradle.initialization.DefaultGradleLauncher.runTasks(DefaultGradleLauncher.java:247)
    at org.gradle.initialization.DefaultGradleLauncher.doBuildStages(DefaultGradleLauncher.java:159)
    at org.gradle.initialization.DefaultGradleLauncher.executeTasks(DefaultGradleLauncher.java:134)
    at org.gradle.internal.invocation.GradleBuildController$1.execute(GradleBuildController.java:58)
    at org.gradle.internal.invocation.GradleBuildController$1.execute(GradleBuildController.java:55)
    at org.gradle.internal.invocation.GradleBuildController$3.create(GradleBuildController.java:82)
    at org.gradle.internal.invocation.GradleBuildController$3.create(GradleBuildController.java:75)
    at org.gradle.internal.work.DefaultWorkerLeaseService.withLocks(DefaultWorkerLeaseService.java:183)
    at org.gradle.internal.work.StopShieldingWorkerLeaseService.withLocks(StopShieldingWorkerLeaseService.java:40)
    at org.gradle.internal.invocation.GradleBuildController.doBuild(GradleBuildController.java:75)
    at org.gradle.internal.invocation.GradleBuildController.run(GradleBuildController.java:55)
    at org.gradle.tooling.internal.provider.ExecuteBuildActionRunner.run(ExecuteBuildActionRunner.java:31)
    at org.gradle.launcher.exec.ChainingBuildActionRunner.run(ChainingBuildActionRunner.java:35)
    at org.gradle.launcher.exec.BuildOutcomeReportingBuildActionRunner.run(BuildOutcomeReportingBuildActionRunner.java:58)
    at org.gradle.tooling.internal.provider.ValidatingBuildActionRunner.run(ValidatingBuildActionRunner.java:32)
    at org.gradle.launcher.exec.BuildCompletionNotifyingBuildActionRunner.run(BuildCompletionNotifyingBuildActionRunner.java:39)
    at org.gradle.launcher.exec.RunAsBuildOperationBuildActionRunner$3.call(RunAsBuildOperationBuildActionRunner.java:51)
    at org.gradle.launcher.exec.RunAsBuildOperationBuildActionRunner$3.call(RunAsBuildOperationBuildActionRunner.java:45)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$CallableBuildOperationWorker.execute(DefaultBuildOperationExecutor.java:416)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$CallableBuildOperationWorker.execute(DefaultBuildOperationExecutor.java:406)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$1.execute(DefaultBuildOperationExecutor.java:165)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.execute(DefaultBuildOperationExecutor.java:250)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.execute(DefaultBuildOperationExecutor.java:158)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.call(DefaultBuildOperationExecutor.java:102)
    at org.gradle.internal.operations.DelegatingBuildOperationExecutor.call(DelegatingBuildOperationExecutor.java:36)
    at org.gradle.launcher.exec.RunAsBuildOperationBuildActionRunner.run(RunAsBuildOperationBuildActionRunner.java:45)
    at org.gradle.launcher.exec.InProcessBuildActionExecuter$1.transform(InProcessBuildActionExecuter.java:49)
    at org.gradle.launcher.exec.InProcessBuildActionExecuter$1.transform(InProcessBuildActionExecuter.java:46)
    at org.gradle.composite.internal.DefaultRootBuildState.run(DefaultRootBuildState.java:78)
    at org.gradle.launcher.exec.InProcessBuildActionExecuter.execute(InProcessBuildActionExecuter.java:46)
    at org.gradle.launcher.exec.InProcessBuildActionExecuter.execute(InProcessBuildActionExecuter.java:31)
    at org.gradle.launcher.exec.BuildTreeScopeBuildActionExecuter.execute(BuildTreeScopeBuildActionExecuter.java:42)
    at org.gradle.launcher.exec.BuildTreeScopeBuildActionExecuter.execute(BuildTreeScopeBuildActionExecuter.java:28)
    at org.gradle.tooling.internal.provider.ContinuousBuildActionExecuter.execute(ContinuousBuildActionExecuter.java:78)
    at org.gradle.tooling.internal.provider.ContinuousBuildActionExecuter.execute(ContinuousBuildActionExecuter.java:52)
    at org.gradle.tooling.internal.provider.SubscribableBuildActionExecuter.execute(SubscribableBuildActionExecuter.java:59)
    at org.gradle.tooling.internal.provider.SubscribableBuildActionExecuter.execute(SubscribableBuildActionExecuter.java:36)
    at org.gradle.tooling.internal.provider.SessionScopeBuildActionExecuter.execute(SessionScopeBuildActionExecuter.java:68)
    at org.gradle.tooling.internal.provider.SessionScopeBuildActionExecuter.execute(SessionScopeBuildActionExecuter.java:38)
    at org.gradle.tooling.internal.provider.GradleThreadBuildActionExecuter.execute(GradleThreadBuildActionExecuter.java:37)
    at org.gradle.tooling.internal.provider.GradleThreadBuildActionExecuter.execute(GradleThreadBuildActionExecuter.java:26)
    at org.gradle.tooling.internal.provider.ParallelismConfigurationBuildActionExecuter.execute(ParallelismConfigurationBuildActionExecuter.java:43)
    at org.gradle.tooling.internal.provider.ParallelismConfigurationBuildActionExecuter.execute(ParallelismConfigurationBuildActionExecuter.java:29)
    at org.gradle.tooling.internal.provider.StartParamsValidatingActionExecuter.execute(StartParamsValidatingActionExecuter.java:60)
    at org.gradle.tooling.internal.provider.StartParamsValidatingActionExecuter.execute(StartParamsValidatingActionExecuter.java:32)
    at org.gradle.tooling.internal.provider.SessionFailureReportingActionExecuter.execute(SessionFailureReportingActionExecuter.java:55)
    at org.gradle.tooling.internal.provider.SessionFailureReportingActionExecuter.execute(SessionFailureReportingActionExecuter.java:41)
    at org.gradle.tooling.internal.provider.SetupLoggingActionExecuter.execute(SetupLoggingActionExecuter.java:48)
    at org.gradle.tooling.internal.provider.SetupLoggingActionExecuter.execute(SetupLoggingActionExecuter.java:32)
    at org.gradle.launcher.cli.RunBuildAction.run(RunBuildAction.java:55)
    at org.gradle.internal.Actions$RunnableActionAdapter.execute(Actions.java:208)
    at org.gradle.launcher.cli.CommandLineActionFactory$ParseAndBuildAction.execute(CommandLineActionFactory.java:394)
    at org.gradle.launcher.cli.CommandLineActionFactory$ParseAndBuildAction.execute(CommandLineActionFactory.java:367)
    at org.gradle.launcher.cli.ExceptionReportingAction.execute(ExceptionReportingAction.java:37)
    at org.gradle.launcher.cli.ExceptionReportingAction.execute(ExceptionReportingAction.java:23)
    at org.gradle.launcher.cli.CommandLineActionFactory$WithLogging.execute(CommandLineActionFactory.java:360)
    at org.gradle.launcher.cli.CommandLineActionFactory$WithLogging.execute(CommandLineActionFactory.java:292)
    at org.gradle.launcher.Main.doAction(Main.java:36)
    at org.gradle.launcher.bootstrap.EntryPoint.run(EntryPoint.java:45)
    at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
    at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
    at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
    at org.gradle.launcher.bootstrap.ProcessBootstrap.runNoExit(ProcessBootstrap.java:60)
    at org.gradle.launcher.bootstrap.ProcessBootstrap.run(ProcessBootstrap.java:37)
    at org.gradle.launcher.GradleMain.main(GradleMain.java:23)
    at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
    at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
    at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
    at org.gradle.wrapper.BootstrapMainStarter.start(BootstrapMainStarter.java:31)
    at org.gradle.wrapper.WrapperExecutor.execute(WrapperExecutor.java:108)
    at org.gradle.wrapper.GradleWrapperMain.main(GradleWrapperMain.java:62)
Caused by: org.gradle.api.GradleException: There were failing tests. See the report at: file:///tmp/workspace/unitt-cd/unitt-cd-run-unitt-docgen-unitt-3x/build/reports/tests/test/index.html
    at org.gradle.api.tasks.testing.AbstractTestTask.handleTestFailures(AbstractTestTask.java:626)
    at org.gradle.api.tasks.testing.AbstractTestTask.executeTests(AbstractTestTask.java:498)
    at org.gradle.api.tasks.testing.Test.executeTests(Test.java:594)
    at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
    at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
    at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
    at org.gradle.internal.reflect.JavaMethod.invoke(JavaMethod.java:103)
    at org.gradle.api.internal.project.taskfactory.StandardTaskAction.doExecute(StandardTaskAction.java:48)
    at org.gradle.api.internal.project.taskfactory.StandardTaskAction.execute(StandardTaskAction.java:41)
    at org.gradle.api.internal.project.taskfactory.StandardTaskAction.execute(StandardTaskAction.java:28)
    at org.gradle.api.internal.AbstractTask$TaskActionWrapper.execute(AbstractTask.java:702)
    at org.gradle.api.internal.AbstractTask$TaskActionWrapper.execute(AbstractTask.java:669)
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter$5.run(ExecuteActionsTaskExecuter.java:404)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$RunnableBuildOperationWorker.execute(DefaultBuildOperationExecutor.java:402)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$RunnableBuildOperationWorker.execute(DefaultBuildOperationExecutor.java:394)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor$1.execute(DefaultBuildOperationExecutor.java:165)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.execute(DefaultBuildOperationExecutor.java:250)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.execute(DefaultBuildOperationExecutor.java:158)
    at org.gradle.internal.operations.DefaultBuildOperationExecutor.run(DefaultBuildOperationExecutor.java:92)
    at org.gradle.internal.operations.DelegatingBuildOperationExecutor.run(DelegatingBuildOperationExecutor.java:31)
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter.executeAction(ExecuteActionsTaskExecuter.java:393)
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter.executeActions(ExecuteActionsTaskExecuter.java:376)
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter.access$200(ExecuteActionsTaskExecuter.java:80)
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter$TaskExecution.execute(ExecuteActionsTaskExecuter.java:213)
    at org.gradle.internal.execution.steps.ExecuteStep.lambda$execute$1(ExecuteStep.java:33)
    at org.gradle.internal.execution.steps.ExecuteStep.execute(ExecuteStep.java:33)
    at org.gradle.internal.execution.steps.ExecuteStep.execute(ExecuteStep.java:26)
    at org.gradle.internal.execution.steps.CleanupOutputsStep.execute(CleanupOutputsStep.java:58)
    at org.gradle.internal.execution.steps.CleanupOutputsStep.execute(CleanupOutputsStep.java:35)
    at org.gradle.internal.execution.steps.ResolveInputChangesStep.execute(ResolveInputChangesStep.java:48)
    at org.gradle.internal.execution.steps.ResolveInputChangesStep.execute(ResolveInputChangesStep.java:33)
    at org.gradle.internal.execution.steps.CancelExecutionStep.execute(CancelExecutionStep.java:39)
    at org.gradle.internal.execution.steps.TimeoutStep.executeWithoutTimeout(TimeoutStep.java:73)
    at org.gradle.internal.execution.steps.TimeoutStep.execute(TimeoutStep.java:54)
    at org.gradle.internal.execution.steps.CatchExceptionStep.execute(CatchExceptionStep.java:35)
    at org.gradle.internal.execution.steps.CreateOutputsStep.execute(CreateOutputsStep.java:51)
    at org.gradle.internal.execution.steps.SnapshotOutputsStep.execute(SnapshotOutputsStep.java:45)
    at org.gradle.internal.execution.steps.SnapshotOutputsStep.execute(SnapshotOutputsStep.java:31)
    at org.gradle.internal.execution.steps.CacheStep.executeWithoutCache(CacheStep.java:201)
    at org.gradle.internal.execution.steps.CacheStep.execute(CacheStep.java:70)
    at org.gradle.internal.execution.steps.CacheStep.execute(CacheStep.java:45)
    at org.gradle.internal.execution.steps.BroadcastChangingOutputsStep.execute(BroadcastChangingOutputsStep.java:49)
    at org.gradle.internal.execution.steps.StoreSnapshotsStep.execute(StoreSnapshotsStep.java:43)
    at org.gradle.internal.execution.steps.StoreSnapshotsStep.execute(StoreSnapshotsStep.java:32)
    at org.gradle.internal.execution.steps.RecordOutputsStep.execute(RecordOutputsStep.java:38)
    at org.gradle.internal.execution.steps.RecordOutputsStep.execute(RecordOutputsStep.java:24)
    at org.gradle.internal.execution.steps.SkipUpToDateStep.executeBecause(SkipUpToDateStep.java:96)
    at org.gradle.internal.execution.steps.SkipUpToDateStep.lambda$execute$0(SkipUpToDateStep.java:89)
    at org.gradle.internal.execution.steps.SkipUpToDateStep.execute(SkipUpToDateStep.java:54)
    at org.gradle.internal.execution.steps.SkipUpToDateStep.execute(SkipUpToDateStep.java:38)
    at org.gradle.internal.execution.steps.ResolveChangesStep.execute(ResolveChangesStep.java:77)
    at org.gradle.internal.execution.steps.ResolveChangesStep.execute(ResolveChangesStep.java:37)
    at org.gradle.internal.execution.steps.legacy.MarkSnapshottingInputsFinishedStep.execute(MarkSnapshottingInputsFinishedStep.java:36)
    at org.gradle.internal.execution.steps.legacy.MarkSnapshottingInputsFinishedStep.execute(MarkSnapshottingInputsFinishedStep.java:26)
    at org.gradle.internal.execution.steps.ResolveCachingStateStep.execute(ResolveCachingStateStep.java:90)
    at org.gradle.internal.execution.steps.ResolveCachingStateStep.execute(ResolveCachingStateStep.java:48)
    at org.gradle.internal.execution.impl.DefaultWorkExecutor.execute(DefaultWorkExecutor.java:33)
    at org.gradle.api.internal.tasks.execution.ExecuteActionsTaskExecuter.execute(ExecuteActionsTaskExecuter.java:120)
    ... 121 more

* Get more help at https://help.gradle.org

BUILD FAILED in 1m 41s
7 actionable tasks: 6 executed, 1 up-to-date
[Pipeline] error
[Pipeline] }
[Pipeline] // withEnv
[Pipeline] }
[Pipeline] // stage
[Pipeline] }
[Pipeline] // wrap
[Pipeline] stage
[Pipeline] { (odsPipeline error)
[Pipeline] echo
WARN: [docgen] ***** Finished ODS Pipeline for docgen (with error) ***** (took 204062 ms)
[Pipeline] echo
WARN: Error: hudson.AbortException: Build failed!
[Pipeline] echo
DEBUG: [buildstatus-92bf9719-FAILED] Setting Bitbucket build status to 'FAILED' on commit '92bf9719067e84e286b8e26284c18b125c15536a' / 'https://jenkins-unitt-cd.inh-odsapps.base.domain.com/job/unitt-cd/job/unitt-cd-run-unitt-docgen-unitt-3x/2/'
[Pipeline] withCredentials
Masking supported pattern matches of $USERNAME or $TOKEN
[Pipeline] {
[Pipeline] sh (Set bitbucket build status via API)
+ curl --fail --silent --request POST --header 'Authorization: Bearer ****' --header 'Content-Type: application/json' --data '{"state":"FAILED","key":"92bf9719","name":"92bf9719","url":"https://jenkins-unitt-cd.inh-odsapps.base.domain.com/job/unitt-cd/job/unitt-cd-run-unitt-docgen-unitt-3x/2/"}' https://bitbucket/rest/build-status/1.0/commits/92bf9719067e84e286b8e26284c18b125c15536a
[Pipeline] }
[Pipeline] // withCredentials
[Pipeline] echo
DEBUG: [buildstatus-92bf9719-FAILED]  (took 2967 ms)
[Pipeline] emailextrecipients
Failed to send e-mail to aymerich because no e-mail address is known, and no default e-mail domain is configured
[Pipeline] emailext
An attempt to send an e-mail to empty list of recipients, ignored.
[Pipeline] }
[Pipeline] // stage
[Pipeline] echo
Attempting to stash testresults from location: 'build/test-results/test'
[Pipeline] sh (Moving test results to system location: build/test-results/test)
+ mkdir -p build/test-results/test build/test-results/test
+ cp -rf build/test-results/test/TEST-app.AppSpec.xml build/test-results/test/TEST-app.BitBucketDocumentTemplatesStoreSpec.xml build/test-results/test/TEST-app.DocGenSpec.xml build/test-results/test/TEST-app.GithubDocumentTemplatesStoreSpec.xml build/test-results/test/TEST-app.SpecHelper.xml build/test-results/test/binary build/test-results/test
+ true
cp: 'build/test-results/test/TEST-app.AppSpec.xml' and 'build/test-results/test/TEST-app.AppSpec.xml' are the same file
cp: 'build/test-results/test/TEST-app.BitBucketDocumentTemplatesStoreSpec.xml' and 'build/test-results/test/TEST-app.BitBucketDocumentTemplatesStoreSpec.xml' are the same file
cp: 'build/test-results/test/TEST-app.DocGenSpec.xml' and 'build/test-results/test/TEST-app.DocGenSpec.xml' are the same file
cp: 'build/test-results/test/TEST-app.GithubDocumentTemplatesStoreSpec.xml' and 'build/test-results/test/TEST-app.GithubDocumentTemplatesStoreSpec.xml' are the same file
cp: 'build/test-results/test/TEST-app.SpecHelper.xml' and 'build/test-results/test/TEST-app.SpecHelper.xml' are the same file
cp: 'build/test-results/test/binary' and 'build/test-results/test/binary' are the same file
[Pipeline] sh (Counting test results in build/test-results/test)
+ ls -la build/test-results/test/TEST-app.AppSpec.xml build/test-results/test/TEST-app.BitBucketDocumentTemplatesStoreSpec.xml build/test-results/test/TEST-app.DocGenSpec.xml build/test-results/test/TEST-app.GithubDocumentTemplatesStoreSpec.xml build/test-results/test/TEST-app.SpecHelper.xml
+ wc -l
[Pipeline] echo
DEBUG: Found 5 test files in 'build/test-results/test'
[Pipeline] junit
Recording test results
[Pipeline] stash
Stashed 5 file(s)
[Pipeline] echo
DEBUG: [docgen] ODS Component Pipeline 'docgen-2'
ODS Build Artifacts 'docgen': 
{
    "builds": {

    },
    "deployments": {

    },
    "testResultsFolder": "build/test-results/test",
    "testResults": "5",
    "xunitTestResultsStashPath": "test-reports-junit-xml-docgen-2"
} (took 209363 ms)
[Pipeline] }
[Pipeline] // node
[Pipeline] }
[Pipeline] // podTemplate
[Pipeline] End of Pipeline
ERROR: Build failed!
Finished: FAILURE
clemensutschig commented 4 years ago 
feign.RetryableException at GithubDocumentTemplatesStoreSpec.groovy:44
    Caused by: javax.net.ssl.SSLException at GithubDocumentTemplatesStoreSpec.groovy:44
        Caused by: java.net.SocketException at GithubDocumentTemplatesStoreSpec.groovy:44