builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-061 starttime: 1505377026.34 results: success (0) revision: 1c08a2f4d2fc14e2a88915a2bd8f033f04c058ab ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.342543) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.344415) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.344735) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.380555) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.380824) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-14 01:17:06-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 226M=0s 2017-09-14 01:17:06 (226 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.124566 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.526292) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.526587) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019959 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.593815) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:06.594140) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 1c08a2f4d2fc14e2a88915a2bd8f033f04c058ab --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 1c08a2f4d2fc14e2a88915a2bd8f033f04c058ab --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-14 01:17:06,494 truncating revision to first 12 chars 2017-09-14 01:17:06,494 Setting DEBUG logging. 2017-09-14 01:17:06,494 attempt 1/10 2017-09-14 01:17:06,494 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/1c08a2f4d2fc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-14 01:17:07,020 unpacking tar archive at: mozilla-beta-1c08a2f4d2fc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.799715 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:07.410989) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:07.411307) ========= script_repo_revision: 1c08a2f4d2fc14e2a88915a2bd8f033f04c058ab ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:07.411684) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:07.411943) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-14 01:17:07.425084) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2017-09-14 01:17:07.425369) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 01:17:07 INFO - MultiFileLogger online at 20170914 01:17:07 in /builds/slave/test 01:17:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta-Non-PGO 01:17:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 01:17:07 INFO - {'append_to_log': False, 01:17:07 INFO - 'base_work_dir': '/builds/slave/test', 01:17:07 INFO - 'blob_upload_branch': 'Mozilla-Beta-Non-PGO', 01:17:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 01:17:07 INFO - 'branch': 'Mozilla-Beta-Non-PGO', 01:17:07 INFO - 'buildbot_json_path': 'buildprops.json', 01:17:07 INFO - 'code_coverage': False, 01:17:07 INFO - 'config_files': ('talos/linux_config.py',), 01:17:07 INFO - 'default_actions': ('clobber', 01:17:07 INFO - 'read-buildbot-config', 01:17:07 INFO - 'download-and-extract', 01:17:07 INFO - 'populate-webroot', 01:17:07 INFO - 'create-virtualenv', 01:17:07 INFO - 'install', 01:17:07 INFO - 'setup-mitmproxy', 01:17:07 INFO - 'run-tests'), 01:17:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 01:17:07 INFO - 'disable_ccov_upload': False, 01:17:07 INFO - 'download_minidump_stackwalk': True, 01:17:07 INFO - 'download_symbols': 'ondemand', 01:17:07 INFO - 'enable_stylo': False, 01:17:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 01:17:07 INFO - 'tooltool.py': '/tools/tooltool.py', 01:17:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 01:17:07 INFO - '/tools/misc-python/virtualenv.py')}, 01:17:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 01:17:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 01:17:07 INFO - 'gecko_profile': False, 01:17:07 INFO - 'gecko_profile_interval': 0, 01:17:07 INFO - 'installer_path': 'installer.exe', 01:17:07 INFO - 'log_level': 'info', 01:17:07 INFO - 'log_name': 'talos', 01:17:07 INFO - 'log_to_console': True, 01:17:07 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 01:17:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 01:17:07 INFO - 'opt_config_files': (), 01:17:07 INFO - 'pip_index': False, 01:17:07 INFO - 'suite': 'dromaeojs-e10s', 01:17:07 INFO - 'system_bits': '32', 01:17:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 01:17:07 INFO - 'title': 'talos-linux64-ix-061', 01:17:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 01:17:07 INFO - 'use_talos_json': True, 01:17:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 01:17:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 01:17:07 INFO - 'work_dir': 'build'} 01:17:07 INFO - [mozharness: 2017-09-14 08:17:07.426482Z] Running clobber step. 01:17:07 INFO - Running pre-action listener: _resource_record_pre_action 01:17:07 INFO - Running main action method: clobber 01:17:07 INFO - rmtree: /builds/slave/test/build 01:17:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 01:17:08 INFO - Running post-action listener: _resource_record_post_action 01:17:08 INFO - [mozharness: 2017-09-14 08:17:08.934144Z] Finished clobber step (success) 01:17:08 INFO - [mozharness: 2017-09-14 08:17:08.934247Z] Running read-buildbot-config step. 01:17:08 INFO - Running pre-action listener: _resource_record_pre_action 01:17:08 INFO - Running main action method: read_buildbot_config 01:17:08 INFO - Using buildbot properties: 01:17:08 INFO - { 01:17:08 INFO - "project": "", 01:17:08 INFO - "product": "firefox", 01:17:08 INFO - "who": "kwierso@gmail.com", 01:17:08 INFO - "installer_path": "public/build/target.tar.bz2", 01:17:08 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 01:17:08 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-beta", 01:17:08 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta talos dromaeojs-e10s", 01:17:08 INFO - "stage_platform": "linux64", 01:17:08 INFO - "basedir": "/builds/slave/test", 01:17:08 INFO - "buildnumber": 107, 01:17:08 INFO - "platform": "ubuntu64_hw", 01:17:08 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 01:17:08 INFO - "slavebuilddir": "test", 01:17:08 INFO - "taskId": "KXVAvXEjSNKVooTgx5ZS-g", 01:17:08 INFO - "branch": "mozilla-beta", 01:17:08 INFO - "script_repo_revision": "production", 01:17:08 INFO - "revision": "1c08a2f4d2fc14e2a88915a2bd8f033f04c058ab", 01:17:08 INFO - "slavename": "talos-linux64-ix-061", 01:17:08 INFO - "repo_path": "releases/mozilla-beta" 01:17:08 INFO - } 01:17:08 INFO - Finding installer, test and symbols from parent task. 01:17:08 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KXVAvXEjSNKVooTgx5ZS-g'}, attempt #1 01:17:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KXVAvXEjSNKVooTgx5ZS-g'}, attempt #1 01:17:09 INFO - Task dependencies: NXHJuPQ6StmVl1oYUH0QVA 01:17:09 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA'}, attempt #1 01:17:11 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.tar.bz2 01:17:11 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.test_packages.json 01:17:11 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.crashreporter-symbols.zip 01:17:11 INFO - Running post-action listener: _resource_record_post_action 01:17:11 INFO - [mozharness: 2017-09-14 08:17:11.332756Z] Finished read-buildbot-config step (success) 01:17:11 INFO - [mozharness: 2017-09-14 08:17:11.332978Z] Running download-and-extract step. 01:17:11 INFO - Running pre-action listener: _resource_record_pre_action 01:17:11 INFO - Running main action method: download_and_extract 01:17:11 INFO - mkdir: /builds/slave/test/build/tests 01:17:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:11 INFO - trying https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.test_packages.json 01:17:11 INFO - Downloading https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 01:17:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 01:17:11 INFO - Downloaded 989 bytes. 01:17:11 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 01:17:11 INFO - Using the following test package requirements: 01:17:11 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 01:17:11 INFO - u'common': [u'target.common.tests.zip'], 01:17:11 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 01:17:11 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 01:17:11 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 01:17:11 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 01:17:11 INFO - u'mozbase': [u'target.common.tests.zip'], 01:17:11 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 01:17:11 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 01:17:11 INFO - u'web-platform': [u'target.common.tests.zip', 01:17:11 INFO - u'target.web-platform.tests.tar.gz'], 01:17:11 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 01:17:11 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 01:17:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.common.tests.zip 01:17:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.common.tests.zip'}, attempt #1 01:17:11 INFO - Fetch https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.common.tests.zip into memory 01:17:13 INFO - Content-Length response header: 72852400 01:17:13 INFO - Bytes received: 72852400 01:17:24 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.talos.tests.zip 01:17:24 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.talos.tests.zip'}, attempt #1 01:17:24 INFO - Fetch https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.talos.tests.zip into memory 01:17:25 INFO - Content-Length response header: 14496472 01:17:25 INFO - Bytes received: 14496472 01:17:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:26 INFO - trying https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.tar.bz2 01:17:26 INFO - Downloading https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 01:17:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 01:17:28 INFO - Downloaded 54199971 bytes. 01:17:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.tar.bz2 01:17:28 INFO - mkdir: /builds/slave/test/properties 01:17:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 01:17:28 INFO - Writing to file /builds/slave/test/properties/build_url 01:17:28 INFO - Contents: 01:17:28 INFO - build_url:https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.tar.bz2 01:17:28 INFO - Running post-action listener: _resource_record_post_action 01:17:28 INFO - Running post-action listener: set_extra_try_arguments 01:17:28 INFO - [mozharness: 2017-09-14 08:17:28.720644Z] Finished download-and-extract step (success) 01:17:28 INFO - [mozharness: 2017-09-14 08:17:28.720809Z] Running populate-webroot step. 01:17:28 INFO - Running pre-action listener: _resource_record_pre_action 01:17:28 INFO - Running main action method: populate_webroot 01:17:28 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 01:17:28 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 01:17:28 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 01:17:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:17:28 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 01:17:28 INFO - 'tests': ['damp', 'tps']}, 01:17:28 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 01:17:28 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 01:17:28 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 01:17:28 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 01:17:28 INFO - 'other-e10s': {'tests': ['a11yr', 01:17:28 INFO - 'ts_paint', 01:17:28 INFO - 'tpaint', 01:17:28 INFO - 'sessionrestore', 01:17:28 INFO - 'sessionrestore_many_windows', 01:17:28 INFO - 'sessionrestore_no_auto_restore', 01:17:28 INFO - 'tabpaint']}, 01:17:28 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 01:17:28 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 01:17:28 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 01:17:28 INFO - 'talos_options': ['--mitmproxy', 01:17:28 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 01:17:28 INFO - '--firstNonBlankPaint'], 01:17:28 INFO - 'tests': ['quantum_pageload_google', 01:17:28 INFO - 'quantum_pageload_youtube', 01:17:28 INFO - 'quantum_pageload_amazon', 01:17:28 INFO - 'quantum_pageload_facebook']}, 01:17:28 INFO - 'quantum-pageload-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 01:17:28 INFO - 'talos_options': ['--stylo', 01:17:28 INFO - '--mitmproxy', 01:17:28 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 01:17:28 INFO - '--firstNonBlankPaint'], 01:17:28 INFO - 'tests': ['quantum_pageload_google', 01:17:28 INFO - 'quantum_pageload_youtube', 01:17:28 INFO - 'quantum_pageload_amazon', 01:17:28 INFO - 'quantum_pageload_facebook']}, 01:17:28 INFO - 'svgr-e10s': {'tests': ['tsvgx', 01:17:28 INFO - 'tsvgr_opacity', 01:17:28 INFO - 'tart', 01:17:28 INFO - 'tscrollx', 01:17:28 INFO - 'cart', 01:17:28 INFO - 'tsvg_static']}, 01:17:28 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 01:17:28 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 01:17:28 INFO - 'talos_options': ['--stylo', 01:17:28 INFO - '--stylo-threads=1', 01:17:28 INFO - '--mitmproxy', 01:17:28 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 01:17:28 INFO - '--firstNonBlankPaint'], 01:17:28 INFO - 'tests': ['tp6_google', 01:17:28 INFO - 'tp6_youtube', 01:17:28 INFO - 'tp6_amazon', 01:17:28 INFO - 'tp6_facebook']}, 01:17:28 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 01:17:28 INFO - 'talos_options': ['--xperf_path', 01:17:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:17:28 INFO - 'tests': ['tp5n']}}} 01:17:28 INFO - Running post-action listener: _resource_record_post_action 01:17:28 INFO - [mozharness: 2017-09-14 08:17:28.737220Z] Finished populate-webroot step (success) 01:17:28 INFO - [mozharness: 2017-09-14 08:17:28.737312Z] Running create-virtualenv step. 01:17:28 INFO - Running pre-action listener: _resource_record_pre_action 01:17:28 INFO - Running main action method: create_virtualenv 01:17:28 INFO - Creating virtualenv /builds/slave/test/build/venv 01:17:28 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 01:17:28 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 01:17:28 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 01:17:28 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 01:17:28 INFO - Using real prefix '/usr' 01:17:28 INFO - New python executable in /builds/slave/test/build/venv/bin/python 01:17:29 INFO - Installing distribute.............................................................................................................................................................................................done. 01:17:31 INFO - Installing pip.................done. 01:17:31 INFO - Return code: 0 01:17:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 01:17:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 01:17:31 INFO - Reading from file tmpfile_stdout 01:17:31 INFO - Output received: 01:17:31 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 01:17:31 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 01:17:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 01:17:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 01:17:31 INFO - Using env: {'DISPLAY': ':0', 01:17:31 INFO - 'HOME': '/home/cltbld', 01:17:31 INFO - 'LANG': 'en_US.UTF-8', 01:17:31 INFO - 'LANGUAGE': 'en_US:en', 01:17:31 INFO - 'LOGNAME': 'cltbld', 01:17:31 INFO - 'MAIL': '/var/mail/cltbld', 01:17:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:31 INFO - 'MOZ_NO_REMOTE': '1', 01:17:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:31 INFO - 'NO_EM_RESTART': '1', 01:17:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:31 INFO - 'PWD': '/builds/slave/test', 01:17:31 INFO - 'SHELL': '/bin/bash', 01:17:31 INFO - 'SHLVL': '1', 01:17:31 INFO - 'TERM': 'linux', 01:17:31 INFO - 'TMOUT': '86400', 01:17:31 INFO - 'USER': 'cltbld', 01:17:31 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:31 INFO - '_': '/tools/buildbot/bin/python'} 01:17:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:31 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 01:17:31 INFO - Cleaning up... 01:17:31 INFO - Return code: 0 01:17:31 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 01:17:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 01:17:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 01:17:31 INFO - Using env: {'DISPLAY': ':0', 01:17:31 INFO - 'HOME': '/home/cltbld', 01:17:31 INFO - 'LANG': 'en_US.UTF-8', 01:17:31 INFO - 'LANGUAGE': 'en_US:en', 01:17:31 INFO - 'LOGNAME': 'cltbld', 01:17:31 INFO - 'MAIL': '/var/mail/cltbld', 01:17:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:31 INFO - 'MOZ_NO_REMOTE': '1', 01:17:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:31 INFO - 'NO_EM_RESTART': '1', 01:17:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:31 INFO - 'PWD': '/builds/slave/test', 01:17:31 INFO - 'SHELL': '/bin/bash', 01:17:31 INFO - 'SHLVL': '1', 01:17:31 INFO - 'TERM': 'linux', 01:17:31 INFO - 'TMOUT': '86400', 01:17:31 INFO - 'USER': 'cltbld', 01:17:31 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:31 INFO - '_': '/tools/buildbot/bin/python'} 01:17:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:31 INFO - Downloading/unpacking psutil>=3.1.1 01:17:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 01:17:33 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:17:33 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:17:33 INFO - Installing collected packages: psutil 01:17:33 INFO - Running setup.py install for psutil 01:17:33 INFO - building 'psutil._psutil_linux' extension 01:17:33 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 01:17:33 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 01:17:33 INFO - building 'psutil._psutil_posix' extension 01:17:33 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 01:17:33 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 01:17:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:17:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:17:34 INFO - Successfully installed psutil 01:17:34 INFO - Cleaning up... 01:17:34 INFO - Return code: 0 01:17:34 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 01:17:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 01:17:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 01:17:34 INFO - Using env: {'DISPLAY': ':0', 01:17:34 INFO - 'HOME': '/home/cltbld', 01:17:34 INFO - 'LANG': 'en_US.UTF-8', 01:17:34 INFO - 'LANGUAGE': 'en_US:en', 01:17:34 INFO - 'LOGNAME': 'cltbld', 01:17:34 INFO - 'MAIL': '/var/mail/cltbld', 01:17:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:34 INFO - 'MOZ_NO_REMOTE': '1', 01:17:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:34 INFO - 'NO_EM_RESTART': '1', 01:17:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:34 INFO - 'PWD': '/builds/slave/test', 01:17:34 INFO - 'SHELL': '/bin/bash', 01:17:34 INFO - 'SHLVL': '1', 01:17:34 INFO - 'TERM': 'linux', 01:17:34 INFO - 'TMOUT': '86400', 01:17:34 INFO - 'USER': 'cltbld', 01:17:34 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:34 INFO - '_': '/tools/buildbot/bin/python'} 01:17:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:35 INFO - Downloading/unpacking mozsystemmonitor==0.3 01:17:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:36 INFO - Downloading mozsystemmonitor-0.3.tar.gz 01:17:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 01:17:36 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 01:17:36 INFO - Installing collected packages: mozsystemmonitor 01:17:36 INFO - Running setup.py install for mozsystemmonitor 01:17:36 INFO - Successfully installed mozsystemmonitor 01:17:36 INFO - Cleaning up... 01:17:36 INFO - Return code: 0 01:17:36 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 01:17:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 01:17:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 01:17:36 INFO - Using env: {'DISPLAY': ':0', 01:17:36 INFO - 'HOME': '/home/cltbld', 01:17:36 INFO - 'LANG': 'en_US.UTF-8', 01:17:36 INFO - 'LANGUAGE': 'en_US:en', 01:17:36 INFO - 'LOGNAME': 'cltbld', 01:17:36 INFO - 'MAIL': '/var/mail/cltbld', 01:17:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:36 INFO - 'MOZ_NO_REMOTE': '1', 01:17:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:36 INFO - 'NO_EM_RESTART': '1', 01:17:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:36 INFO - 'PWD': '/builds/slave/test', 01:17:36 INFO - 'SHELL': '/bin/bash', 01:17:36 INFO - 'SHLVL': '1', 01:17:36 INFO - 'TERM': 'linux', 01:17:36 INFO - 'TMOUT': '86400', 01:17:36 INFO - 'USER': 'cltbld', 01:17:36 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:36 INFO - '_': '/tools/buildbot/bin/python'} 01:17:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:36 INFO - Downloading/unpacking jsonschema==2.5.1 01:17:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:37 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 01:17:37 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 01:17:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:37 INFO - Downloading functools32-3.2.3-2.tar.gz 01:17:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 01:17:38 INFO - warning: no files found matching '*.txt' 01:17:38 INFO - no previously-included directories found matching 'build' 01:17:38 INFO - no previously-included directories found matching 'dist' 01:17:38 INFO - no previously-included directories found matching '.git*' 01:17:38 INFO - Installing collected packages: jsonschema, functools32 01:17:38 INFO - Running setup.py install for functools32 01:17:38 INFO - warning: no files found matching '*.txt' 01:17:38 INFO - no previously-included directories found matching 'build' 01:17:38 INFO - no previously-included directories found matching 'dist' 01:17:38 INFO - no previously-included directories found matching '.git*' 01:17:38 INFO - Successfully installed jsonschema functools32 01:17:38 INFO - Cleaning up... 01:17:38 INFO - Return code: 0 01:17:38 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 01:17:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 01:17:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 01:17:38 INFO - Using env: {'DISPLAY': ':0', 01:17:38 INFO - 'HOME': '/home/cltbld', 01:17:38 INFO - 'LANG': 'en_US.UTF-8', 01:17:38 INFO - 'LANGUAGE': 'en_US:en', 01:17:38 INFO - 'LOGNAME': 'cltbld', 01:17:38 INFO - 'MAIL': '/var/mail/cltbld', 01:17:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:38 INFO - 'MOZ_NO_REMOTE': '1', 01:17:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:38 INFO - 'NO_EM_RESTART': '1', 01:17:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:38 INFO - 'PWD': '/builds/slave/test', 01:17:38 INFO - 'SHELL': '/bin/bash', 01:17:38 INFO - 'SHLVL': '1', 01:17:38 INFO - 'TERM': 'linux', 01:17:38 INFO - 'TMOUT': '86400', 01:17:38 INFO - 'USER': 'cltbld', 01:17:38 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:38 INFO - '_': '/tools/buildbot/bin/python'} 01:17:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:38 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 01:17:38 INFO - Cleaning up... 01:17:38 INFO - Return code: 0 01:17:38 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 01:17:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 01:17:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 01:17:38 INFO - Using env: {'DISPLAY': ':0', 01:17:38 INFO - 'HOME': '/home/cltbld', 01:17:38 INFO - 'LANG': 'en_US.UTF-8', 01:17:38 INFO - 'LANGUAGE': 'en_US:en', 01:17:38 INFO - 'LOGNAME': 'cltbld', 01:17:38 INFO - 'MAIL': '/var/mail/cltbld', 01:17:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:38 INFO - 'MOZ_NO_REMOTE': '1', 01:17:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:38 INFO - 'NO_EM_RESTART': '1', 01:17:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:38 INFO - 'PWD': '/builds/slave/test', 01:17:38 INFO - 'SHELL': '/bin/bash', 01:17:38 INFO - 'SHLVL': '1', 01:17:38 INFO - 'TERM': 'linux', 01:17:38 INFO - 'TMOUT': '86400', 01:17:38 INFO - 'USER': 'cltbld', 01:17:38 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:38 INFO - '_': '/tools/buildbot/bin/python'} 01:17:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:38 INFO - Downloading/unpacking blobuploader==1.2.4 01:17:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:39 INFO - Downloading blobuploader-1.2.4.tar.gz 01:17:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 01:17:39 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 01:17:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 01:17:40 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 01:17:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:40 INFO - Downloading docopt-0.6.1.tar.gz 01:17:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 01:17:40 INFO - Installing collected packages: blobuploader, requests, docopt 01:17:40 INFO - Running setup.py install for blobuploader 01:17:40 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 01:17:40 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 01:17:40 INFO - Running setup.py install for requests 01:17:40 INFO - Running setup.py install for docopt 01:17:40 INFO - Successfully installed blobuploader requests docopt 01:17:40 INFO - Cleaning up... 01:17:40 INFO - Return code: 0 01:17:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:17:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 01:17:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 01:17:40 INFO - Using env: {'DISPLAY': ':0', 01:17:40 INFO - 'HOME': '/home/cltbld', 01:17:40 INFO - 'LANG': 'en_US.UTF-8', 01:17:40 INFO - 'LANGUAGE': 'en_US:en', 01:17:40 INFO - 'LOGNAME': 'cltbld', 01:17:40 INFO - 'MAIL': '/var/mail/cltbld', 01:17:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:40 INFO - 'MOZ_NO_REMOTE': '1', 01:17:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:40 INFO - 'NO_EM_RESTART': '1', 01:17:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:40 INFO - 'PWD': '/builds/slave/test', 01:17:40 INFO - 'SHELL': '/bin/bash', 01:17:40 INFO - 'SHLVL': '1', 01:17:40 INFO - 'TERM': 'linux', 01:17:40 INFO - 'TMOUT': '86400', 01:17:40 INFO - 'USER': 'cltbld', 01:17:40 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:40 INFO - '_': '/tools/buildbot/bin/python'} 01:17:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 01:17:41 INFO - Running setup.py (path:/tmp/pip-Lv_UdW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 01:17:41 INFO - Running setup.py (path:/tmp/pip-TD5Y2o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 01:17:41 INFO - Running setup.py (path:/tmp/pip-S7oSJu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 01:17:41 INFO - Running setup.py (path:/tmp/pip-1AcVgl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 01:17:41 INFO - Running setup.py (path:/tmp/pip-qFM8ia-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 01:17:41 INFO - Running setup.py (path:/tmp/pip-jepAXg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 01:17:41 INFO - Running setup.py (path:/tmp/pip-_AUwNb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 01:17:41 INFO - Running setup.py (path:/tmp/pip-zsALve-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 01:17:41 INFO - Running setup.py (path:/tmp/pip-LED5B_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 01:17:41 INFO - Running setup.py (path:/tmp/pip-OGo73j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 01:17:41 INFO - Running setup.py (path:/tmp/pip-pgb9Ax-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 01:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 01:17:41 INFO - Running setup.py (path:/tmp/pip-ecWICn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 01:17:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 01:17:42 INFO - Running setup.py (path:/tmp/pip-TtWR5_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 01:17:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 01:17:42 INFO - Running setup.py (path:/tmp/pip-Q9NWRk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 01:17:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 01:17:42 INFO - Running setup.py (path:/tmp/pip-hMKmzm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 01:17:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 01:17:42 INFO - Running setup.py (path:/tmp/pip-9S8rAz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 01:17:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 01:17:42 INFO - Running setup.py (path:/tmp/pip-BNPdG6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 01:17:42 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 01:17:42 INFO - Running setup.py install for manifestparser 01:17:42 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 01:17:42 INFO - Running setup.py install for mozcrash 01:17:42 INFO - Running setup.py install for mozdebug 01:17:42 INFO - Running setup.py install for mozdevice 01:17:42 INFO - Installing dm script to /builds/slave/test/build/venv/bin 01:17:42 INFO - Running setup.py install for mozfile 01:17:42 INFO - Running setup.py install for mozhttpd 01:17:42 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Running setup.py install for mozinfo 01:17:43 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Running setup.py install for mozInstall 01:17:43 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Running setup.py install for mozleak 01:17:43 INFO - Running setup.py install for mozlog 01:17:43 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Running setup.py install for moznetwork 01:17:43 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Running setup.py install for mozprocess 01:17:43 INFO - Running setup.py install for mozprofile 01:17:43 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Running setup.py install for mozrunner 01:17:43 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 01:17:43 INFO - Running setup.py install for mozscreenshot 01:17:43 INFO - Running setup.py install for moztest 01:17:44 INFO - Running setup.py install for mozversion 01:17:44 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 01:17:44 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 01:17:44 INFO - Cleaning up... 01:17:44 INFO - Return code: 0 01:17:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:17:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 01:17:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 01:17:44 INFO - Using env: {'DISPLAY': ':0', 01:17:44 INFO - 'HOME': '/home/cltbld', 01:17:44 INFO - 'LANG': 'en_US.UTF-8', 01:17:44 INFO - 'LANGUAGE': 'en_US:en', 01:17:44 INFO - 'LOGNAME': 'cltbld', 01:17:44 INFO - 'MAIL': '/var/mail/cltbld', 01:17:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:44 INFO - 'MOZ_NO_REMOTE': '1', 01:17:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:44 INFO - 'NO_EM_RESTART': '1', 01:17:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:44 INFO - 'PWD': '/builds/slave/test', 01:17:44 INFO - 'SHELL': '/bin/bash', 01:17:44 INFO - 'SHLVL': '1', 01:17:44 INFO - 'TERM': 'linux', 01:17:44 INFO - 'TMOUT': '86400', 01:17:44 INFO - 'USER': 'cltbld', 01:17:44 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:44 INFO - '_': '/tools/buildbot/bin/python'} 01:17:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 01:17:44 INFO - Running setup.py (path:/tmp/pip-HnQo_3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 01:17:44 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 01:17:44 INFO - Running setup.py (path:/tmp/pip-FLTQPU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 01:17:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 01:17:44 INFO - Running setup.py (path:/tmp/pip-hNpNoh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 01:17:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 01:17:44 INFO - Running setup.py (path:/tmp/pip-YtLdbo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 01:17:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 01:17:44 INFO - Running setup.py (path:/tmp/pip-RfuNYy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 01:17:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 01:17:44 INFO - Running setup.py (path:/tmp/pip-zD7HhE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 01:17:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 01:17:44 INFO - Running setup.py (path:/tmp/pip-XydEC5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 01:17:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 01:17:44 INFO - Running setup.py (path:/tmp/pip-niupn2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 01:17:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 01:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 01:17:44 INFO - Running setup.py (path:/tmp/pip-e6f09y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 01:17:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 01:17:45 INFO - Running setup.py (path:/tmp/pip-RUvbp4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 01:17:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 01:17:45 INFO - Running setup.py (path:/tmp/pip-UeSnq_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 01:17:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 01:17:45 INFO - Running setup.py (path:/tmp/pip-HhDhp3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 01:17:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 01:17:45 INFO - Running setup.py (path:/tmp/pip-rjOwLX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 01:17:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 01:17:45 INFO - Running setup.py (path:/tmp/pip-V6I3Ow-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 01:17:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 01:17:45 INFO - Running setup.py (path:/tmp/pip-FMYklb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 01:17:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 01:17:45 INFO - Running setup.py (path:/tmp/pip-VXrEMN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 01:17:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 01:17:45 INFO - Running setup.py (path:/tmp/pip-NAe9K4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 01:17:45 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 01:17:45 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 01:17:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:46 INFO - Downloading blessings-1.6.tar.gz 01:17:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 01:17:46 INFO - Installing collected packages: blessings 01:17:46 INFO - Running setup.py install for blessings 01:17:46 INFO - Successfully installed blessings 01:17:46 INFO - Cleaning up... 01:17:46 INFO - Return code: 0 01:17:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 01:17:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 01:17:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 01:17:47 INFO - Reading from file tmpfile_stdout 01:17:47 INFO - Current package versions: 01:17:47 INFO - argparse == 1.2.1 01:17:47 INFO - blessings == 1.6 01:17:47 INFO - blobuploader == 1.2.4 01:17:47 INFO - docopt == 0.6.1 01:17:47 INFO - functools32 == 3.2.3-2 01:17:47 INFO - jsonschema == 2.5.1 01:17:47 INFO - manifestparser == 1.1 01:17:47 INFO - mozInstall == 1.13 01:17:47 INFO - mozcrash == 1.0 01:17:47 INFO - mozdebug == 0.1 01:17:47 INFO - mozdevice == 0.51 01:17:47 INFO - mozfile == 1.2 01:17:47 INFO - mozhttpd == 0.7 01:17:47 INFO - mozinfo == 0.10 01:17:47 INFO - mozleak == 0.1 01:17:47 INFO - mozlog == 3.5 01:17:47 INFO - moznetwork == 0.27 01:17:47 INFO - mozprocess == 0.25 01:17:47 INFO - mozprofile == 0.28 01:17:47 INFO - mozrunner == 6.13 01:17:47 INFO - mozscreenshot == 0.1 01:17:47 INFO - mozsystemmonitor == 0.3 01:17:47 INFO - moztest == 0.8 01:17:47 INFO - mozversion == 1.4 01:17:47 INFO - psutil == 3.1.1 01:17:47 INFO - requests == 1.2.3 01:17:47 INFO - wsgiref == 0.1.2 01:17:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 01:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 01:17:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 01:17:47 INFO - Using env: {'DISPLAY': ':0', 01:17:47 INFO - 'HOME': '/home/cltbld', 01:17:47 INFO - 'LANG': 'en_US.UTF-8', 01:17:47 INFO - 'LANGUAGE': 'en_US:en', 01:17:47 INFO - 'LOGNAME': 'cltbld', 01:17:47 INFO - 'MAIL': '/var/mail/cltbld', 01:17:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:47 INFO - 'MOZ_NO_REMOTE': '1', 01:17:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:47 INFO - 'NO_EM_RESTART': '1', 01:17:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:47 INFO - 'PWD': '/builds/slave/test', 01:17:47 INFO - 'SHELL': '/bin/bash', 01:17:47 INFO - 'SHLVL': '1', 01:17:47 INFO - 'TERM': 'linux', 01:17:47 INFO - 'TMOUT': '86400', 01:17:47 INFO - 'USER': 'cltbld', 01:17:47 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:47 INFO - '_': '/tools/buildbot/bin/python'} 01:17:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 01:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 01:17:47 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 01:17:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:17:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:17:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 01:17:48 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 01:17:48 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 01:17:48 INFO - Installing collected packages: simplejson 01:17:48 INFO - Running setup.py install for simplejson 01:17:48 INFO - building 'simplejson._speedups' extension 01:17:48 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 01:17:49 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 01:17:49 INFO - Successfully installed simplejson 01:17:49 INFO - Cleaning up... 01:17:49 INFO - Return code: 0 01:17:49 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 01:17:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:17:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:17:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:17:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26531f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x281fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29c2eb0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:17:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 01:17:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 01:17:49 INFO - Using env: {'DISPLAY': ':0', 01:17:49 INFO - 'HOME': '/home/cltbld', 01:17:49 INFO - 'LANG': 'en_US.UTF-8', 01:17:49 INFO - 'LANGUAGE': 'en_US:en', 01:17:49 INFO - 'LOGNAME': 'cltbld', 01:17:49 INFO - 'MAIL': '/var/mail/cltbld', 01:17:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:17:49 INFO - 'MOZ_NO_REMOTE': '1', 01:17:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:17:49 INFO - 'NO_EM_RESTART': '1', 01:17:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:17:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:17:49 INFO - 'PWD': '/builds/slave/test', 01:17:49 INFO - 'SHELL': '/bin/bash', 01:17:49 INFO - 'SHLVL': '1', 01:17:49 INFO - 'TERM': 'linux', 01:17:49 INFO - 'TMOUT': '86400', 01:17:49 INFO - 'USER': 'cltbld', 01:17:49 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:17:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:17:49 INFO - '_': '/tools/buildbot/bin/python'} 01:17:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:17:49 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 01:17:49 INFO - Cleaning up... 01:17:49 INFO - Return code: 0 01:17:49 INFO - Running post-action listener: _resource_record_post_action 01:17:49 INFO - Running post-action listener: _start_resource_monitoring 01:17:49 INFO - Starting resource monitoring. 01:17:49 INFO - [mozharness: 2017-09-14 08:17:49.905726Z] Finished create-virtualenv step (success) 01:17:49 INFO - [mozharness: 2017-09-14 08:17:49.906241Z] Running install step. 01:17:49 INFO - Running pre-action listener: _resource_record_pre_action 01:17:49 INFO - Running main action method: install 01:17:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 01:17:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 01:17:50 INFO - Reading from file tmpfile_stdout 01:17:50 INFO - Detecting whether we're running mozinstall >=1.0... 01:17:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 01:17:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 01:17:50 INFO - Reading from file tmpfile_stdout 01:17:50 INFO - Output received: 01:17:50 INFO - Usage: mozinstall [options] installer 01:17:50 INFO - Options: 01:17:50 INFO - -h, --help show this help message and exit 01:17:50 INFO - -d DEST, --destination=DEST 01:17:50 INFO - Directory to install application into. [default: 01:17:50 INFO - "/builds/slave/test"] 01:17:50 INFO - --app=APP Application being installed. [default: firefox] 01:17:50 INFO - mkdir: /builds/slave/test/build/application 01:17:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 01:17:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 01:18:05 INFO - Reading from file tmpfile_stdout 01:18:05 INFO - Output received: 01:18:05 INFO - /builds/slave/test/build/application/firefox/firefox 01:18:05 INFO - Running post-action listener: _resource_record_post_action 01:18:05 INFO - [mozharness: 2017-09-14 08:18:05.190472Z] Finished install step (success) 01:18:05 INFO - [mozharness: 2017-09-14 08:18:05.190740Z] Running setup-mitmproxy step. 01:18:05 INFO - Running pre-action listener: _resource_record_pre_action 01:18:05 INFO - Running main action method: setup_mitmproxy 01:18:05 INFO - Skipping: mitmproxy is not required 01:18:05 INFO - Running post-action listener: _resource_record_post_action 01:18:05 INFO - [mozharness: 2017-09-14 08:18:05.191873Z] Finished setup-mitmproxy step (success) 01:18:05 INFO - [mozharness: 2017-09-14 08:18:05.192095Z] Running run-tests step. 01:18:05 INFO - Running pre-action listener: _resource_record_pre_action 01:18:05 INFO - Running pre-action listener: _set_gcov_prefix 01:18:05 INFO - Running main action method: run_tests 01:18:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 01:18:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 01:18:05 INFO - Python 2.7.3 01:18:05 INFO - Return code: 0 01:18:05 INFO - grabbing minidump binary from tooltool 01:18:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 01:18:05 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0050>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c0f50>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29c13e0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 01:18:05 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 01:18:05 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 01:18:05 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 01:18:05 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 01:18:05 INFO - Return code: 0 01:18:05 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 01:18:05 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 01:18:05 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 01:18:05 INFO - ENV: RUST_BACKTRACE is now 1 01:18:05 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 01:18:05 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 01:18:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 01:18:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-061 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 01:18:05 INFO - Using env: {'DISPLAY': ':0', 01:18:05 INFO - 'HOME': '/home/cltbld', 01:18:05 INFO - 'LANG': 'en_US.UTF-8', 01:18:05 INFO - 'LANGUAGE': 'en_US:en', 01:18:05 INFO - 'LOGNAME': 'cltbld', 01:18:05 INFO - 'MAIL': '/var/mail/cltbld', 01:18:05 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 01:18:05 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 01:18:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:18:05 INFO - 'MOZ_NO_REMOTE': '1', 01:18:05 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 01:18:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:18:05 INFO - 'NO_EM_RESTART': '1', 01:18:05 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:18:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 01:18:05 INFO - 'PWD': '/builds/slave/test', 01:18:05 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 01:18:05 INFO - 'RUST_BACKTRACE': '1', 01:18:05 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 01:18:05 INFO - 'SHELL': '/bin/bash', 01:18:05 INFO - 'SHLVL': '1', 01:18:05 INFO - 'TERM': 'linux', 01:18:05 INFO - 'TMOUT': '86400', 01:18:05 INFO - 'USER': 'cltbld', 01:18:05 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794', 01:18:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:18:05 INFO - '_': '/tools/buildbot/bin/python'} 01:18:05 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 01:18:05 INFO - mozversion application_buildid: 20170914070856 01:18:05 INFO - mozversion application_changeset: 1c08a2f4d2fc14e2a88915a2bd8f033f04c058ab 01:18:05 INFO - mozversion application_display_name: Firefox 01:18:05 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 01:18:05 INFO - mozversion application_name: Firefox 01:18:05 INFO - mozversion application_remotingname: firefox 01:18:05 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 01:18:05 INFO - mozversion application_vendor: Mozilla 01:18:05 INFO - mozversion application_version: 56.0 01:18:05 INFO - mozversion platform_buildid: 20170914070856 01:18:05 INFO - mozversion platform_changeset: 1c08a2f4d2fc14e2a88915a2bd8f033f04c058ab 01:18:05 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 01:18:05 INFO - mozversion platform_version: 56.0 01:18:05 INFO - using testdate: 1505377085 01:18:05 INFO - actual date: 1505377085 01:18:05 INFO - starting webserver on 'localhost:53400' 01:18:05 INFO - SUITE-START | Running 2 tests 01:18:05 INFO - TEST-START | dromaeo_css 01:18:05 INFO - Initialising browser for dromaeo_css test... 01:18:05 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:53400/getInfo.html -profile /tmp/tmpZcPJtO/profile 01:18:05 INFO - TEST-INFO | started process 16138 (/builds/slave/test/build/application/firefox/firefox http://localhost:53400/getInfo.html) 01:18:11 INFO - TEST-INFO | 16138: exit 0 01:18:11 INFO - Browser initialized. 01:18:11 INFO - Running cycle 1/1 for dromaeo_css test... 01:18:11 INFO - TEST-INFO | started process 16298 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZcPJtO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 01:18:22 INFO - PID 16298 | RSS: Main: 151564288 01:18:22 INFO - PID 16298 | 01:21:20 INFO - PID 16298 | Cycle 1(1): loaded http://localhost:53400/tests/dromaeo/cssquery-dojo.html (next: http://localhost:53400/tests/dromaeo/cssquery-ext.html) 01:21:21 INFO - PID 16298 | RSS: Main: 161550336 01:21:21 INFO - PID 16298 | 01:24:23 INFO - PID 16298 | Cycle 1(1): loaded http://localhost:53400/tests/dromaeo/cssquery-ext.html (next: http://localhost:53400/tests/dromaeo/cssquery-jquery.html) 01:24:23 INFO - PID 16298 | RSS: Main: 157601792 01:24:23 INFO - PID 16298 | 01:27:25 INFO - PID 16298 | Cycle 1(1): loaded http://localhost:53400/tests/dromaeo/cssquery-jquery.html (next: http://localhost:53400/tests/dromaeo/cssquery-mootools.html) 01:27:25 INFO - PID 16298 | RSS: Main: 159485952 01:27:25 INFO - PID 16298 | 01:30:27 INFO - PID 16298 | Cycle 1(1): loaded http://localhost:53400/tests/dromaeo/cssquery-mootools.html (next: http://localhost:53400/tests/dromaeo/cssquery-prototype.html) 01:30:28 INFO - PID 16298 | RSS: Main: 159215616 01:30:28 INFO - PID 16298 | 01:33:31 INFO - PID 16298 | Cycle 1(1): loaded http://localhost:53400/tests/dromaeo/cssquery-prototype.html (next: http://localhost:53400/tests/dromaeo/cssquery-yui.html) 01:33:31 INFO - PID 16298 | RSS: Main: 161017856 01:33:31 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | Cycle 1(1): loaded http://localhost:53400/tests/dromaeo/cssquery-yui.html (next: http://localhost:53400/tests/dromaeo/cssquery-dojo.html) 01:36:33 INFO - PID 16298 | RSS: Main: 164507648 01:36:33 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | __start_tp_report 01:36:33 INFO - PID 16298 | _x_x_mozilla_page_load 01:36:33 INFO - PID 16298 | _x_x_mozilla_page_load_details 01:36:33 INFO - PID 16298 | |i|pagename|runs| 01:36:33 INFO - PID 16298 | |0;dojo.html;3539.8407071681772;3603.9639603603955;3606.7475276730625;3629.9092522686938;3642.4354225095103;6411.455026322768;6457.483401327889;6464.773732919349;6519.771807986722;6528.6409247491365;6445.613263204211;6477.74089036438;6524.282328943812;6548.377904099127;6552.836179095537;5592.944070559303;5622.100463925773;5669.121286200625;5685.147227915825;5702.686352250625;5607.214989901417;5613.66318020918;5661.716914154275;5685.346185188694;5693.601447898649;5509.834704958857;5564.4991950724425;5582.441755824426;5643.463870932275;5655.717214139277;5589.608727389084;5649.604527683064;5657.038303488375;5661.433856614347;5713.971430142823;5652.491275785199;5658.85852853682;5709.172170035322;5715.828525144252;5724.456176663252;6321.431071203614;6349.873002539969;6382.712777924958;6443.774467893648;6458.095866578683;6936.687849046805;6941.409980151693;6956.026156338116;6965;6993.195782484978;7012.649367531603;7022.016917631536;7064.187618423895;7087.787366379017;7088.326608972139;6456.225252969673;6503.15458990333;6526.151600291979;6565.212174539086;6574.901376479356;7190.568565886064;7195.424366050704;7249.383802376857;7268.23683513234;7271.781846544613;6860.176778786577;6864.828379290458;6931.09895713554;6933.168019837551;6940.757073502403;6876.449884009267;6952.965235173791;6955.339242771928;7007.299270072952;7009.12385951756;6890.552114112566;6919.308069193141;6922.688479018456;6937.063496427918;6946.409555187764;6903.6203008835;6905.689243984033;6927.515073944775;7000.61496617691;7002.649867506604;5084.7966081356335;5099.847004589868;5126.051680439131;5128.589712822965;5152.278680984665;4549.27211646135;4574.656900732459;4591.242444996538;4599.8390056348535;4601.67788254819;6586.769463068769;6591.538592298493;6665.733370665216;6669.166354205724;6690.19717633887;6903.447724182053;6948.652567371611;7005.054317667152;7024.262452442522;7042.964785176041;6521.543491955613;6532.608043517404;6626.503012274099;6634.237062737847;6649.168853893263;5538.501534861882;5668.234788303526;5681.034224181899;5747.6838773867;5754.021816291241;7087.043249161297;7114.857702845914;7134.072570565793;7204.3155900189395;7258.673359698826;6897.206821215625;6953.096097507291;6990.755323563651;7010.894836577558;7016.789496315017;7019.894701579378;7142.285771422816;7148.821279468055;7210.459215558749;7212.134543854771;6815.693293801692;6815.829604259933;6926.619035953071;6927.618980956096;6961.756338528127;7025.894611580932;7062.540934839219;7089.751858684921;7096.503244772816;7104.680289387094;6763.222229443677;6773.93226067733;6845.897311540431;6846.383825455733;6853.657317134223;6593.868122637617;6707.195136583641;6715.05989161508;6725.0248713935225;6737.663116844236;6667.566608170453;6710.463162946855;6723.932760672331;6797.592144471348;6824.454043676593;6815.045893575003;6843.726250949906;6896.27589103137;6901.206361268519;6916;6625.834354141185;6631.867362652816;6649.767258145942;6710;6710.66446677674 01:36:33 INFO - PID 16298 | |1;ext.html;911.6080085563206;917.1607978699491;948.3788118782198;960.0879164793448;970.6893793985919;43903;44502.33246501305;44627.33059004109;44665;44836.103277934424;41763.79118104405;41867;41952.16095678085;42013.789931050305;42352.36471452931;7174.24670409606;7286.81782955425;7287.161976372706;7330.486865919388;7344.30229128232;7008.789736307919;7034.296570342976;7063.117110361205;7068.293170682942;7100.041494398268;7922.9603851980655;8137.430379873411;8147.918520814776;8162.347012239006;8163.652997255445;8099.230573095576;8128.878066829002;8157.877631835528;8194.877076843852;8199.7290419985;8061.95969020157;8137.877931831027;8151.918480815235;8158.632861521246;8164.183581641848;42165;42589.57410425887;42599.36100958488;42645.36031959523;42713;3664.193877346979;3723.925521489555;3723.9945214792124;3731.2164445466483;3737.8691745789038;33291.500627490605;33551.664483355096;33769.15577110592;33800.661993379996;33875.32249354999;5158.509941555546;5316.229146773735;5375.462453754632;5389.676619402849;5397.325334333208;204914;207123;218400;219080;255090.99999999814;55551.72224138853;56122;56189.71905140448;56228.15657765137;56273;57044.714776426685;57105;57467.712661436424;57498;57629.13556296659;14772.187529685756;14826.40694372213;14897.627559311104;14906.25468726581;15100.697986040217;11868.109891758153;11900.047996160287;11904.940475297568;11915.642530724092;11916.285022898654;15467.690646187239;15538;15695.215239237992;15724.764128538081;15802.841971580137;6108.007076532556;6134.5092392608485;6224.190855188796;6299.716512756845;6330.987042073246;1091.7543552700579;1107.4684151607112;1108.833674948748;1113.4210210690396;1119.7928383249125;24213.273601791974;24328.391790205387;24369.39076523101;24472.632910506356;24565.385865353153;1231.6982339326744;1239.2502535965791;1239.962801115968;1243.5523211643801;1245.439552201513;13182.274974876475;13216.471341146247;13399.464021439228;13421.39603717835;17547.73678394825;299707;302037;302057;302953;303455;66838.33161668418;67098.66450667716;67134;67510.66244668844;67637;1515.7877897094415;1523.6800271943016;1572.207683241106;1579.3603590545847;1583.7804890234454;30093.69906300909;30234.697653024068;30455;30479;30810.69189308078;42698.35952460654;42930.78534607307;42950.140997180504;42976;43083.569164307955;251998;253930;253978;255676;255756;37313.62686373101;41181;41346.96632584209;41608.58391416168;41826.79086604548;50773;51330.48669513257;51547.742261288455;51640.74179629078;51675;37344.6265537352;37358;37579.624203757616;37698;37764.43353349757;36493.63506365009;36535;37151.62848371482;37442;37671;42344.36483452689;43626.56373436225;43864;44111.77944110259;44153.77923110364;35662;35663.46504802482;35773.821130894175;36012.4598131023;36456.63543364532;25681.22956311314;25696.871515642302;26024.479510410063;26098.60852087182;26416.339591509597 01:36:33 INFO - PID 16298 | |2;jquery.html;602.6986506746626;607.7751232044144;609.2536642612799;612.6416046612732;629.1035274733505;24040.03839846404;24868.50262994739;24899.875500622493;24904.626430603512;24969;25060;26072.871255449325;26222.082227122053;26235.606465903027;26346.868265658693;6432.356764323554;6549.050387693782;6563;6568.671566421684;6572.769953051644;6536.934630653704;6606.339366063403;6653.866922661544;6804.795856124324;6830.146231721035;6782;6792.898106528406;6796.7621133260345;6829.385355318021;6833.4191593714595;6776.457883369319;6777.491688123386;6778.593284402927;6789.558678685869;6792.117024786796;6267.655278959655;6299.811005669837;6310.274318453391;6329.208848893888;6337.746490140389;31278.530822037686;31588.842055789573;31705;31768;32262.838685806655;2222.8777417242045;2263.8302127340353;2263.852849564773;2264.2641141629038;2265.1166045242367;19997.400077997685;20401.183952641877;20507.077181526867;20577.69133462999;20591.382258532118;2392.572786099821;2395.293388450394;2462.18747813223;2544.821862469628;2551.795856331489;133636;139780.30109849488;148751;149769;153850.46149538472;15377.155711072231;16608.00351978885;16641.583960401087;16645;17103.914480427517;25212.747872521406;25307;25335.746642533708;25358.873205634223;25412.491750164892;10182.134518565857;10293.279470436997;10300;10423.583056677648;10434.895651043393;9273.397229180082;9359.34484586086;9363.859542106873;9397.953010234905;9490.667826626035;9799.216062714966;9806.362586431858;9906.504674766376;10273.691789246335;10274.486275686186;2769.4599553086955;2847.601335812988;2874.453853767777;2878.654561452639;2944.3816798472562;1064.3188359449957;1077.7521170130915;1079.379356869803;1082.967510974672;1087.9619213327496;20938;20987.58024839495;21555.67666485004;21668.24161154352;21928.561428771336;1107.9002889739802;1117.273772048159;1124.1175677093606;1131.2477202660139;1150.3500522204927;11520.539178432937;11907.285562866082;11939.343336116597;12035.75928481443;12057.51769929193;555214;561706;563693;572025;596040;117758;119322;120499;121335.39332303283;121570;1245.9501619935281;1254.1221145198397;1281.814136950137;1287.549357724789;1293.3768121008075;19238.23047078101;19271.22915083381;19516.707249390987;19651.606967860847;19664;61404;61696.69151654213;61897;62221.688891555255;63125.36874631195;75015;75533.622331888;76113.61943190248;76371;77353.61323193349;14859.628509286922;14931.776023359442;14971.877109216635;15175.696486070437;15266.77099843481;23640.408989775395;23730.88134559385;23830.642540362256;23848.642270366305;23982.640260395758;18357.908210458863;18628.348007819663;18728.812711872706;19108.52228694238;19494.31769888047;15221;15749.370025199321;15981.520554383387;16698.165091745606;16755.581110472336;19067;19847.60304793925;19947.301844435955;20039.499012524804;20089.799102008794;14980.925095374454;15007.099574025593;15054.247287635793;15143.469978550698;15152.924235378752;19378.127984241026;19441.31955381555;19605.411837644893;19607;19627.901860490605 01:36:33 INFO - PID 16298 | |3;mootools.html;1479.2381923309495;1515.7120147172036;1531.3185632393574;1548.3032635314119;1549.7985261915946;15692.607684807885;16350.918245408786;16367.754483682724;16369.590760231;16372.918135409322;16017.279222434989;17139.228734706936;17148.056856872867;17177.141142942834;17194.656106877886;3061.785675002751;3063.4638938185726;3124.468840297155;3124.6875312468796;3125.249940014403;2952.8818847246084;3002.549617557362;3029.666736658966;3036.0436462514235;3039.4377040247514;3106.565080888666;3114.890978815742;3127.093142988542;3133.639631442379;3141.7643676724224;2941.2940894185454;2950.7786915981387;2959.215807810932;2969.2873710309586;2992.895248666297;2951.1294168220425;2969;3000.639923209229;3012.653544842349;3015.8190508569555;15764.132972686497;15930.283137258735;16036.919815400965;16037.438689645807;16061.759073613905;8336.374771892133;8628.784280392978;8650.524221167832;8679.739607811776;8705.303575713928;5917.733701983421;6043.244594425697;6151.507879369639;6152.261728592553;6295.307516173218;1929.324736342269;1953.2187125150053;1971.4874132725452;1989.910454029572;2011.8189362957405;28053.71946280552;28314.85842570774;28343;28359.149225523266;28452.146435606966;7554.357879580188;7604.125525564631;7620.771376858703;7706.614669266514;7749.186335434698;18703.906480467784;18884.716729249074;18908.527286817938;18919.43241702751;18946.147423365983;7829.960850195713;8262.380321475794;8296.087430382653;8297.377696672773;8298.460600060977;7362.889556656654;7534.510256833289;7590.8861367079535;7619.542827430372;7660.425468089916;5435.42927992563;5545.140503221926;5708.286464191976;5846.795362162389;5850.502707269845;1656.9254383552768;1668.0908904646997;1668.6829502394505;1719.406804652393;1724.9137543123045;982.5725809272989;1010.3382284603597;1017.7862648843677;1026.9229807764448;1035.9689209323733;9273.397229180082;9377.275493002715;9601.135897769234;9622.326437149331;9728.562214700214;1072.3137192197;1079.5803518373314;1082.3614067700096;1086.1039642295138;1109.8501702270253;5383.596230282745;5477.808276710296;5727.341355744143;5806.970965145148;5829.183914252008;23394.53210935772;24037;24104.397390065387;24127.879360603085;24327;22056.669149962763;23037.654435183485;23463.648045279333;23464.530709385715;23559.175428859908;12221.69445763863;12326.383680815923;12390.380480976095;12434.937825310815;12516.31160286193;9499.667511637335;9825;9959.601615935282;9991.800163996824;10073.748156295858;19975.700364494835;20179.293724719566;20180;20430.795692042888;20545.075471604112;20760.273390431263;21030.894845525676;21288.25491107804;21295.574088518453;21646.891765541073;12714.61856144317;12763.93618031941;12816.871831281567;12863.163894346837;12903.612891613267;13451.865481345452;13725.656858578615;14561.781573276621;14619.853801462275;14807.703845923237;11792.233504822503;12206.572769953009;12300.938495307824;12399.628011159679;12505.437255323714;11772.941135294268;11810.409479525817;12170.878291217328;12209.816852747394;12320.75358492843;10657.946710266398;10924.945375273073;10932.125429965743;10933.671989840317;10944.726381840517;8246.587670616565;8253.298469629908;8267.379946504156;8338.958305208678;8418.116097809641;8383.119772423808;8441.155884411755;8538.188872057144;8598.570071496275;8615.956920215358 01:36:33 INFO - PID 16298 | |4;prototype.html;535.1090434426678;536.1582315764249;555.1561626327981;557.7824648387127;557.8856334451438;6247.968760156198;6316.526260530456;6320.778772742955;6335.054199797093;6339.207599050119;6014.188084608588;6119.357467465908;6148.877022459559;6178.938210617893;6238.656873871935;4846.466888642247;4867.707937523742;4879.170541008037;4886.096072226632;4904.485029071931;4858.275312264148;4891.706497610155;4893.8776530586665;4915.680480768757;4949.901001979958;4737.73942433166;4852.636052296092;4861.416630004387;4877.365942427479;4883.462819089915;4859.368282123319;4863.392075990501;4877.170880950247;4892.828750993698;4940.925886111711;4452.777361131963;4463.107378524276;4463.642908567307;4477.440319960005;4479.3057076153245;6110;6123.601965872204;6144.78493252734;6157.7806415520645;6158.507319414436;5896.793612223594;5905.29136503618;5930.021546444831;5940.524758019391;5959.135925290809;6569.605823650596;6572.86854262912;6628.5691430056895;6640.535162538624;6703.960886062668;4968.205087186033;4986.351774269358;5027.974860125712;5061.746912654389;5085.8728531787;6903.406253121576;6989.4408447324095;7007.159140903073;7052.224255331909;7064.081669382998;5151;5155.896882062413;5157.716325602128;5208.65077660158;5250.65870718402;5257.605679574047;5275.942382470839;5288.180332048539;5309.41596424393;5341.145416733304;5821.27234095738;5840.2115714378015;5876.44173803488;5878.118282257696;5882.323532793698;6489.3510648934725;6537.723785166294;6559.934400656028;6568.6058836469965;6576;1729.9481015569554;1765.6645237404853;1774.6539424812295;1783.6611043901617;1791.4536066499843;1271.675722690708;1274.3819247664876;1279.9040071994639;1280.5454063807401;1283.1595305075004;6317.399082523009;6345.49236061114;6352.841178970562;6365.326562843617;6399.296077431479;6605.867882642417;6640.302768209269;6695;6765.898511522331;6780.694868730919;6288.585068359674;6304;6371.139896114058;6380.744770209232;6403.551751377358;3549.769264997767;3559.1458050068313;3580.838862251205;3584.534010578608;3607.621199773986;6920.204176519664;6986;6988.895166572505;7065.293470652894;7072;6918.82379995392;6947.444204463631;6949.7567585134275;6975.546589471668;6999.475039372068;6923.165361179191;6990.860182796418;7032.830869311052;7069.116360454943;7080.575165490087;6726.461883049246;6727.966360168168;6792.626405547742;6799.558028728315;6808.897866532105;6622.377517508241;6677.53094319249;6690.45762610205;6715.865682686416;6749.426298764463;6944.305569443015;6987.545809522365;7006.264342244195;7031.261717519586;7044.718211271492;5177.792888284577;5191.118928994444;5201.765920533509;5212.791488340576;5228.7973766033265;6699.464042876656;6797.1843378794865;6817.863642727217;6839.213490448463;6892.862142757217;6529.249136349381;6549.901751473636;6609;6654.966725166343;6696.5647232929705;6340.1181090559085;6559.229008167863;6584.50616203777;6595.571287866273;6633.535652504278;6273.780417685359;6411.519136064907;6463.967680161569;6498.610083395011;6547.345265473415;6559.8032059038305;6627.50293727982;6652.168478940132;6682.498812588978;6684.192639091496;6343.9682801585695;6360.996286169841;6411.839704007437;6556.901791426698;6558.376954189344 01:36:33 INFO - PID 16298 | |5;yui.html;953.790166163444;964.127464644497;976.4678250353556;994.2642444590996;997.8602995580618;19309.613807723836;19648;19659;19676.606467870635;23829.165979190733;20495.282665106723;20554.177832886704;21344.786552134512;21369.252076177338;21394.35816925491;1049.1711547877187;1090.1115590793518;1092.4155576766432;1094.1738987064755;1097.5938902606047;1046.3251202974077;1067.2422579968193;1079.1636481726646;1089.7548051688386;1092.6995076353987;1144;1144.3362849547243;1145.0953746540224;1145.2212495503054;1146.9942650286737;1135.9545618175264;1137.181229514748;1138.1577632551935;1139.1399493382485;1139.1797905508063;835.7534527314457;839.5382539603194;840.5419046619606;841.1882533355341;841.1966571923798;18322.541936451562;18413.35553255643;20444.182232710675;20453.693194602092;20637.4840628984;20834;21060;21225.787742122535;21477;21501.784982150133;16384.83615163845;16501.422450214184;16537.255823487973;16648.83351166485;16888.15559222034;3775.263823554408;3808.2954653388933;3823.541175058983;3824.4836947012077;3824.8470061197795;134430;135490.32254838664;136377;136741;139130;16533;16601.169941502878;16970.745438818427;17025.40411085606;17043.744343834853;32971.50542741813;33265.00204993854;33427;33655.99032029043;33929.66070339265;7872.842543149105;7917.485363451357;9226.169644732006;9534.856977145348;9552.713418597454;4584.083183363341;4692.5307469253485;4694.929576056362;4703.741294228782;4710.717356958594;5700.714964251771;5807.970960145257;6415.748928958808;6596.208454985433;6632.403083722392;1226.7669142862828;1258.6916205529703;1265.1460264321547;1267.1636719765095;1279.0662816144081;765.3876898481193;766.0654002117519;784.0473824303499;787.1577412169039;787.7006737439737;13031.283279419533;13403.664908377368;13680.726385472235;13782.793258101137;13882;763.4312437234184;773.2344978471273;780.2470615855726;782.8082119880552;803.4737247103157;6007.928790485434;6334.271558770801;6395.872082558323;6402.519811014193;6495.058216558573;121940.34178974468;122615.38692306481;124564;125600;127533;108254.45872770586;109922;110009.44995274972;112157.95289212005;113211;97039;97098.51450742701;97160.51419742857;97415;99011.50494247483;13184.736305274033;13240.470381184645;13407.731845362843;13491.662708432368;13508.121972071784;45566.31650525311;45648;46392.76803615961;48198.759006204746;48869.2669609949;59326.70336648289;59498.40501594928;59560.70219648874;59608.70195648994;62676.05985910124;18837.434876953714;20095.59808803845;20778;20886.268980585606;20944.37166884996;22443.21448749286;22557.774422255567;22658.320250392513;22887.656685149403;23198;20880.060397281854;21174.153033879087;21515.139394424048;21599.784002159777;21710.131594736034;20792.896035519727;21117.155313787276;21164.04761785754;21461.248856289956;21612;20874;21297.6805347923;21412.785872141078;21863.890680546494;21917.123315067856;15111.924440377728;15310.617234569225;15442.536723898302;16042.839571604134;16091.356345746039;15410.922945385202;15692.372305107669;15906.363745450515;16153.59616009609;16306.755398669267 01:36:33 INFO - PID 16298 | __end_tp_report 01:36:33 INFO - PID 16298 | __start_cc_report 01:36:33 INFO - PID 16298 | _x_x_mozilla_cycle_collect,289 01:36:33 INFO - PID 16298 | __end_cc_report 01:36:33 INFO - PID 16298 | __startTimestamp1505378193826__endTimestamp 01:36:33 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | ------- Summary: start ------- 01:36:33 INFO - PID 16298 | Number of tests: 6 01:36:33 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | [#0] dojo.html Cycles:165 Average:6405.40 Median:6710.46 stddev:820.10 (12.2%) stddev-sans-first:791.20 01:36:33 INFO - PID 16298 | Values: 3539.8 3604.0 3606.7 3629.9 3642.4 6411.5 6457.5 6464.8 6519.8 6528.6 6445.6 6477.7 6524.3 6548.4 6552.8 5592.9 5622.1 5669.1 5685.1 5702.7 5607.2 5613.7 5661.7 5685.3 5693.6 5509.8 5564.5 5582.4 5643.5 5655.7 5589.6 5649.6 5657.0 5661.4 5714.0 5652.5 5658.9 5709.2 5715.8 5724.5 6321.4 6349.9 6382.7 6443.8 6458.1 6936.7 6941.4 6956.0 6965.0 6993.2 7012.6 7022.0 7064.2 7087.8 7088.3 6456.2 6503.2 6526.2 6565.2 6574.9 7190.6 7195.4 7249.4 7268.2 7271.8 6860.2 6864.8 6931.1 6933.2 6940.8 6876.4 6953.0 6955.3 7007.3 7009.1 6890.6 6919.3 6922.7 6937.1 6946.4 6903.6 6905.7 6927.5 7000.6 7002.6 5084.8 5099.8 5126.1 5128.6 5152.3 4549.3 4574.7 4591.2 4599.8 4601.7 6586.8 6591.5 6665.7 6669.2 6690.2 6903.4 6948.7 7005.1 7024.3 7043.0 6521.5 6532.6 6626.5 6634.2 6649.2 5538.5 5668.2 5681.0 5747.7 5754.0 7087.0 7114.9 7134.1 7204.3 7258.7 6897.2 6953.1 6990.8 7010.9 7016.8 7019.9 7142.3 7148.8 7210.5 7212.1 6815.7 6815.8 6926.6 6927.6 6961.8 7025.9 7062.5 7089.8 7096.5 7104.7 6763.2 6773.9 6845.9 6846.4 6853.7 6593.9 6707.2 6715.1 6725.0 6737.7 6667.6 6710.5 6723.9 6797.6 6824.5 6815.0 6843.7 6896.3 6901.2 6916.0 6625.8 6631.9 6649.8 6710.0 6710.7 01:36:33 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | [#1] ext.html Cycles:180 Average:44609.59 Median:39472.72 stddev:68202.97 (172.8%) stddev-sans-first:68315.38 01:36:33 INFO - PID 16298 | Values: 911.6 917.2 948.4 960.1 970.7 43903.0 44502.3 44627.3 44665.0 44836.1 41763.8 41867.0 41952.2 42013.8 42352.4 7174.2 7286.8 7287.2 7330.5 7344.3 7008.8 7034.3 7063.1 7068.3 7100.0 7923.0 8137.4 8147.9 8162.3 8163.7 8099.2 8128.9 8157.9 8194.9 8199.7 8062.0 8137.9 8151.9 8158.6 8164.2 42165.0 42589.6 42599.4 42645.4 42713.0 3664.2 3723.9 3724.0 3731.2 3737.9 33291.5 33551.7 33769.2 33800.7 33875.3 5158.5 5316.2 5375.5 5389.7 5397.3 204914.0 207123.0 218400.0 219080.0 255091.0 55551.7 56122.0 56189.7 56228.2 56273.0 57044.7 57105.0 57467.7 57498.0 57629.1 14772.2 14826.4 14897.6 14906.3 15100.7 11868.1 11900.0 11904.9 11915.6 11916.3 15467.7 15538.0 15695.2 15724.8 15802.8 6108.0 6134.5 6224.2 6299.7 6331.0 1091.8 1107.5 1108.8 1113.4 1119.8 24213.3 24328.4 24369.4 24472.6 24565.4 1231.7 1239.3 1240.0 1243.6 1245.4 13182.3 13216.5 13399.5 13421.4 17547.7 299707.0 302037.0 302057.0 302953.0 303455.0 66838.3 67098.7 67134.0 67510.7 67637.0 1515.8 1523.7 1572.2 1579.4 1583.8 30093.7 30234.7 30455.0 30479.0 30810.7 42698.4 42930.8 42950.1 42976.0 43083.6 251998.0 253930.0 253978.0 255676.0 255756.0 37313.6 41181.0 41347.0 41608.6 41826.8 50773.0 51330.5 51547.7 51640.7 51675.0 37344.6 37358.0 37579.6 37698.0 37764.4 36493.6 36535.0 37151.6 37442.0 37671.0 42344.4 43626.6 43864.0 44111.8 44153.8 35662.0 35663.5 35773.8 36012.5 36456.6 25681.2 25696.9 26024.5 26098.6 26416.3 01:36:33 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | [#2] jquery.html Cycles:180 Average:38146.63 Median:2264.69 stddev:95302.53 (4208.2%) stddev-sans-first:95528.18 01:36:33 INFO - PID 16298 | Values: 602.7 607.8 609.3 612.6 629.1 24040.0 24868.5 24899.9 24904.6 24969.0 25060.0 26072.9 26222.1 26235.6 26346.9 6432.4 6549.1 6563.0 6568.7 6572.8 6536.9 6606.3 6653.9 6804.8 6830.1 6782.0 6792.9 6796.8 6829.4 6833.4 6776.5 6777.5 6778.6 6789.6 6792.1 6267.7 6299.8 6310.3 6329.2 6337.7 31278.5 31588.8 31705.0 31768.0 32262.8 2222.9 2263.8 2263.9 2264.3 2265.1 19997.4 20401.2 20507.1 20577.7 20591.4 2392.6 2395.3 2462.2 2544.8 2551.8 133636.0 139780.3 148751.0 149769.0 153850.5 15377.2 16608.0 16641.6 16645.0 17103.9 25212.7 25307.0 25335.7 25358.9 25412.5 10182.1 10293.3 10300.0 10423.6 10434.9 9273.4 9359.3 9363.9 9398.0 9490.7 9799.2 9806.4 9906.5 10273.7 10274.5 2769.5 2847.6 2874.5 2878.7 2944.4 1064.3 1077.8 1079.4 1083.0 1088.0 20938.0 20987.6 21555.7 21668.2 21928.6 1107.9 1117.3 1124.1 1131.2 1150.4 11520.5 11907.3 11939.3 12035.8 12057.5 555214.0 561706.0 563693.0 572025.0 596040.0 117758.0 119322.0 120499.0 121335.4 121570.0 1246.0 1254.1 1281.8 1287.5 1293.4 19238.2 19271.2 19516.7 19651.6 19664.0 61404.0 61696.7 61897.0 62221.7 63125.4 75015.0 75533.6 76113.6 76371.0 77353.6 14859.6 14931.8 14971.9 15175.7 15266.8 23640.4 23730.9 23830.6 23848.6 23982.6 18357.9 18628.3 18728.8 19108.5 19494.3 15221.0 15749.4 15981.5 16698.2 16755.6 19067.0 19847.6 19947.3 20039.5 20089.8 14980.9 15007.1 15054.2 15143.5 15152.9 19378.1 19441.3 19605.4 19607.0 19627.9 01:36:33 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | [#3] mootools.html Cycles:180 Average:10211.31 Median:23798.09 stddev:7206.72 (30.3%) stddev-sans-first:7197.07 01:36:33 INFO - PID 16298 | Values: 1479.2 1515.7 1531.3 1548.3 1549.8 15692.6 16350.9 16367.8 16369.6 16372.9 16017.3 17139.2 17148.1 17177.1 17194.7 3061.8 3063.5 3124.5 3124.7 3125.2 2952.9 3002.5 3029.7 3036.0 3039.4 3106.6 3114.9 3127.1 3133.6 3141.8 2941.3 2950.8 2959.2 2969.3 2992.9 2951.1 2969.0 3000.6 3012.7 3015.8 15764.1 15930.3 16036.9 16037.4 16061.8 8336.4 8628.8 8650.5 8679.7 8705.3 5917.7 6043.2 6151.5 6152.3 6295.3 1929.3 1953.2 1971.5 1989.9 2011.8 28053.7 28314.9 28343.0 28359.1 28452.1 7554.4 7604.1 7620.8 7706.6 7749.2 18703.9 18884.7 18908.5 18919.4 18946.1 7830.0 8262.4 8296.1 8297.4 8298.5 7362.9 7534.5 7590.9 7619.5 7660.4 5435.4 5545.1 5708.3 5846.8 5850.5 1656.9 1668.1 1668.7 1719.4 1724.9 982.6 1010.3 1017.8 1026.9 1036.0 9273.4 9377.3 9601.1 9622.3 9728.6 1072.3 1079.6 1082.4 1086.1 1109.9 5383.6 5477.8 5727.3 5807.0 5829.2 23394.5 24037.0 24104.4 24127.9 24327.0 22056.7 23037.7 23463.6 23464.5 23559.2 12221.7 12326.4 12390.4 12434.9 12516.3 9499.7 9825.0 9959.6 9991.8 10073.7 19975.7 20179.3 20180.0 20430.8 20545.1 20760.3 21030.9 21288.3 21295.6 21646.9 12714.6 12763.9 12816.9 12863.2 12903.6 13451.9 13725.7 14561.8 14619.9 14807.7 11792.2 12206.6 12300.9 12399.6 12505.4 11772.9 11810.4 12170.9 12209.8 12320.8 10657.9 10924.9 10932.1 10933.7 10944.7 8246.6 8253.3 8267.4 8339.0 8418.1 8383.1 8441.2 8538.2 8598.6 8616.0 01:36:33 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | [#4] prototype.html Cycles:180 Average:5631.75 Median:6319.09 stddev:1593.43 (25.2%) stddev-sans-first:1551.30 01:36:33 INFO - PID 16298 | Values: 535.1 536.2 555.2 557.8 557.9 6248.0 6316.5 6320.8 6335.1 6339.2 6014.2 6119.4 6148.9 6178.9 6238.7 4846.5 4867.7 4879.2 4886.1 4904.5 4858.3 4891.7 4893.9 4915.7 4949.9 4737.7 4852.6 4861.4 4877.4 4883.5 4859.4 4863.4 4877.2 4892.8 4940.9 4452.8 4463.1 4463.6 4477.4 4479.3 6110.0 6123.6 6144.8 6157.8 6158.5 5896.8 5905.3 5930.0 5940.5 5959.1 6569.6 6572.9 6628.6 6640.5 6704.0 4968.2 4986.4 5028.0 5061.7 5085.9 6903.4 6989.4 7007.2 7052.2 7064.1 5151.0 5155.9 5157.7 5208.7 5250.7 5257.6 5275.9 5288.2 5309.4 5341.1 5821.3 5840.2 5876.4 5878.1 5882.3 6489.4 6537.7 6559.9 6568.6 6576.0 1729.9 1765.7 1774.7 1783.7 1791.5 1271.7 1274.4 1279.9 1280.5 1283.2 6317.4 6345.5 6352.8 6365.3 6399.3 6605.9 6640.3 6695.0 6765.9 6780.7 6288.6 6304.0 6371.1 6380.7 6403.6 3549.8 3559.1 3580.8 3584.5 3607.6 6920.2 6986.0 6988.9 7065.3 7072.0 6918.8 6947.4 6949.8 6975.5 6999.5 6923.2 6990.9 7032.8 7069.1 7080.6 6726.5 6728.0 6792.6 6799.6 6808.9 6622.4 6677.5 6690.5 6715.9 6749.4 6944.3 6987.5 7006.3 7031.3 7044.7 5177.8 5191.1 5201.8 5212.8 5228.8 6699.5 6797.2 6817.9 6839.2 6892.9 6529.2 6549.9 6609.0 6655.0 6696.6 6340.1 6559.2 6584.5 6595.6 6633.5 6273.8 6411.5 6464.0 6498.6 6547.3 6559.8 6627.5 6652.2 6682.5 6684.2 6344.0 6361.0 6411.8 6556.9 6558.4 01:36:33 INFO - PID 16298 | 01:36:33 INFO - PID 16298 | [#5] yui.html Cycles:180 Average:25830.92 Median:21088.58 stddev:35227.11 (167.0%) stddev-sans-first:35276.40 01:36:33 INFO - PID 16298 | Values: 953.8 964.1 976.5 994.3 997.9 19309.6 19648.0 19659.0 19676.6 23829.2 20495.3 20554.2 21344.8 21369.3 21394.4 1049.2 1090.1 1092.4 1094.2 1097.6 1046.3 1067.2 1079.2 1089.8 1092.7 1144.0 1144.3 1145.1 1145.2 1147.0 1136.0 1137.2 1138.2 1139.1 1139.2 835.8 839.5 840.5 841.2 841.2 18322.5 18413.4 20444.2 20453.7 20637.5 20834.0 21060.0 21225.8 21477.0 21501.8 16384.8 16501.4 16537.3 16648.8 16888.2 3775.3 3808.3 3823.5 3824.5 3824.8 134430.0 135490.3 136377.0 136741.0 139130.0 16533.0 16601.2 16970.7 17025.4 17043.7 32971.5 33265.0 33427.0 33656.0 33929.7 7872.8 7917.5 9226.2 9534.9 9552.7 4584.1 4692.5 4694.9 4703.7 4710.7 5700.7 5808.0 6415.7 6596.2 6632.4 1226.8 1258.7 1265.1 1267.2 1279.1 765.4 766.1 784.0 787.2 787.7 13031.3 13403.7 13680.7 13782.8 13882.0 763.4 773.2 780.2 782.8 803.5 6007.9 6334.3 6395.9 6402.5 6495.1 121940.3 122615.4 124564.0 125600.0 127533.0 108254.5 109922.0 110009.4 112158.0 113211.0 97039.0 97098.5 97160.5 97415.0 99011.5 13184.7 13240.5 13407.7 13491.7 13508.1 45566.3 45648.0 46392.8 48198.8 48869.3 59326.7 59498.4 59560.7 59608.7 62676.1 18837.4 20095.6 20778.0 20886.3 20944.4 22443.2 22557.8 22658.3 22887.7 23198.0 20880.1 21174.2 21515.1 21599.8 21710.1 20792.9 21117.2 21164.0 21461.2 21612.0 20874.0 21297.7 21412.8 21863.9 21917.1 15111.9 15310.6 15442.5 16042.8 16091.4 15410.9 15692.4 15906.4 16153.6 16306.8 01:36:33 INFO - PID 16298 | -------- Summary: end -------- 01:36:33 INFO - PID 16298 | 01:36:34 INFO - TEST-INFO | 16298: exit 0 01:36:34 INFO - TEST-OK | dromaeo_css | took 1108950ms 01:36:34 INFO - TEST-START | kraken 01:36:34 INFO - Initialising browser for kraken test... 01:36:34 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:53400/getInfo.html -profile /tmp/tmpeuWSBW/profile 01:36:34 INFO - TEST-INFO | started process 16650 (/builds/slave/test/build/application/firefox/firefox http://localhost:53400/getInfo.html) 01:36:39 INFO - TEST-INFO | 16650: exit 0 01:36:39 INFO - Browser initialized. 01:36:39 INFO - Running cycle 1/1 for kraken test... 01:36:39 INFO - TEST-INFO | started process 16817 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpeuWSBW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 01:36:50 INFO - PID 16817 | RSS: Main: 152477696 01:36:50 INFO - PID 16817 | 01:36:53 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:53400/tests/kraken/driver.html?testName=audio-beat-detection) 01:36:54 INFO - PID 16817 | RSS: Main: 158846976 01:36:54 INFO - PID 16817 | 01:36:56 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:53400/tests/kraken/driver.html?testName=audio-dft) 01:36:57 INFO - PID 16817 | RSS: Main: 159416320 01:36:57 INFO - PID 16817 | 01:37:00 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:53400/tests/kraken/driver.html?testName=audio-fft) 01:37:00 INFO - PID 16817 | RSS: Main: 160026624 01:37:00 INFO - PID 16817 | 01:37:03 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:53400/tests/kraken/driver.html?testName=audio-oscillator) 01:37:03 INFO - PID 16817 | RSS: Main: 160251904 01:37:03 INFO - PID 16817 | 01:37:05 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:53400/tests/kraken/driver.html?testName=imaging-gaussian-blur) 01:37:06 INFO - PID 16817 | RSS: Main: 158982144 01:37:06 INFO - PID 16817 | 01:37:09 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:53400/tests/kraken/driver.html?testName=imaging-darkroom) 01:37:09 INFO - PID 16817 | RSS: Main: 159928320 01:37:09 INFO - PID 16817 | 01:37:13 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:53400/tests/kraken/driver.html?testName=imaging-desaturate) 01:37:13 INFO - PID 16817 | RSS: Main: 161480704 01:37:13 INFO - PID 16817 | 01:37:16 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:53400/tests/kraken/driver.html?testName=json-parse-financial) 01:37:17 INFO - PID 16817 | RSS: Main: 162508800 01:37:17 INFO - PID 16817 | 01:37:18 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:53400/tests/kraken/driver.html?testName=json-stringify-tinderbox) 01:37:19 INFO - PID 16817 | RSS: Main: 162299904 01:37:19 INFO - PID 16817 | 01:37:21 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:53400/tests/kraken/driver.html?testName=stanford-crypto-aes) 01:37:21 INFO - PID 16817 | RSS: Main: 162111488 01:37:21 INFO - PID 16817 | 01:37:23 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:53400/tests/kraken/driver.html?testName=stanford-crypto-ccm) 01:37:24 INFO - PID 16817 | RSS: Main: 162258944 01:37:24 INFO - PID 16817 | 01:37:26 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:53400/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 01:37:27 INFO - PID 16817 | RSS: Main: 162308096 01:37:27 INFO - PID 16817 | 01:37:30 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:53400/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 01:37:31 INFO - PID 16817 | RSS: Main: 162533376 01:37:31 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | Cycle 1(1): loaded http://localhost:53400/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:53400/tests/kraken/driver.html?testName=ai-astar) 01:37:32 INFO - PID 16817 | RSS: Main: 164442112 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | __start_tp_report 01:37:32 INFO - PID 16817 | _x_x_mozilla_page_load 01:37:32 INFO - PID 16817 | _x_x_mozilla_page_load_details 01:37:32 INFO - PID 16817 | |i|pagename|runs| 01:37:32 INFO - PID 16817 | |0;ai-astar;96;106;99;105;107;106;109;100;107;106 01:37:32 INFO - PID 16817 | |1;audio-beat-detection;141;112;137;167;112;142;149;121;167;112 01:37:32 INFO - PID 16817 | |2;audio-dft;164;167;163;163;163;163;162;163;165;162 01:37:32 INFO - PID 16817 | |3;audio-fft;75;73;77;187;75;76;74;74;158;76 01:37:32 INFO - PID 16817 | |4;audio-oscillator;78;77;146;78;78;78;129;78;77;126 01:37:32 INFO - PID 16817 | |5;imaging-gaussian-blur;114;113;114;114;114;115;114;114;114;121 01:37:32 INFO - PID 16817 | |6;imaging-darkroom;147;147;148;149;149;148;147;148;148;148 01:37:32 INFO - PID 16817 | |7;imaging-desaturate;94;98;99;94;99;98;94;94;95;95 01:37:32 INFO - PID 16817 | |8;json-parse-financial;48;48;48;47;48;47;47;48;48;47 01:37:32 INFO - PID 16817 | |9;json-stringify-tinderbox;52;53;54;52;53;53;53;55;53;53 01:37:32 INFO - PID 16817 | |10;stanford-crypto-aes;83;73;73;80;74;73;74;74;83;73 01:37:32 INFO - PID 16817 | |11;stanford-crypto-ccm;119;116;115;128;114;118;124;116;118;149 01:37:32 INFO - PID 16817 | |12;stanford-crypto-pbkdf2;175;158;170;158;157;165;166;159;161;156 01:37:32 INFO - PID 16817 | |13;stanford-crypto-sha256-iterative;62;61;63;61;61;61;61;59;59;59 01:37:32 INFO - PID 16817 | __end_tp_report 01:37:32 INFO - PID 16817 | __start_cc_report 01:37:32 INFO - PID 16817 | _x_x_mozilla_cycle_collect,805 01:37:32 INFO - PID 16817 | __end_cc_report 01:37:32 INFO - PID 16817 | __startTimestamp1505378252954__endTimestamp 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | ------- Summary: start ------- 01:37:32 INFO - PID 16817 | Number of tests: 14 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#0] ai-astar Cycles:10 Average:104.10 Median:107.00 stddev:4.23 (4.0%) stddev-sans-first:3.32 01:37:32 INFO - PID 16817 | Values: 96.0 106.0 99.0 105.0 107.0 106.0 109.0 100.0 107.0 106.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#1] audio-beat-detection Cycles:10 Average:136.00 Median:141.50 stddev:21.36 (15.1%) stddev-sans-first:22.58 01:37:32 INFO - PID 16817 | Values: 141.0 112.0 137.0 167.0 112.0 142.0 149.0 121.0 167.0 112.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#2] audio-dft Cycles:10 Average:163.50 Median:163.00 stddev:1.51 (0.9%) stddev-sans-first:1.59 01:37:32 INFO - PID 16817 | Values: 164.0 167.0 163.0 163.0 163.0 163.0 162.0 163.0 165.0 162.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#3] audio-fft Cycles:10 Average:94.50 Median:75.00 stddev:41.69 (55.6%) stddev-sans-first:43.62 01:37:32 INFO - PID 16817 | Values: 75.0 73.0 77.0 187.0 75.0 76.0 74.0 74.0 158.0 76.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#4] audio-oscillator Cycles:10 Average:94.50 Median:78.00 stddev:27.50 (35.3%) stddev-sans-first:28.52 01:37:32 INFO - PID 16817 | Values: 78.0 77.0 146.0 78.0 78.0 78.0 129.0 78.0 77.0 126.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#5] imaging-gaussian-blur Cycles:10 Average:114.70 Median:114.00 stddev:2.26 (2.0%) stddev-sans-first:2.39 01:37:32 INFO - PID 16817 | Values: 114.0 113.0 114.0 114.0 114.0 115.0 114.0 114.0 114.0 121.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#6] imaging-darkroom Cycles:10 Average:147.90 Median:148.00 stddev:0.74 (0.5%) stddev-sans-first:0.71 01:37:32 INFO - PID 16817 | Values: 147.0 147.0 148.0 149.0 149.0 148.0 147.0 148.0 148.0 148.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.50 stddev:2.21 (2.3%) stddev-sans-first:2.22 01:37:32 INFO - PID 16817 | Values: 94.0 98.0 99.0 94.0 99.0 98.0 94.0 94.0 95.0 95.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#8] json-parse-financial Cycles:10 Average:47.60 Median:48.00 stddev:0.52 (1.1%) stddev-sans-first:0.53 01:37:32 INFO - PID 16817 | Values: 48.0 48.0 48.0 47.0 48.0 47.0 47.0 48.0 48.0 47.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#9] json-stringify-tinderbox Cycles:10 Average:53.10 Median:53.00 stddev:0.88 (1.7%) stddev-sans-first:0.83 01:37:32 INFO - PID 16817 | Values: 52.0 53.0 54.0 52.0 53.0 53.0 53.0 55.0 53.0 53.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#10] stanford-crypto-aes Cycles:10 Average:76.00 Median:74.00 stddev:4.24 (5.7%) stddev-sans-first:3.67 01:37:32 INFO - PID 16817 | Values: 83.0 73.0 73.0 80.0 74.0 73.0 74.0 74.0 83.0 73.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#11] stanford-crypto-ccm Cycles:10 Average:121.70 Median:118.50 stddev:10.51 (8.9%) stddev-sans-first:11.10 01:37:32 INFO - PID 16817 | Values: 119.0 116.0 115.0 128.0 114.0 118.0 124.0 116.0 118.0 149.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:162.50 Median:163.00 stddev:6.31 (3.9%) stddev-sans-first:4.81 01:37:32 INFO - PID 16817 | Values: 175.0 158.0 170.0 158.0 157.0 165.0 166.0 159.0 161.0 156.0 01:37:32 INFO - PID 16817 | 01:37:32 INFO - PID 16817 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.70 Median:61.00 stddev:1.34 (2.2%) stddev-sans-first:1.33 01:37:32 INFO - PID 16817 | Values: 62.0 61.0 63.0 61.0 61.0 61.0 61.0 59.0 59.0 59.0 01:37:32 INFO - PID 16817 | -------- Summary: end -------- 01:37:32 INFO - PID 16817 | 01:37:33 INFO - PID 16817 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 01:37:33 INFO - TEST-INFO | 16817: exit 0 01:37:33 INFO - TEST-OK | kraken | took 59266ms 01:37:33 INFO - SUITE-END | took 1168s 01:37:34 INFO - Completed test suite (00:19:28) 01:37:34 INFO - javascript benchmark 01:37:34 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 9129.43226491901, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3539.8407071681772, 3603.9639603603955, 3606.7475276730625, 3629.9092522686938, 3642.4354225095103, 6411.455026322768, 6457.483401327889, 6464.773732919349, 6519.771807986722, 6528.6409247491365, 6445.613263204211, 6477.74089036438, 6524.282328943812, 6548.377904099127, 6552.836179095537, 5592.944070559303, 5622.100463925773, 5669.121286200625, 5685.147227915825, 5702.686352250625, 5607.214989901417, 5613.66318020918, 5661.716914154275, 5685.346185188694, 5693.601447898649, 5509.834704958857, 5564.4991950724425, 5582.441755824426, 5643.463870932275, 5655.717214139277, 5589.608727389084, 5649.604527683064, 5657.038303488375, 5661.433856614347, 5713.971430142823, 5652.491275785199, 5658.85852853682, 5709.172170035322, 5715.828525144252, 5724.456176663252, 6321.431071203614, 6349.873002539969, 6382.712777924958, 6443.774467893648, 6458.095866578683, 6936.687849046805, 6941.409980151693, 6956.026156338116, 6965.0, 6993.195782484978, 7012.649367531603, 7022.016917631536, 7064.187618423895, 7087.787366379017, 7088.326608972139, 6456.225252969673, 6503.15458990333, 6526.151600291979, 6565.212174539086, 6574.901376479356, 7190.568565886064, 7195.424366050704, 7249.383802376857, 7268.23683513234, 7271.781846544613, 6860.176778786577, 6864.828379290458, 6931.09895713554, 6933.168019837551, 6940.757073502403, 6876.449884009267, 6952.965235173791, 6955.339242771928, 7007.299270072952, 7009.12385951756, 6890.552114112566, 6919.308069193141, 6922.688479018456, 6937.063496427918, 6946.409555187764, 6903.6203008835, 6905.689243984033, 6927.515073944775, 7000.61496617691, 7002.649867506604, 5084.7966081356335, 5099.847004589868, 5126.051680439131, 5128.589712822965, 5152.278680984665, 4549.27211646135, 4574.656900732459, 4591.242444996538, 4599.8390056348535, 4601.67788254819, 6586.769463068769, 6591.538592298493, 6665.733370665216, 6669.166354205724, 6690.19717633887, 6903.447724182053, 6948.652567371611, 7005.054317667152, 7024.262452442522, 7042.964785176041, 6521.543491955613, 6532.608043517404, 6626.503012274099, 6634.237062737847, 6649.168853893263, 5538.501534861882, 5668.234788303526, 5681.034224181899, 5747.6838773867, 5754.021816291241, 7087.043249161297, 7114.857702845914, 7134.072570565793, 7204.3155900189395, 7258.673359698826, 6897.206821215625, 6953.096097507291, 6990.755323563651, 7010.894836577558, 7016.789496315017, 7019.894701579378, 7142.285771422816, 7148.821279468055, 7210.459215558749, 7212.134543854771, 6815.693293801692, 6815.829604259933, 6926.619035953071, 6927.618980956096, 6961.756338528127, 7025.894611580932, 7062.540934839219, 7089.751858684921, 7096.503244772816, 7104.680289387094, 6763.222229443677, 6773.93226067733, 6845.897311540431, 6846.383825455733, 6853.657317134223, 6593.868122637617, 6707.195136583641, 6715.05989161508, 6725.0248713935225, 6737.663116844236, 6667.566608170453, 6710.463162946855, 6723.932760672331, 6797.592144471348, 6824.454043676593, 6815.045893575003, 6843.726250949906, 6896.27589103137, 6901.206361268519, 6916.0, 6625.834354141185, 6631.867362652816, 6649.767258145942, 6710.0, 6710.66446677674], "value": 6343.120162812627, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [911.6080085563206, 917.1607978699491, 948.3788118782198, 960.0879164793448, 970.6893793985919, 43903.0, 44502.33246501305, 44627.33059004109, 44665.0, 44836.103277934424, 41763.79118104405, 41867.0, 41952.16095678085, 42013.789931050305, 42352.36471452931, 7174.24670409606, 7286.81782955425, 7287.161976372706, 7330.486865919388, 7344.30229128232, 7008.789736307919, 7034.296570342976, 7063.117110361205, 7068.293170682942, 7100.041494398268, 7922.9603851980655, 8137.430379873411, 8147.918520814776, 8162.347012239006, 8163.652997255445, 8099.230573095576, 8128.878066829002, 8157.877631835528, 8194.877076843852, 8199.7290419985, 8061.95969020157, 8137.877931831027, 8151.918480815235, 8158.632861521246, 8164.183581641848, 42165.0, 42589.57410425887, 42599.36100958488, 42645.36031959523, 42713.0, 3664.193877346979, 3723.925521489555, 3723.9945214792124, 3731.2164445466483, 3737.8691745789038, 33291.500627490605, 33551.664483355096, 33769.15577110592, 33800.661993379996, 33875.32249354999, 5158.509941555546, 5316.229146773735, 5375.462453754632, 5389.676619402849, 5397.325334333208, 204914.0, 207123.0, 218400.0, 219080.0, 255090.99999999814, 55551.72224138853, 56122.0, 56189.71905140448, 56228.15657765137, 56273.0, 57044.714776426685, 57105.0, 57467.712661436424, 57498.0, 57629.13556296659, 14772.187529685756, 14826.40694372213, 14897.627559311104, 14906.25468726581, 15100.697986040217, 11868.109891758153, 11900.047996160287, 11904.940475297568, 11915.642530724092, 11916.285022898654, 15467.690646187239, 15538.0, 15695.215239237992, 15724.764128538081, 15802.841971580137, 6108.007076532556, 6134.5092392608485, 6224.190855188796, 6299.716512756845, 6330.987042073246, 1091.7543552700579, 1107.4684151607112, 1108.833674948748, 1113.4210210690396, 1119.7928383249125, 24213.273601791974, 24328.391790205387, 24369.39076523101, 24472.632910506356, 24565.385865353153, 1231.6982339326744, 1239.2502535965791, 1239.962801115968, 1243.5523211643801, 1245.439552201513, 13182.274974876475, 13216.471341146247, 13399.464021439228, 13421.39603717835, 17547.73678394825, 299707.0, 302037.0, 302057.0, 302953.0, 303455.0, 66838.33161668418, 67098.66450667716, 67134.0, 67510.66244668844, 67637.0, 1515.7877897094415, 1523.6800271943016, 1572.207683241106, 1579.3603590545847, 1583.7804890234454, 30093.69906300909, 30234.697653024068, 30455.0, 30479.0, 30810.69189308078, 42698.35952460654, 42930.78534607307, 42950.140997180504, 42976.0, 43083.569164307955, 251998.0, 253930.0, 253978.0, 255676.0, 255756.0, 37313.62686373101, 41181.0, 41346.96632584209, 41608.58391416168, 41826.79086604548, 50773.0, 51330.48669513257, 51547.742261288455, 51640.74179629078, 51675.0, 37344.6265537352, 37358.0, 37579.624203757616, 37698.0, 37764.43353349757, 36493.63506365009, 36535.0, 37151.62848371482, 37442.0, 37671.0, 42344.36483452689, 43626.56373436225, 43864.0, 44111.77944110259, 44153.77923110364, 35662.0, 35663.46504802482, 35773.821130894175, 36012.4598131023, 36456.63543364532, 25681.22956311314, 25696.871515642302, 26024.479510410063, 26098.60852087182, 26416.339591509597], "value": 18956.576656701905, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [602.6986506746626, 607.7751232044144, 609.2536642612799, 612.6416046612732, 629.1035274733505, 24040.03839846404, 24868.50262994739, 24899.875500622493, 24904.626430603512, 24969.0, 25060.0, 26072.871255449325, 26222.082227122053, 26235.606465903027, 26346.868265658693, 6432.356764323554, 6549.050387693782, 6563.0, 6568.671566421684, 6572.769953051644, 6536.934630653704, 6606.339366063403, 6653.866922661544, 6804.795856124324, 6830.146231721035, 6782.0, 6792.898106528406, 6796.7621133260345, 6829.385355318021, 6833.4191593714595, 6776.457883369319, 6777.491688123386, 6778.593284402927, 6789.558678685869, 6792.117024786796, 6267.655278959655, 6299.811005669837, 6310.274318453391, 6329.208848893888, 6337.746490140389, 31278.530822037686, 31588.842055789573, 31705.0, 31768.0, 32262.838685806655, 2222.8777417242045, 2263.8302127340353, 2263.852849564773, 2264.2641141629038, 2265.1166045242367, 19997.400077997685, 20401.183952641877, 20507.077181526867, 20577.69133462999, 20591.382258532118, 2392.572786099821, 2395.293388450394, 2462.18747813223, 2544.821862469628, 2551.795856331489, 133636.0, 139780.30109849488, 148751.0, 149769.0, 153850.46149538472, 15377.155711072231, 16608.00351978885, 16641.583960401087, 16645.0, 17103.914480427517, 25212.747872521406, 25307.0, 25335.746642533708, 25358.873205634223, 25412.491750164892, 10182.134518565857, 10293.279470436997, 10300.0, 10423.583056677648, 10434.895651043393, 9273.397229180082, 9359.34484586086, 9363.859542106873, 9397.953010234905, 9490.667826626035, 9799.216062714966, 9806.362586431858, 9906.504674766376, 10273.691789246335, 10274.486275686186, 2769.4599553086955, 2847.601335812988, 2874.453853767777, 2878.654561452639, 2944.3816798472562, 1064.3188359449957, 1077.7521170130915, 1079.379356869803, 1082.967510974672, 1087.9619213327496, 20938.0, 20987.58024839495, 21555.67666485004, 21668.24161154352, 21928.561428771336, 1107.9002889739802, 1117.273772048159, 1124.1175677093606, 1131.2477202660139, 1150.3500522204927, 11520.539178432937, 11907.285562866082, 11939.343336116597, 12035.75928481443, 12057.51769929193, 555214.0, 561706.0, 563693.0, 572025.0, 596040.0, 117758.0, 119322.0, 120499.0, 121335.39332303283, 121570.0, 1245.9501619935281, 1254.1221145198397, 1281.814136950137, 1287.549357724789, 1293.3768121008075, 19238.23047078101, 19271.22915083381, 19516.707249390987, 19651.606967860847, 19664.0, 61404.0, 61696.69151654213, 61897.0, 62221.688891555255, 63125.36874631195, 75015.0, 75533.622331888, 76113.61943190248, 76371.0, 77353.61323193349, 14859.628509286922, 14931.776023359442, 14971.877109216635, 15175.696486070437, 15266.77099843481, 23640.408989775395, 23730.88134559385, 23830.642540362256, 23848.642270366305, 23982.640260395758, 18357.908210458863, 18628.348007819663, 18728.812711872706, 19108.52228694238, 19494.31769888047, 15221.0, 15749.370025199321, 15981.520554383387, 16698.165091745606, 16755.581110472336, 19067.0, 19847.60304793925, 19947.301844435955, 20039.499012524804, 20089.799102008794, 14980.925095374454, 15007.099574025593, 15054.247287635793, 15143.469978550698, 15152.924235378752, 19378.127984241026, 19441.31955381555, 19605.411837644893, 19607.0, 19627.901860490605], "value": 12653.680815390933, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1479.2381923309495, 1515.7120147172036, 1531.3185632393574, 1548.3032635314119, 1549.7985261915946, 15692.607684807885, 16350.918245408786, 16367.754483682724, 16369.590760231, 16372.918135409322, 16017.279222434989, 17139.228734706936, 17148.056856872867, 17177.141142942834, 17194.656106877886, 3061.785675002751, 3063.4638938185726, 3124.468840297155, 3124.6875312468796, 3125.249940014403, 2952.8818847246084, 3002.549617557362, 3029.666736658966, 3036.0436462514235, 3039.4377040247514, 3106.565080888666, 3114.890978815742, 3127.093142988542, 3133.639631442379, 3141.7643676724224, 2941.2940894185454, 2950.7786915981387, 2959.215807810932, 2969.2873710309586, 2992.895248666297, 2951.1294168220425, 2969.0, 3000.639923209229, 3012.653544842349, 3015.8190508569555, 15764.132972686497, 15930.283137258735, 16036.919815400965, 16037.438689645807, 16061.759073613905, 8336.374771892133, 8628.784280392978, 8650.524221167832, 8679.739607811776, 8705.303575713928, 5917.733701983421, 6043.244594425697, 6151.507879369639, 6152.261728592553, 6295.307516173218, 1929.324736342269, 1953.2187125150053, 1971.4874132725452, 1989.910454029572, 2011.8189362957405, 28053.71946280552, 28314.85842570774, 28343.0, 28359.149225523266, 28452.146435606966, 7554.357879580188, 7604.125525564631, 7620.771376858703, 7706.614669266514, 7749.186335434698, 18703.906480467784, 18884.716729249074, 18908.527286817938, 18919.43241702751, 18946.147423365983, 7829.960850195713, 8262.380321475794, 8296.087430382653, 8297.377696672773, 8298.460600060977, 7362.889556656654, 7534.510256833289, 7590.8861367079535, 7619.542827430372, 7660.425468089916, 5435.42927992563, 5545.140503221926, 5708.286464191976, 5846.795362162389, 5850.502707269845, 1656.9254383552768, 1668.0908904646997, 1668.6829502394505, 1719.406804652393, 1724.9137543123045, 982.5725809272989, 1010.3382284603597, 1017.7862648843677, 1026.9229807764448, 1035.9689209323733, 9273.397229180082, 9377.275493002715, 9601.135897769234, 9622.326437149331, 9728.562214700214, 1072.3137192197, 1079.5803518373314, 1082.3614067700096, 1086.1039642295138, 1109.8501702270253, 5383.596230282745, 5477.808276710296, 5727.341355744143, 5806.970965145148, 5829.183914252008, 23394.53210935772, 24037.0, 24104.397390065387, 24127.879360603085, 24327.0, 22056.669149962763, 23037.654435183485, 23463.648045279333, 23464.530709385715, 23559.175428859908, 12221.69445763863, 12326.383680815923, 12390.380480976095, 12434.937825310815, 12516.31160286193, 9499.667511637335, 9825.0, 9959.601615935282, 9991.800163996824, 10073.748156295858, 19975.700364494835, 20179.293724719566, 20180.0, 20430.795692042888, 20545.075471604112, 20760.273390431263, 21030.894845525676, 21288.25491107804, 21295.574088518453, 21646.891765541073, 12714.61856144317, 12763.93618031941, 12816.871831281567, 12863.163894346837, 12903.612891613267, 13451.865481345452, 13725.656858578615, 14561.781573276621, 14619.853801462275, 14807.703845923237, 11792.233504822503, 12206.572769953009, 12300.938495307824, 12399.628011159679, 12505.437255323714, 11772.941135294268, 11810.409479525817, 12170.878291217328, 12209.816852747394, 12320.75358492843, 10657.946710266398, 10924.945375273073, 10932.125429965743, 10933.671989840317, 10944.726381840517, 8246.587670616565, 8253.298469629908, 8267.379946504156, 8338.958305208678, 8418.116097809641, 8383.119772423808, 8441.155884411755, 8538.188872057144, 8598.570071496275, 8615.956920215358], "value": 7352.547116631815, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [535.1090434426678, 536.1582315764249, 555.1561626327981, 557.7824648387127, 557.8856334451438, 6247.968760156198, 6316.526260530456, 6320.778772742955, 6335.054199797093, 6339.207599050119, 6014.188084608588, 6119.357467465908, 6148.877022459559, 6178.938210617893, 6238.656873871935, 4846.466888642247, 4867.707937523742, 4879.170541008037, 4886.096072226632, 4904.485029071931, 4858.275312264148, 4891.706497610155, 4893.8776530586665, 4915.680480768757, 4949.901001979958, 4737.73942433166, 4852.636052296092, 4861.416630004387, 4877.365942427479, 4883.462819089915, 4859.368282123319, 4863.392075990501, 4877.170880950247, 4892.828750993698, 4940.925886111711, 4452.777361131963, 4463.107378524276, 4463.642908567307, 4477.440319960005, 4479.3057076153245, 6110.0, 6123.601965872204, 6144.78493252734, 6157.7806415520645, 6158.507319414436, 5896.793612223594, 5905.29136503618, 5930.021546444831, 5940.524758019391, 5959.135925290809, 6569.605823650596, 6572.86854262912, 6628.5691430056895, 6640.535162538624, 6703.960886062668, 4968.205087186033, 4986.351774269358, 5027.974860125712, 5061.746912654389, 5085.8728531787, 6903.406253121576, 6989.4408447324095, 7007.159140903073, 7052.224255331909, 7064.081669382998, 5151.0, 5155.896882062413, 5157.716325602128, 5208.65077660158, 5250.65870718402, 5257.605679574047, 5275.942382470839, 5288.180332048539, 5309.41596424393, 5341.145416733304, 5821.27234095738, 5840.2115714378015, 5876.44173803488, 5878.118282257696, 5882.323532793698, 6489.3510648934725, 6537.723785166294, 6559.934400656028, 6568.6058836469965, 6576.0, 1729.9481015569554, 1765.6645237404853, 1774.6539424812295, 1783.6611043901617, 1791.4536066499843, 1271.675722690708, 1274.3819247664876, 1279.9040071994639, 1280.5454063807401, 1283.1595305075004, 6317.399082523009, 6345.49236061114, 6352.841178970562, 6365.326562843617, 6399.296077431479, 6605.867882642417, 6640.302768209269, 6695.0, 6765.898511522331, 6780.694868730919, 6288.585068359674, 6304.0, 6371.139896114058, 6380.744770209232, 6403.551751377358, 3549.769264997767, 3559.1458050068313, 3580.838862251205, 3584.534010578608, 3607.621199773986, 6920.204176519664, 6986.0, 6988.895166572505, 7065.293470652894, 7072.0, 6918.82379995392, 6947.444204463631, 6949.7567585134275, 6975.546589471668, 6999.475039372068, 6923.165361179191, 6990.860182796418, 7032.830869311052, 7069.116360454943, 7080.575165490087, 6726.461883049246, 6727.966360168168, 6792.626405547742, 6799.558028728315, 6808.897866532105, 6622.377517508241, 6677.53094319249, 6690.45762610205, 6715.865682686416, 6749.426298764463, 6944.305569443015, 6987.545809522365, 7006.264342244195, 7031.261717519586, 7044.718211271492, 5177.792888284577, 5191.118928994444, 5201.765920533509, 5212.791488340576, 5228.7973766033265, 6699.464042876656, 6797.1843378794865, 6817.863642727217, 6839.213490448463, 6892.862142757217, 6529.249136349381, 6549.901751473636, 6609.0, 6654.966725166343, 6696.5647232929705, 6340.1181090559085, 6559.229008167863, 6584.50616203777, 6595.571287866273, 6633.535652504278, 6273.780417685359, 6411.519136064907, 6463.967680161569, 6498.610083395011, 6547.345265473415, 6559.8032059038305, 6627.50293727982, 6652.168478940132, 6682.498812588978, 6684.192639091496, 6343.9682801585695, 6360.996286169841, 6411.839704007437, 6556.901791426698, 6558.376954189344], "value": 5168.96828078888, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [953.790166163444, 964.127464644497, 976.4678250353556, 994.2642444590996, 997.8602995580618, 19309.613807723836, 19648.0, 19659.0, 19676.606467870635, 23829.165979190733, 20495.282665106723, 20554.177832886704, 21344.786552134512, 21369.252076177338, 21394.35816925491, 1049.1711547877187, 1090.1115590793518, 1092.4155576766432, 1094.1738987064755, 1097.5938902606047, 1046.3251202974077, 1067.2422579968193, 1079.1636481726646, 1089.7548051688386, 1092.6995076353987, 1144.0, 1144.3362849547243, 1145.0953746540224, 1145.2212495503054, 1146.9942650286737, 1135.9545618175264, 1137.181229514748, 1138.1577632551935, 1139.1399493382485, 1139.1797905508063, 835.7534527314457, 839.5382539603194, 840.5419046619606, 841.1882533355341, 841.1966571923798, 18322.541936451562, 18413.35553255643, 20444.182232710675, 20453.693194602092, 20637.4840628984, 20834.0, 21060.0, 21225.787742122535, 21477.0, 21501.784982150133, 16384.83615163845, 16501.422450214184, 16537.255823487973, 16648.83351166485, 16888.15559222034, 3775.263823554408, 3808.2954653388933, 3823.541175058983, 3824.4836947012077, 3824.8470061197795, 134430.0, 135490.32254838664, 136377.0, 136741.0, 139130.0, 16533.0, 16601.169941502878, 16970.745438818427, 17025.40411085606, 17043.744343834853, 32971.50542741813, 33265.00204993854, 33427.0, 33655.99032029043, 33929.66070339265, 7872.842543149105, 7917.485363451357, 9226.169644732006, 9534.856977145348, 9552.713418597454, 4584.083183363341, 4692.5307469253485, 4694.929576056362, 4703.741294228782, 4710.717356958594, 5700.714964251771, 5807.970960145257, 6415.748928958808, 6596.208454985433, 6632.403083722392, 1226.7669142862828, 1258.6916205529703, 1265.1460264321547, 1267.1636719765095, 1279.0662816144081, 765.3876898481193, 766.0654002117519, 784.0473824303499, 787.1577412169039, 787.7006737439737, 13031.283279419533, 13403.664908377368, 13680.726385472235, 13782.793258101137, 13882.0, 763.4312437234184, 773.2344978471273, 780.2470615855726, 782.8082119880552, 803.4737247103157, 6007.928790485434, 6334.271558770801, 6395.872082558323, 6402.519811014193, 6495.058216558573, 121940.34178974468, 122615.38692306481, 124564.0, 125600.0, 127533.0, 108254.45872770586, 109922.0, 110009.44995274972, 112157.95289212005, 113211.0, 97039.0, 97098.51450742701, 97160.51419742857, 97415.0, 99011.50494247483, 13184.736305274033, 13240.470381184645, 13407.731845362843, 13491.662708432368, 13508.121972071784, 45566.31650525311, 45648.0, 46392.76803615961, 48198.759006204746, 48869.2669609949, 59326.70336648289, 59498.40501594928, 59560.70219648874, 59608.70195648994, 62676.05985910124, 18837.434876953714, 20095.59808803845, 20778.0, 20886.268980585606, 20944.37166884996, 22443.21448749286, 22557.774422255567, 22658.320250392513, 22887.656685149403, 23198.0, 20880.060397281854, 21174.153033879087, 21515.139394424048, 21599.784002159777, 21710.131594736034, 20792.896035519727, 21117.155313787276, 21164.04761785754, 21461.248856289956, 21612.0, 20874.0, 21297.6805347923, 21412.785872141078, 21863.890680546494, 21917.123315067856, 15111.924440377728, 15310.617234569225, 15442.536723898302, 16042.839571604134, 16091.356345746039, 15410.922945385202, 15692.372305107669, 15906.363745450515, 16153.59616009609, 16306.755398669267], "value": 10011.853434461722, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1472.8000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 106.0, 99.0, 105.0, 107.0, 106.0, 109.0, 100.0, 107.0, 106.0], "value": 104.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 112.0, 137.0, 167.0, 112.0, 142.0, 149.0, 121.0, 167.0, 112.0], "value": 136.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 167.0, 163.0, 163.0, 163.0, 163.0, 162.0, 163.0, 165.0, 162.0], "value": 163.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 73.0, 77.0, 187.0, 75.0, 76.0, 74.0, 74.0, 158.0, 76.0], "value": 94.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 77.0, 146.0, 78.0, 78.0, 78.0, 129.0, 78.0, 77.0, 126.0], "value": 94.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 113.0, 114.0, 114.0, 114.0, 115.0, 114.0, 114.0, 114.0, 121.0], "value": 114.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 148.0, 149.0, 149.0, 148.0, 147.0, 148.0, 148.0, 148.0], "value": 147.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 98.0, 99.0, 94.0, 99.0, 98.0, 94.0, 94.0, 95.0, 95.0], "value": 96.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [48.0, 48.0, 48.0, 47.0, 48.0, 47.0, 47.0, 48.0, 48.0, 47.0], "value": 47.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 53.0, 54.0, 52.0, 53.0, 53.0, 53.0, 55.0, 53.0, 53.0], "value": 53.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 73.0, 73.0, 80.0, 74.0, 73.0, 74.0, 74.0, 83.0, 73.0], "value": 76.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 116.0, 115.0, 128.0, 114.0, 118.0, 124.0, 116.0, 118.0, 149.0], "value": 121.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [175.0, 158.0, 170.0, 158.0, 157.0, 165.0, 166.0, 159.0, 161.0, 156.0], "value": 162.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 61.0, 63.0, 61.0, 61.0, 61.0, 61.0, 59.0, 59.0, 59.0], "value": 60.7, "unit": "score"}]}]} 01:37:34 INFO - Return code: 0 01:37:34 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 01:37:34 INFO - # TBPL SUCCESS # 01:37:34 INFO - Running post-action listener: _package_coverage_data 01:37:34 INFO - Running post-action listener: _resource_record_post_action 01:37:34 INFO - [mozharness: 2017-09-14 08:37:34.281976Z] Finished run-tests step (success) 01:37:34 INFO - Running post-run listener: _resource_record_post_run 01:37:34 INFO - Total resource usage - Wall time: 1184s; CPU: 13.0%; Read bytes: 507904; Write bytes: 349147136; Read time: 268; Write time: 186892 01:37:34 INFO - TinderboxPrint: CPU usage
13.0% 01:37:34 INFO - TinderboxPrint: I/O read bytes / time
507,904 / 268 01:37:34 INFO - TinderboxPrint: I/O write bytes / time
349,147,136 / 186,892 01:37:34 INFO - TinderboxPrint: CPU idle
8,210.2 (87.0%) 01:37:34 INFO - TinderboxPrint: CPU user
1,182.4 (12.5%) 01:37:34 INFO - TinderboxPrint: Swap in / out
0 / 0 01:37:34 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 67633152; Read time: 0; Write time: 38860 01:37:34 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 01:37:34 INFO - run-tests - Wall time: 1169s; CPU: 13.0%; Read bytes: 503808; Write bytes: 281513984; Read time: 256; Write time: 148032 01:37:34 INFO - Running post-run listener: _upload_blobber_files 01:37:34 INFO - Blob upload gear active. 01:37:34 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 01:37:34 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 01:37:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 01:37:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 01:37:35 INFO - (blobuploader) - INFO - Open directory for files ... 01:37:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 01:37:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 01:37:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 01:37:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 01:37:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 01:37:36 INFO - (blobuploader) - INFO - Done attempting. 01:37:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 01:37:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 01:37:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 01:37:37 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 01:37:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 01:37:37 INFO - (blobuploader) - INFO - Done attempting. 01:37:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 01:37:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 01:37:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 01:37:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 01:37:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 01:37:44 INFO - (blobuploader) - INFO - Done attempting. 01:37:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 01:37:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 01:37:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 01:37:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 01:37:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 01:37:45 INFO - (blobuploader) - INFO - Done attempting. 01:37:45 INFO - (blobuploader) - INFO - Iteration through files over. 01:37:45 INFO - Return code: 0 01:37:45 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 01:37:45 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 01:37:45 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/0d41e44b0b123a221e046d820681a94328456036f418da456c4fbedb84d405f8222b372c07d930d00ac2afe55005b5a05959360cb1e33cfae3fd77d0432484a9", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/a08465ff38198cb6d77f2f010dd0eedf4b7a955b0065f1913eb72566cc996400e121fe9a4aea875bc12c8a492b936348756911a429eb32c83c2442211fabb9cf", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/28dc96738b311779f80f35f466ced8c06d3f5a30072b44b30cb84add3638c245b6baa783475918c704d81449e9d0ebb600fff4293705db134fc9a82bb5fcdcca", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/57201cbff6b414530069df3a8219c55d8ab65b125481b7d20695d0ce08f45f21f388d187ca1e5d8fc827f5f3ba2f7698be4541ee2b0433b4156cb6ed94604ba6"} 01:37:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 01:37:45 INFO - Writing to file /builds/slave/test/properties/blobber_files 01:37:45 INFO - Contents: 01:37:45 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/0d41e44b0b123a221e046d820681a94328456036f418da456c4fbedb84d405f8222b372c07d930d00ac2afe55005b5a05959360cb1e33cfae3fd77d0432484a9", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/a08465ff38198cb6d77f2f010dd0eedf4b7a955b0065f1913eb72566cc996400e121fe9a4aea875bc12c8a492b936348756911a429eb32c83c2442211fabb9cf", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/28dc96738b311779f80f35f466ced8c06d3f5a30072b44b30cb84add3638c245b6baa783475918c704d81449e9d0ebb600fff4293705db134fc9a82bb5fcdcca", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/57201cbff6b414530069df3a8219c55d8ab65b125481b7d20695d0ce08f45f21f388d187ca1e5d8fc827f5f3ba2f7698be4541ee2b0433b4156cb6ed94604ba6"} 01:37:45 INFO - Running post-run listener: copy_logs_to_upload_dir 01:37:45 INFO - Copying logs to upload dir... 01:37:45 INFO - mkdir: /builds/slave/test/build/upload/logs 01:37:45 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.197582 ========= master_lag: -0.08 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2017-09-14 01:37:45.540453) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-14 01:37:45.543610) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/0d41e44b0b123a221e046d820681a94328456036f418da456c4fbedb84d405f8222b372c07d930d00ac2afe55005b5a05959360cb1e33cfae3fd77d0432484a9", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/a08465ff38198cb6d77f2f010dd0eedf4b7a955b0065f1913eb72566cc996400e121fe9a4aea875bc12c8a492b936348756911a429eb32c83c2442211fabb9cf", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/28dc96738b311779f80f35f466ced8c06d3f5a30072b44b30cb84add3638c245b6baa783475918c704d81449e9d0ebb600fff4293705db134fc9a82bb5fcdcca", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/57201cbff6b414530069df3a8219c55d8ab65b125481b7d20695d0ce08f45f21f388d187ca1e5d8fc827f5f3ba2f7698be4541ee2b0433b4156cb6ed94604ba6"} build_url:https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011249 build_url: 'https://queue.taskcluster.net/v1/task/NXHJuPQ6StmVl1oYUH0QVA/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/0d41e44b0b123a221e046d820681a94328456036f418da456c4fbedb84d405f8222b372c07d930d00ac2afe55005b5a05959360cb1e33cfae3fd77d0432484a9", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/a08465ff38198cb6d77f2f010dd0eedf4b7a955b0065f1913eb72566cc996400e121fe9a4aea875bc12c8a492b936348756911a429eb32c83c2442211fabb9cf", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/28dc96738b311779f80f35f466ced8c06d3f5a30072b44b30cb84add3638c245b6baa783475918c704d81449e9d0ebb600fff4293705db134fc9a82bb5fcdcca", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/57201cbff6b414530069df3a8219c55d8ab65b125481b7d20695d0ce08f45f21f388d187ca1e5d8fc827f5f3ba2f7698be4541ee2b0433b4156cb6ed94604ba6"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-14 01:37:45.571420) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 01:37:45.571718) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=516f8d7ca085b4d087ab0a71000001a4-1505371786.255931-1108532794 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004471 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-14 01:37:45.656006) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-14 01:37:45.656317) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-14 01:37:45.656604) ========= ========= Total master_lag: 0.10 =========