builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-039 starttime: 1494444850.58 results: success (0) revision: ce2218406119c36a551e3faea4e192186ee46cc5 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:10.579654) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:10.580096) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:10.580363) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:10.595329) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:10.595736) ========= 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=5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-10 12:34:10-- 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% 42.0M=0s 2017-05-10 12:34:11 (42.0 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.084018 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:10.694044) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:10.694365) ========= 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=5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018171 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:10.746465) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-05-10 12:34:10.749869) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev ce2218406119c36a551e3faea4e192186ee46cc5 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev ce2218406119c36a551e3faea4e192186ee46cc5 --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=5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-10 12:34:11,150 truncating revision to first 12 chars 2017-05-10 12:34:11,150 Setting DEBUG logging. 2017-05-10 12:34:11,150 attempt 1/10 2017-05-10 12:34:11,150 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/ce2218406119?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-10 12:34:12,141 unpacking tar archive at: mozilla-central-ce2218406119/testing/mozharness/ program finished with exit code 0 elapsedTime=1.407507 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-05-10 12:34:12.173951) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:12.174354) ========= script_repo_revision: ce2218406119c36a551e3faea4e192186ee46cc5 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:12.174761) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:12.175019) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-10 12:34:12.185780) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2017-05-10 12:34:12.186150) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:34:12 INFO - MultiFileLogger online at 20170510 12:34:12 in /builds/slave/test 12:34:12 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 12:34:12 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:34:12 INFO - {'append_to_log': False, 12:34:12 INFO - 'base_work_dir': '/builds/slave/test', 12:34:12 INFO - 'blob_upload_branch': 'Firefox', 12:34:12 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:34:12 INFO - 'branch': 'Firefox', 12:34:12 INFO - 'buildbot_json_path': 'buildprops.json', 12:34:12 INFO - 'config_files': ('talos/linux_config.py',), 12:34:12 INFO - 'default_actions': ('clobber', 12:34:12 INFO - 'read-buildbot-config', 12:34:12 INFO - 'download-and-extract', 12:34:12 INFO - 'populate-webroot', 12:34:12 INFO - 'create-virtualenv', 12:34:12 INFO - 'install', 12:34:12 INFO - 'run-tests'), 12:34:12 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:34:12 INFO - 'download_minidump_stackwalk': True, 12:34:12 INFO - 'download_symbols': 'ondemand', 12:34:12 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:34:12 INFO - 'tooltool.py': '/tools/tooltool.py', 12:34:12 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:34:12 INFO - '/tools/misc-python/virtualenv.py')}, 12:34:12 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:34:12 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:34:12 INFO - 'gecko_profile': False, 12:34:12 INFO - 'gecko_profile_interval': 0, 12:34:12 INFO - 'installer_path': 'installer.exe', 12:34:12 INFO - 'log_level': 'info', 12:34:12 INFO - 'log_name': 'talos', 12:34:12 INFO - 'log_to_console': True, 12:34:12 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:34:12 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:34:12 INFO - 'opt_config_files': (), 12:34:12 INFO - 'pip_index': False, 12:34:12 INFO - 'suite': 'dromaeojs', 12:34:12 INFO - 'system_bits': '32', 12:34:12 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:34:12 INFO - 'title': 'talos-linux64-ix-039', 12:34:12 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:34:12 INFO - 'use_talos_json': True, 12:34:12 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:34:12 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:34:12 INFO - 'work_dir': 'build'} 12:34:12 INFO - [mozharness: 2017-05-10 19:34:12.688350Z] Running clobber step. 12:34:12 INFO - Running pre-action listener: _resource_record_pre_action 12:34:12 INFO - Running main action method: clobber 12:34:12 INFO - rmtree: /builds/slave/test/build 12:34:12 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:34:14 INFO - Running post-action listener: _resource_record_post_action 12:34:14 INFO - [mozharness: 2017-05-10 19:34:14.189354Z] Finished clobber step (success) 12:34:14 INFO - [mozharness: 2017-05-10 19:34:14.189456Z] Running read-buildbot-config step. 12:34:14 INFO - Running pre-action listener: _resource_record_pre_action 12:34:14 INFO - Running main action method: read_buildbot_config 12:34:14 INFO - Using buildbot properties: 12:34:14 INFO - { 12:34:14 INFO - "project": "", 12:34:14 INFO - "product": "firefox", 12:34:14 INFO - "who": "kwierso@gmail.com", 12:34:14 INFO - "installer_path": "public/build/target.tar.bz2", 12:34:14 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 12:34:14 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 12:34:14 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 12:34:14 INFO - "stage_platform": "linux64-pgo", 12:34:14 INFO - "basedir": "/builds/slave/test", 12:34:14 INFO - "buildnumber": 174, 12:34:14 INFO - "platform": "ubuntu64_hw", 12:34:14 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 12:34:14 INFO - "slavebuilddir": "test", 12:34:14 INFO - "taskId": "c1IFlJSnRSeS6BqU1pKnLQ", 12:34:14 INFO - "branch": "mozilla-central", 12:34:14 INFO - "script_repo_revision": "production", 12:34:14 INFO - "revision": "ce2218406119c36a551e3faea4e192186ee46cc5", 12:34:14 INFO - "slavename": "talos-linux64-ix-039", 12:34:14 INFO - "repo_path": "mozilla-central" 12:34:14 INFO - } 12:34:14 INFO - Finding installer, test and symbols from parent task. 12:34:14 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/c1IFlJSnRSeS6BqU1pKnLQ'}, attempt #1 12:34:14 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/c1IFlJSnRSeS6BqU1pKnLQ'}, attempt #1 12:34:15 INFO - Task dependencies: dDZ7T-uyRZ-H7DYWqmfTsw 12:34:15 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw'}, attempt #1 12:34:15 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.tar.bz2 12:34:15 INFO - Set test_url: https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/test_packages.json 12:34:15 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.crashreporter-symbols.zip 12:34:15 INFO - Running post-action listener: _resource_record_post_action 12:34:15 INFO - [mozharness: 2017-05-10 19:34:15.548882Z] Finished read-buildbot-config step (success) 12:34:15 INFO - [mozharness: 2017-05-10 19:34:15.549099Z] Running download-and-extract step. 12:34:15 INFO - Running pre-action listener: _resource_record_pre_action 12:34:15 INFO - Running main action method: download_and_extract 12:34:15 INFO - mkdir: /builds/slave/test/build/tests 12:34:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:15 INFO - trying https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.test_packages.json 12:34:15 INFO - Downloading https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 12:34:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 12:34:16 INFO - Downloaded 986 bytes. 12:34:16 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 12:34:16 INFO - Using the following test package requirements: 12:34:16 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 12:34:16 INFO - u'common': [u'target.common.tests.zip'], 12:34:16 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 12:34:16 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 12:34:16 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 12:34:16 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 12:34:16 INFO - u'mozbase': [u'target.common.tests.zip'], 12:34:16 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 12:34:16 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 12:34:16 INFO - u'web-platform': [u'target.common.tests.zip', 12:34:16 INFO - u'target.web-platform.tests.zip'], 12:34:16 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 12:34:16 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 12:34:16 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.common.tests.zip 12:34:16 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.common.tests.zip'}, attempt #1 12:34:16 INFO - Fetch https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.common.tests.zip into memory 12:34:17 INFO - Content-Length response header: 60738116 12:34:17 INFO - Bytes received: 60738116 12:34:27 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 12:34:27 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.common.tests.zip 12:34:27 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.common.tests.zip'}, attempt #1 12:34:27 INFO - Fetch https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.common.tests.zip into memory 12:34:28 INFO - Content-Length response header: 60738116 12:34:28 INFO - Bytes received: 60738116 12:34:39 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.talos.tests.zip 12:34:39 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 12:34:39 INFO - Fetch https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.talos.tests.zip into memory 12:34:40 INFO - Content-Length response header: 14409362 12:34:40 INFO - Bytes received: 14409362 12:34:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:40 INFO - trying https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.tar.bz2 12:34:40 INFO - Downloading https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 12:34:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 12:34:41 INFO - Downloaded 68585121 bytes. 12:34:41 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.tar.bz2 12:34:41 INFO - mkdir: /builds/slave/test/properties 12:34:41 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:34:41 INFO - Writing to file /builds/slave/test/properties/build_url 12:34:41 INFO - Contents: 12:34:41 INFO - build_url:https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.tar.bz2 12:34:41 INFO - Running post-action listener: _resource_record_post_action 12:34:41 INFO - Running post-action listener: set_extra_try_arguments 12:34:41 INFO - [mozharness: 2017-05-10 19:34:41.501356Z] Finished download-and-extract step (success) 12:34:41 INFO - [mozharness: 2017-05-10 19:34:41.501454Z] Running populate-webroot step. 12:34:41 INFO - Running pre-action listener: _resource_record_pre_action 12:34:41 INFO - Running main action method: populate_webroot 12:34:41 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:34:41 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:34:41 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:34:41 INFO - '--tppagecycles', 12:34:41 INFO - '7'], 12:34:41 INFO - 'tests': ['tsvgm']}}, 12:34:41 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:34:41 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:34:41 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:34:41 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:34:41 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 12:34:41 INFO - 'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:34:41 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 12:34:41 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:34:41 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 12:34:41 INFO - 'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['damp', 'tps']}, 12:34:41 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 12:34:41 INFO - 'tests': ['damp', 'tps']}, 12:34:41 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['dromaeo_dom']}, 12:34:41 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:34:41 INFO - 'g4': {'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 12:34:41 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 12:34:41 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['a11yr', 12:34:41 INFO - 'ts_paint', 12:34:41 INFO - 'tpaint', 12:34:41 INFO - 'sessionrestore', 12:34:41 INFO - 'sessionrestore_no_auto_restore', 12:34:41 INFO - 'tabpaint']}, 12:34:41 INFO - 'other-e10s': {'tests': ['a11yr', 12:34:41 INFO - 'ts_paint', 12:34:41 INFO - 'tpaint', 12:34:41 INFO - 'sessionrestore', 12:34:41 INFO - 'sessionrestore_no_auto_restore', 12:34:41 INFO - 'tabpaint']}, 12:34:41 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:34:41 INFO - 'ts_paint', 12:34:41 INFO - 'tpaint', 12:34:41 INFO - 'sessionrestore', 12:34:41 INFO - 'sessionrestore_no_auto_restore', 12:34:41 INFO - 'tabpaint']}, 12:34:41 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:34:41 INFO - 'ts_paint', 12:34:41 INFO - 'tpaint', 12:34:41 INFO - 'sessionrestore', 12:34:41 INFO - 'sessionrestore_no_auto_restore', 12:34:41 INFO - 'tabpaint']}, 12:34:41 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['a11yr', 12:34:41 INFO - 'ts_paint', 12:34:41 INFO - 'tpaint', 12:34:41 INFO - 'sessionrestore', 12:34:41 INFO - 'sessionrestore_no_auto_restore', 12:34:41 INFO - 'tabpaint']}, 12:34:41 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['a11yr', 12:34:41 INFO - 'ts_paint', 12:34:41 INFO - 'tpaint', 12:34:41 INFO - 'sessionrestore', 12:34:41 INFO - 'sessionrestore_no_auto_restore', 12:34:41 INFO - 'tabpaint']}, 12:34:41 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 12:34:41 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 12:34:41 INFO - 'bloom_basic_ref']}, 12:34:41 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['tsvgx', 12:34:41 INFO - 'tsvgr_opacity', 12:34:41 INFO - 'tart', 12:34:41 INFO - 'tscrollx', 12:34:41 INFO - 'cart', 12:34:41 INFO - 'tsvg_static']}, 12:34:41 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:34:41 INFO - 'tsvgr_opacity', 12:34:41 INFO - 'tart', 12:34:41 INFO - 'tscrollx', 12:34:41 INFO - 'cart', 12:34:41 INFO - 'tsvg_static']}, 12:34:41 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 12:34:41 INFO - 'talos_options': ['--disable-e10s'], 12:34:41 INFO - 'tests': ['tp5o']}, 12:34:41 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 12:34:41 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 12:34:41 INFO - 'talos_options': ['--disable-e10s', 12:34:41 INFO - '--xperf_path', 12:34:41 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:34:41 INFO - 'tests': ['tp5n']}, 12:34:41 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 12:34:41 INFO - 'talos_options': ['--xperf_path', 12:34:41 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:34:41 INFO - 'tests': ['tp5n']}}, 12:34:41 INFO - 'talos.zip': {'path': '', 12:34:41 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:34:41 INFO - Running post-action listener: _resource_record_post_action 12:34:41 INFO - [mozharness: 2017-05-10 19:34:41.515081Z] Finished populate-webroot step (success) 12:34:41 INFO - [mozharness: 2017-05-10 19:34:41.515170Z] Running create-virtualenv step. 12:34:41 INFO - Running pre-action listener: _resource_record_pre_action 12:34:41 INFO - Running main action method: create_virtualenv 12:34:41 INFO - Creating virtualenv /builds/slave/test/build/venv 12:34:41 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 12:34:41 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:34:41 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:34:41 INFO - Using real prefix '/usr' 12:34:41 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:34:42 INFO - Installing distribute.............................................................................................................................................................................................done. 12:34:44 INFO - Installing pip.................done. 12:34:44 INFO - Return code: 0 12:34:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 12:34:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 12:34:44 INFO - Reading from file tmpfile_stdout 12:34:44 INFO - Output received: 12:34:44 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) 12:34:44 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:34:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:44 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 12:34:44 INFO - Using env: {'DISPLAY': ':0', 12:34:44 INFO - 'HOME': '/home/cltbld', 12:34:44 INFO - 'LANG': 'en_US.UTF-8', 12:34:44 INFO - 'LANGUAGE': 'en_US:en', 12:34:44 INFO - 'LOGNAME': 'cltbld', 12:34:44 INFO - 'MAIL': '/var/mail/cltbld', 12:34:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:44 INFO - 'MOZ_NO_REMOTE': '1', 12:34:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:44 INFO - 'NO_EM_RESTART': '1', 12:34:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:44 INFO - 'PWD': '/builds/slave/test', 12:34:44 INFO - 'SHELL': '/bin/bash', 12:34:44 INFO - 'SHLVL': '1', 12:34:44 INFO - 'TERM': 'linux', 12:34:44 INFO - 'TMOUT': '86400', 12:34:44 INFO - 'USER': 'cltbld', 12:34:44 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:44 INFO - '_': '/tools/buildbot/bin/python'} 12:34:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:44 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 12:34:44 INFO - Cleaning up... 12:34:44 INFO - Return code: 0 12:34:44 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:34:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:44 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 12:34:44 INFO - Using env: {'DISPLAY': ':0', 12:34:44 INFO - 'HOME': '/home/cltbld', 12:34:44 INFO - 'LANG': 'en_US.UTF-8', 12:34:44 INFO - 'LANGUAGE': 'en_US:en', 12:34:44 INFO - 'LOGNAME': 'cltbld', 12:34:44 INFO - 'MAIL': '/var/mail/cltbld', 12:34:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:44 INFO - 'MOZ_NO_REMOTE': '1', 12:34:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:44 INFO - 'NO_EM_RESTART': '1', 12:34:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:44 INFO - 'PWD': '/builds/slave/test', 12:34:44 INFO - 'SHELL': '/bin/bash', 12:34:44 INFO - 'SHLVL': '1', 12:34:44 INFO - 'TERM': 'linux', 12:34:44 INFO - 'TMOUT': '86400', 12:34:44 INFO - 'USER': 'cltbld', 12:34:44 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:44 INFO - '_': '/tools/buildbot/bin/python'} 12:34:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:44 INFO - Downloading/unpacking psutil>=3.1.1 12:34:44 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 12:34:44 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 12:34:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:44 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 12:34:44 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 12:34:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:34:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:34:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:34:46 INFO - Installing collected packages: psutil 12:34:46 INFO - Running setup.py install for psutil 12:34:46 INFO - building 'psutil._psutil_linux' extension 12:34:46 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 12:34:46 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 12:34:46 INFO - building 'psutil._psutil_posix' extension 12:34:46 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 12:34:46 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 12:34:46 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:34:46 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:34:46 INFO - Successfully installed psutil 12:34:46 INFO - Cleaning up... 12:34:46 INFO - Return code: 0 12:34:46 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:34:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:46 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 12:34:46 INFO - Using env: {'DISPLAY': ':0', 12:34:46 INFO - 'HOME': '/home/cltbld', 12:34:46 INFO - 'LANG': 'en_US.UTF-8', 12:34:46 INFO - 'LANGUAGE': 'en_US:en', 12:34:46 INFO - 'LOGNAME': 'cltbld', 12:34:46 INFO - 'MAIL': '/var/mail/cltbld', 12:34:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:46 INFO - 'MOZ_NO_REMOTE': '1', 12:34:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:46 INFO - 'NO_EM_RESTART': '1', 12:34:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:46 INFO - 'PWD': '/builds/slave/test', 12:34:46 INFO - 'SHELL': '/bin/bash', 12:34:46 INFO - 'SHLVL': '1', 12:34:46 INFO - 'TERM': 'linux', 12:34:46 INFO - 'TMOUT': '86400', 12:34:46 INFO - 'USER': 'cltbld', 12:34:46 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:46 INFO - '_': '/tools/buildbot/bin/python'} 12:34:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:46 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:34:46 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 12:34:46 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 12:34:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:46 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 12:34:46 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 12:34:47 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:34:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:34:47 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:34:47 INFO - Installing collected packages: mozsystemmonitor 12:34:47 INFO - Running setup.py install for mozsystemmonitor 12:34:47 INFO - Successfully installed mozsystemmonitor 12:34:47 INFO - Cleaning up... 12:34:48 INFO - Return code: 0 12:34:48 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:34:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:48 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 12:34:48 INFO - Using env: {'DISPLAY': ':0', 12:34:48 INFO - 'HOME': '/home/cltbld', 12:34:48 INFO - 'LANG': 'en_US.UTF-8', 12:34:48 INFO - 'LANGUAGE': 'en_US:en', 12:34:48 INFO - 'LOGNAME': 'cltbld', 12:34:48 INFO - 'MAIL': '/var/mail/cltbld', 12:34:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:48 INFO - 'MOZ_NO_REMOTE': '1', 12:34:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:48 INFO - 'NO_EM_RESTART': '1', 12:34:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:48 INFO - 'PWD': '/builds/slave/test', 12:34:48 INFO - 'SHELL': '/bin/bash', 12:34:48 INFO - 'SHLVL': '1', 12:34:48 INFO - 'TERM': 'linux', 12:34:48 INFO - 'TMOUT': '86400', 12:34:48 INFO - 'USER': 'cltbld', 12:34:48 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:48 INFO - '_': '/tools/buildbot/bin/python'} 12:34:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:48 INFO - Downloading/unpacking jsonschema==2.5.1 12:34:48 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 12:34:48 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 12:34:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:48 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 12:34:48 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 12:34:49 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:34:49 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:34:49 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 12:34:49 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 12:34:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:49 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 12:34:49 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 12:34:49 INFO - Downloading functools32-3.2.3-2.tar.gz 12:34:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:34:49 INFO - warning: no files found matching '*.txt' 12:34:49 INFO - no previously-included directories found matching 'build' 12:34:49 INFO - no previously-included directories found matching 'dist' 12:34:49 INFO - no previously-included directories found matching '.git*' 12:34:49 INFO - Installing collected packages: jsonschema, functools32 12:34:49 INFO - Running setup.py install for functools32 12:34:49 INFO - warning: no files found matching '*.txt' 12:34:49 INFO - no previously-included directories found matching 'build' 12:34:49 INFO - no previously-included directories found matching 'dist' 12:34:49 INFO - no previously-included directories found matching '.git*' 12:34:49 INFO - Successfully installed jsonschema functools32 12:34:49 INFO - Cleaning up... 12:34:49 INFO - Return code: 0 12:34:49 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 12:34:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34: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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 12:34:49 INFO - Using env: {'DISPLAY': ':0', 12:34:49 INFO - 'HOME': '/home/cltbld', 12:34:49 INFO - 'LANG': 'en_US.UTF-8', 12:34:49 INFO - 'LANGUAGE': 'en_US:en', 12:34:49 INFO - 'LOGNAME': 'cltbld', 12:34:49 INFO - 'MAIL': '/var/mail/cltbld', 12:34:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:49 INFO - 'MOZ_NO_REMOTE': '1', 12:34:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:49 INFO - 'NO_EM_RESTART': '1', 12:34:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:49 INFO - 'PWD': '/builds/slave/test', 12:34:49 INFO - 'SHELL': '/bin/bash', 12:34:49 INFO - 'SHLVL': '1', 12:34:49 INFO - 'TERM': 'linux', 12:34:49 INFO - 'TMOUT': '86400', 12:34:49 INFO - 'USER': 'cltbld', 12:34:49 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:49 INFO - '_': '/tools/buildbot/bin/python'} 12:34:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:49 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 12:34:49 INFO - Cleaning up... 12:34:49 INFO - Return code: 0 12:34:49 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:34:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34: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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 12:34:49 INFO - Using env: {'DISPLAY': ':0', 12:34:49 INFO - 'HOME': '/home/cltbld', 12:34:49 INFO - 'LANG': 'en_US.UTF-8', 12:34:49 INFO - 'LANGUAGE': 'en_US:en', 12:34:49 INFO - 'LOGNAME': 'cltbld', 12:34:49 INFO - 'MAIL': '/var/mail/cltbld', 12:34:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:49 INFO - 'MOZ_NO_REMOTE': '1', 12:34:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:49 INFO - 'NO_EM_RESTART': '1', 12:34:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:49 INFO - 'PWD': '/builds/slave/test', 12:34:49 INFO - 'SHELL': '/bin/bash', 12:34:49 INFO - 'SHLVL': '1', 12:34:49 INFO - 'TERM': 'linux', 12:34:49 INFO - 'TMOUT': '86400', 12:34:49 INFO - 'USER': 'cltbld', 12:34:49 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:49 INFO - '_': '/tools/buildbot/bin/python'} 12:34:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:50 INFO - Downloading/unpacking blobuploader==1.2.4 12:34:50 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 12:34:50 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 12:34:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:50 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 12:34:50 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 12:34:51 INFO - Downloading blobuploader-1.2.4.tar.gz 12:34:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:34:51 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:34:51 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 12:34:51 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 12:34:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:51 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 12:34:51 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 12:34:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:34:51 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:34:51 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 12:34:51 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 12:34:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:51 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 12:34:51 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 12:34:51 INFO - Downloading docopt-0.6.1.tar.gz 12:34:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:34:51 INFO - Installing collected packages: blobuploader, requests, docopt 12:34:51 INFO - Running setup.py install for blobuploader 12:34:51 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:34:52 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:34:52 INFO - Running setup.py install for requests 12:34:52 INFO - Running setup.py install for docopt 12:34:52 INFO - Successfully installed blobuploader requests docopt 12:34:52 INFO - Cleaning up... 12:34:52 INFO - Return code: 0 12:34:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:34:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:52 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:52 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:52 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:34:52 INFO - Using env: {'DISPLAY': ':0', 12:34:52 INFO - 'HOME': '/home/cltbld', 12:34:52 INFO - 'LANG': 'en_US.UTF-8', 12:34:52 INFO - 'LANGUAGE': 'en_US:en', 12:34:52 INFO - 'LOGNAME': 'cltbld', 12:34:52 INFO - 'MAIL': '/var/mail/cltbld', 12:34:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:52 INFO - 'MOZ_NO_REMOTE': '1', 12:34:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:52 INFO - 'NO_EM_RESTART': '1', 12:34:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:52 INFO - 'PWD': '/builds/slave/test', 12:34:52 INFO - 'SHELL': '/bin/bash', 12:34:52 INFO - 'SHLVL': '1', 12:34:52 INFO - 'TERM': 'linux', 12:34:52 INFO - 'TMOUT': '86400', 12:34:52 INFO - 'USER': 'cltbld', 12:34:52 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:52 INFO - '_': '/tools/buildbot/bin/python'} 12:34:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:34:52 INFO - Running setup.py (path:/tmp/pip-p37e6F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:34:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:34:52 INFO - Running setup.py (path:/tmp/pip-dwygeW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:34:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:34:52 INFO - Running setup.py (path:/tmp/pip-EaAoXF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:34:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:34:52 INFO - Running setup.py (path:/tmp/pip-f2hfub-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:34:53 INFO - Running setup.py (path:/tmp/pip-hZe6Dz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:34:53 INFO - Running setup.py (path:/tmp/pip-8aIzhd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:34:53 INFO - Running setup.py (path:/tmp/pip-eC3Gxb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:34:53 INFO - Running setup.py (path:/tmp/pip-X2VqZb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:34:53 INFO - Running setup.py (path:/tmp/pip-tEeuJp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:34:53 INFO - Running setup.py (path:/tmp/pip-HwewUq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:34:53 INFO - Running setup.py (path:/tmp/pip-LA3QDT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:34:53 INFO - Running setup.py (path:/tmp/pip-ayey5h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:34:53 INFO - Running setup.py (path:/tmp/pip-LbZo8i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:34:53 INFO - Running setup.py (path:/tmp/pip-MO5bLy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:34:53 INFO - Running setup.py (path:/tmp/pip-iP9lUz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:34:53 INFO - Running setup.py (path:/tmp/pip-Mf7ECH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:34:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:34:53 INFO - Running setup.py (path:/tmp/pip-cXVa5w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:34:53 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:34:53 INFO - Running setup.py install for manifestparser 12:34:54 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Running setup.py install for mozcrash 12:34:54 INFO - Running setup.py install for mozdebug 12:34:54 INFO - Running setup.py install for mozdevice 12:34:54 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Running setup.py install for mozfile 12:34:54 INFO - Running setup.py install for mozhttpd 12:34:54 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Running setup.py install for mozinfo 12:34:54 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Running setup.py install for mozInstall 12:34:54 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Running setup.py install for mozleak 12:34:54 INFO - Running setup.py install for mozlog 12:34:54 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:34:54 INFO - Running setup.py install for moznetwork 12:34:55 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:34:55 INFO - Running setup.py install for mozprocess 12:34:55 INFO - Running setup.py install for mozprofile 12:34:55 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:34:55 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:34:55 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:34:55 INFO - Running setup.py install for mozrunner 12:34:55 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:34:55 INFO - Running setup.py install for mozscreenshot 12:34:55 INFO - Running setup.py install for moztest 12:34:55 INFO - Running setup.py install for mozversion 12:34:55 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:34:55 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:34:55 INFO - Cleaning up... 12:34:55 INFO - Return code: 0 12:34:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:34:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:55 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:55 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:55 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:34:55 INFO - Using env: {'DISPLAY': ':0', 12:34:55 INFO - 'HOME': '/home/cltbld', 12:34:55 INFO - 'LANG': 'en_US.UTF-8', 12:34:55 INFO - 'LANGUAGE': 'en_US:en', 12:34:55 INFO - 'LOGNAME': 'cltbld', 12:34:55 INFO - 'MAIL': '/var/mail/cltbld', 12:34:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:55 INFO - 'MOZ_NO_REMOTE': '1', 12:34:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:55 INFO - 'NO_EM_RESTART': '1', 12:34:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:55 INFO - 'PWD': '/builds/slave/test', 12:34:55 INFO - 'SHELL': '/bin/bash', 12:34:55 INFO - 'SHLVL': '1', 12:34:55 INFO - 'TERM': 'linux', 12:34:55 INFO - 'TMOUT': '86400', 12:34:55 INFO - 'USER': 'cltbld', 12:34:55 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:55 INFO - '_': '/tools/buildbot/bin/python'} 12:34:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:34:55 INFO - Running setup.py (path:/tmp/pip-Knbvps-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:34:56 INFO - Running setup.py (path:/tmp/pip-dbvud1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:34:56 INFO - Running setup.py (path:/tmp/pip-1zcdMt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:34:56 INFO - Running setup.py (path:/tmp/pip-ass9Zm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:34:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:34:56 INFO - Running setup.py (path:/tmp/pip-lDJ1zO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:34:56 INFO - Running setup.py (path:/tmp/pip-ao5E54-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:34:56 INFO - Running setup.py (path:/tmp/pip-npEssf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:34:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:34:56 INFO - Running setup.py (path:/tmp/pip-DwjOTP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:34:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:34:56 INFO - Running setup.py (path:/tmp/pip-92Kq_0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:34:56 INFO - Running setup.py (path:/tmp/pip-AgSVdl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:34:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:34:56 INFO - Running setup.py (path:/tmp/pip-9R6_FA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:34:56 INFO - Running setup.py (path:/tmp/pip-lA4Zlt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:34:56 INFO - Running setup.py (path:/tmp/pip-FqCi3k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:34:56 INFO - Running setup.py (path:/tmp/pip-PQ_Jzk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:34:56 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)) 12:34:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:34:56 INFO - Running setup.py (path:/tmp/pip-sbhH4H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:34:57 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)) 12:34:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:34:57 INFO - Running setup.py (path:/tmp/pip-m2pAVv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:34:57 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)) 12:34:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:34:57 INFO - Running setup.py (path:/tmp/pip-tG5lp0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:34:57 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)) 12:34:57 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)) 12:34:57 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)) 12:34:57 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)) 12:34:57 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:34:57 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:34:57 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:34:57 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 12:34:57 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 12:34:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:34:57 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 12:34:57 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 12:34:58 INFO - Downloading blessings-1.6.tar.gz 12:34:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:34:58 INFO - Installing collected packages: blessings 12:34:58 INFO - Running setup.py install for blessings 12:34:58 INFO - Successfully installed blessings 12:34:58 INFO - Cleaning up... 12:34:58 INFO - Return code: 0 12:34:58 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:34:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:34:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:34:58 INFO - Reading from file tmpfile_stdout 12:34:58 INFO - Current package versions: 12:34:58 INFO - argparse == 1.2.1 12:34:58 INFO - blessings == 1.6 12:34:58 INFO - blobuploader == 1.2.4 12:34:58 INFO - docopt == 0.6.1 12:34:58 INFO - functools32 == 3.2.3-2 12:34:58 INFO - jsonschema == 2.5.1 12:34:58 INFO - manifestparser == 1.1 12:34:58 INFO - mozInstall == 1.12 12:34:58 INFO - mozcrash == 1.0 12:34:58 INFO - mozdebug == 0.1 12:34:58 INFO - mozdevice == 0.50 12:34:58 INFO - mozfile == 1.2 12:34:58 INFO - mozhttpd == 0.7 12:34:58 INFO - mozinfo == 0.9 12:34:58 INFO - mozleak == 0.1 12:34:58 INFO - mozlog == 3.4 12:34:58 INFO - moznetwork == 0.27 12:34:58 INFO - mozprocess == 0.25 12:34:58 INFO - mozprofile == 0.28 12:34:58 INFO - mozrunner == 6.13 12:34:58 INFO - mozscreenshot == 0.1 12:34:58 INFO - mozsystemmonitor == 0.3 12:34:58 INFO - moztest == 0.8 12:34:58 INFO - mozversion == 1.4 12:34:58 INFO - psutil == 3.1.1 12:34:58 INFO - requests == 1.2.3 12:34:58 INFO - wsgiref == 0.1.2 12:34:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:34:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:58 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:58 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 12:34:58 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:34:58 INFO - Using env: {'DISPLAY': ':0', 12:34:58 INFO - 'HOME': '/home/cltbld', 12:34:58 INFO - 'LANG': 'en_US.UTF-8', 12:34:58 INFO - 'LANGUAGE': 'en_US:en', 12:34:58 INFO - 'LOGNAME': 'cltbld', 12:34:58 INFO - 'MAIL': '/var/mail/cltbld', 12:34:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:58 INFO - 'MOZ_NO_REMOTE': '1', 12:34:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:58 INFO - 'NO_EM_RESTART': '1', 12:34:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:58 INFO - 'PWD': '/builds/slave/test', 12:34:58 INFO - 'SHELL': '/bin/bash', 12:34:58 INFO - 'SHLVL': '1', 12:34:58 INFO - 'TERM': 'linux', 12:34:58 INFO - 'TMOUT': '86400', 12:34:58 INFO - 'USER': 'cltbld', 12:34:58 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:58 INFO - '_': '/tools/buildbot/bin/python'} 12:34:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 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)) 12:34:58 INFO - Cleaning up... 12:34:58 INFO - Return code: 0 12:34:58 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:34:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:34:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:34:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:34:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:34:58 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1ed01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2242770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, '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': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', '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 12:34:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 12:34:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 12:34:58 INFO - Using env: {'DISPLAY': ':0', 12:34:58 INFO - 'HOME': '/home/cltbld', 12:34:58 INFO - 'LANG': 'en_US.UTF-8', 12:34:58 INFO - 'LANGUAGE': 'en_US:en', 12:34:58 INFO - 'LOGNAME': 'cltbld', 12:34:58 INFO - 'MAIL': '/var/mail/cltbld', 12:34:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:34:58 INFO - 'MOZ_NO_REMOTE': '1', 12:34:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:34:58 INFO - 'NO_EM_RESTART': '1', 12:34:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:34:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:34:58 INFO - 'PWD': '/builds/slave/test', 12:34:58 INFO - 'SHELL': '/bin/bash', 12:34:58 INFO - 'SHLVL': '1', 12:34:58 INFO - 'TERM': 'linux', 12:34:58 INFO - 'TMOUT': '86400', 12:34:58 INFO - 'USER': 'cltbld', 12:34:58 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:34:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:34:58 INFO - '_': '/tools/buildbot/bin/python'} 12:34:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:34:59 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:34:59 INFO - Cleaning up... 12:34:59 INFO - Return code: 0 12:34:59 INFO - Running post-action listener: _resource_record_post_action 12:34:59 INFO - Running post-action listener: _start_resource_monitoring 12:34:59 INFO - Starting resource monitoring. 12:34:59 INFO - [mozharness: 2017-05-10 19:34:59.217202Z] Finished create-virtualenv step (success) 12:34:59 INFO - [mozharness: 2017-05-10 19:34:59.217753Z] Running install step. 12:34:59 INFO - Running pre-action listener: _resource_record_pre_action 12:34:59 INFO - Running main action method: install 12:34:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:34:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:34:59 INFO - Reading from file tmpfile_stdout 12:34:59 INFO - Detecting whether we're running mozinstall >=1.0... 12:34:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:34:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:34:59 INFO - Reading from file tmpfile_stdout 12:34:59 INFO - Output received: 12:34:59 INFO - Usage: mozinstall [options] installer 12:34:59 INFO - Options: 12:34:59 INFO - -h, --help show this help message and exit 12:34:59 INFO - -d DEST, --destination=DEST 12:34:59 INFO - Directory to install application into. [default: 12:34:59 INFO - "/builds/slave/test"] 12:34:59 INFO - --app=APP Application being installed. [default: firefox] 12:34:59 INFO - mkdir: /builds/slave/test/build/application 12:34:59 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'] 12:34:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 12:35:16 INFO - Reading from file tmpfile_stdout 12:35:16 INFO - Output received: 12:35:16 INFO - /builds/slave/test/build/application/firefox/firefox 12:35:16 INFO - Running post-action listener: _resource_record_post_action 12:35:16 INFO - [mozharness: 2017-05-10 19:35:16.601171Z] Finished install step (success) 12:35:16 INFO - [mozharness: 2017-05-10 19:35:16.601487Z] Running run-tests step. 12:35:16 INFO - Running pre-action listener: _resource_record_pre_action 12:35:16 INFO - Running main action method: run_tests 12:35:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:35:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:35:16 INFO - Python 2.7.3 12:35:16 INFO - Return code: 0 12:35:16 INFO - grabbing minidump binary from tooltool 12:35:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 12:35:16 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 0x223fa30>, '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 0x22407f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2240ca0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:35:16 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 12:35:16 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 12:35:16 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 12:35:16 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:35:16 INFO - Return code: 0 12:35:16 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:35:16 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:35:16 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:35:16 INFO - ENV: RUST_BACKTRACE is now 1 12:35:16 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:35:16 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:35:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-039', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 12:35:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-039 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 12:35:16 INFO - Using env: {'DISPLAY': ':0', 12:35:16 INFO - 'HOME': '/home/cltbld', 12:35:16 INFO - 'LANG': 'en_US.UTF-8', 12:35:16 INFO - 'LANGUAGE': 'en_US:en', 12:35:16 INFO - 'LOGNAME': 'cltbld', 12:35:16 INFO - 'MAIL': '/var/mail/cltbld', 12:35:16 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:35:16 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:35:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:35:16 INFO - 'MOZ_NO_REMOTE': '1', 12:35:16 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:35:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:35:16 INFO - 'NO_EM_RESTART': '1', 12:35:16 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:35:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:35:16 INFO - 'PWD': '/builds/slave/test', 12:35:16 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:35:16 INFO - 'RUST_BACKTRACE': '1', 12:35:16 INFO - 'SHELL': '/bin/bash', 12:35:16 INFO - 'SHLVL': '1', 12:35:16 INFO - 'TERM': 'linux', 12:35:16 INFO - 'TMOUT': '86400', 12:35:16 INFO - 'USER': 'cltbld', 12:35:16 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586', 12:35:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:35:16 INFO - '_': '/tools/buildbot/bin/python'} 12:35:16 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-039', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 12:35:16 INFO - mozversion application_buildid: 20170510183120 12:35:16 INFO - mozversion application_changeset: ce2218406119c36a551e3faea4e192186ee46cc5 12:35:16 INFO - mozversion application_display_name: Nightly 12:35:16 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:35:16 INFO - mozversion application_name: Firefox 12:35:16 INFO - mozversion application_remotingname: firefox 12:35:16 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 12:35:16 INFO - mozversion application_vendor: Mozilla 12:35:16 INFO - mozversion application_version: 55.0a1 12:35:16 INFO - mozversion platform_buildid: 20170510183120 12:35:16 INFO - mozversion platform_changeset: ce2218406119c36a551e3faea4e192186ee46cc5 12:35:16 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 12:35:16 INFO - mozversion platform_version: 55.0a1 12:35:16 INFO - using testdate: 1494444916 12:35:16 INFO - actual date: 1494444916 12:35:16 INFO - starting webserver on 'localhost:39358' 12:35:16 INFO - SUITE-START | Running 2 tests 12:35:16 INFO - TEST-START | dromaeo_css 12:35:16 INFO - operating with platform_type : linux_ 12:35:16 INFO - Initialising browser for dromaeo_css test... 12:35:16 INFO - TEST-INFO | started process 21202 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnbkyMI/profile http://localhost:39358/getInfo.html) 12:35:20 INFO - PID 21202 | __metrics Screen width/height:1600/1200 12:35:20 INFO - PID 21202 | colorDepth:24 12:35:20 INFO - PID 21202 | Browser inner width/height: 1024/695 12:35:20 INFO - PID 21202 | __metrics 12:35:21 INFO - PID 21202 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 12:35:21 INFO - PID 21202 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 334: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:35:22 INFO - TEST-INFO | 21202: exit 0 12:35:22 INFO - Browser initialized. 12:35:22 INFO - Running cycle 1/1 for dromaeo_css test... 12:35:22 INFO - TEST-INFO | started process 21304 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnbkyMI/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:35:34 INFO - PID 21304 | RSS: Main: 144429056 12:35:34 INFO - PID 21304 | 12:38:36 INFO - PID 21304 | Cycle 1(1): loaded http://localhost:39358/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39358/tests/dromaeo/cssquery-ext.html) 12:38:39 INFO - PID 21304 | RSS: Main: 370827264 12:38:39 INFO - PID 21304 | 12:41:41 INFO - PID 21304 | Cycle 1(1): loaded http://localhost:39358/tests/dromaeo/cssquery-ext.html (next: http://localhost:39358/tests/dromaeo/cssquery-jquery.html) 12:41:42 INFO - PID 21304 | RSS: Main: 226455552 12:41:42 INFO - PID 21304 | 12:44:43 INFO - PID 21304 | Cycle 1(1): loaded http://localhost:39358/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39358/tests/dromaeo/cssquery-mootools.html) 12:44:44 INFO - PID 21304 | RSS: Main: 179200000 12:44:44 INFO - PID 21304 | 12:47:46 INFO - PID 21304 | Cycle 1(1): loaded http://localhost:39358/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39358/tests/dromaeo/cssquery-prototype.html) 12:47:46 INFO - PID 21304 | RSS: Main: 215343104 12:47:46 INFO - PID 21304 | 12:50:49 INFO - PID 21304 | Cycle 1(1): loaded http://localhost:39358/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39358/tests/dromaeo/cssquery-yui.html) 12:50:50 INFO - PID 21304 | RSS: Main: 178180096 12:50:50 INFO - PID 21304 | 12:53:51 INFO - PID 21304 | Cycle 1(1): loaded http://localhost:39358/tests/dromaeo/cssquery-yui.html (next: http://localhost:39358/tests/dromaeo/cssquery-dojo.html) 12:53:52 INFO - PID 21304 | RSS: Main: 275144704 12:53:52 INFO - PID 21304 | 12:53:52 INFO - PID 21304 | __start_tp_report 12:53:52 INFO - PID 21304 | _x_x_mozilla_page_load 12:53:52 INFO - PID 21304 | _x_x_mozilla_page_load_details 12:53:52 INFO - PID 21304 | |i|pagename|runs| 12:53:52 INFO - PID 21304 | |0;dojo.html;3329.633740288568;3338.4992251162307;3370.0732298617886;3386.475096360065;3399.8300084995744;5629.549636029118;5694.886102277952;5824.970875145629;5867.589268751189;5867.647941123536;5694.829155125353;5740.913886291699;5754.367019627848;5807.216025836511;5887.8233652990475;5143.228515722643;5158;5193.818216362428;5197.532222100011;5237.240600112981;5151.098557752397;5231;5248.68507889526;5315.7873685052555;5322.893542129155;5190.247414124969;5204.037253108149;5261.184516399964;5269.341332333458;5274.683518988873;5100.515451032146;5126.564242039394;5147.279380886679;5169.586433085344;5180.378354597472;5038.168702164138;5044.8234311798915;5045.47022562633;5057.418396884369;5134.1528647773075;5721.971390143022;5741.913871291892;5746.109353050284;5755.539556835443;5797.681127537984;6059.757609695607;6091.238595175603;6092.20582258655;6142.262928448615;6210.813675589739;6337.746490140389;6338.809835704937;6349.809505714836;6355.523335749791;6365.904511432333;5859.1797148399255;5881.617694849864;5903.0555111182;5908.261467316585;5949.167116603722;6142.389484469172;6233.501319894398;6302.905456418157;6420.74317027323;6432.614043157426;6095.908561371583;6104.519788040277;6120.294761999619;6136.929937132656;6150;6294.779682711083;6303.338149494329;6307.211598550181;6308.684565771693;6310.968445157837;6154.261488621394;6277.654728989858;6278.466330361879;6278.497720182374;6293.402126797947;6133.815985520441;6155.261368635793;6192.504599632019;6274.090256912722;6286.465650419766;4763.1426343258545;4766.904661906742;4774.427068751703;4793.592544633675;4809.663323567387;4245.5542168072525;4254.595813397722;4259.212045771542;4260.978695106504;4293.892652683708;5712.971435142797;5738.856528586735;5821.650700957956;5890.49930755882;5939.346671866091;6317.368263173737;6345.17512723343;6377.426031657174;6378;6383.074454204115;5940.34656187819;5947.6431414115295;5947.821565353046;5949.970250148722;6002.519798416116;5384.084705599979;5403.405625381205;5441.863953401117;5527.889442211133;5538.086215774432;6622.072909792537;6646.700898459581;6656.36764507371;6660.966695166687;6665.900011499928;6291.937080629135;6337.6197428154455;6353.205849268841;6369.649669268235;6374;6410.423061924449;6472.190976127984;6515.869682606227;6607.834804129935;6610.305917878553;6124.081387791867;6189.597676151036;6206;6207.96896015517;6214.25428948529;6309.49524038085;6326.778562750282;6333;6334.208223972004;6335.1447554579545;6027.849303767441;6075.210222671025;6128.693565321627;6141.447269745744;6146.877062458815;6055.3944605540855;6088.573799833969;6091.360407157362;6099.75600975956;6102.389761023862;6089.48239399656;6093.817185484442;6102.084687296941;6102.145699602148;6102.298235702773;6055.788047418319;6059.091136329585;6097.058253825582;6098.522998456991;6100.460065610241;6001.879962400815;6004.039353703386;6031.75872965094;6039.124326972652;6049.485793707408 12:53:52 INFO - PID 21304 | |1;ext.html;785.0971382909653;802.2739420824153;1147.4148184425947;1149.6091328948155;1160.9941950290251;34737.30525389494;37781.24437511248;38247.23505529888;38272;38307.61692383082;39491.617793377234;39902.401463978065;39978.60021399785;40019.79990100046;40043.599564004355;5799.159121927318;7414.740484083059;7491.8876216856515;7498.47510674253;7541.358984486298;5890.057590785475;7331.816704582401;7493;7503.7748867534065;7511.924880751178;7580.393568514533;7626.50427722199;7629.65666545004;7631.542107473541;7633.9618301908695;5827.096799996008;7521.435892308099;7567.259530308005;7576.356009739179;7588.165301816795;5901.911471327933;7289.963550182269;7494.362979146779;7494.925050749477;7498.362639175677;36523.452148217795;36854;36870.63129368726;36879;36908.446373304425;3456.9654303457146;3493.5807703075793;3503.194265318991;3503.807290599016;3504.4217704078796;28383.290417739514;28397.57403638947;28412.431751365064;28436.43127137446;28454;3768.943465847987;3772.6793222576116;3778.376567866299;3783.659470647655;3817.7136714746507;180651;181121;181347;181449;182112;42100.789496052326;42465.787671061444;48749.02501949941;48847.511524885005;48975.75512122488;49813.25280120801;50630.17752958383;50862.491375086516;50982.235266471034;51000.74499627552;15656.060636361855;15753.921230394004;15780.526584202493;15784.131872746879;15799.921000394925;12752.234865908074;12786.552470663482;12788.744225115632;12801.359932003548;12839.743205136032;14545.671677439486;14575.635609109646;14603.269836508132;14670.779938300933;14680.3393847275;5634.5210657093785;5716.514096301861;5741.7990370337675;5841.50347220491;5883.264591926009;1067.5196161727254;1089.9073578745738;1094.2777766673958;1114.9888501114885;1122.814735568622;25850.870745646527;25865.353366165997;25964.22107336783;26034.479310413684;26045.218643440727;1202.0549653349156;1202.6271855724754;1211.4730092409654;1225.497546006151;1235.2032938754453;12710.682232944251;13510.054296199369;13577.253251071286;13698.452061917611;13725.725485490433;239177;239393;239783;240560;241270;52007;52583.21125183125;52621.2106818398;52645;52691.47308526943;1497.236409431198;1507.208715424411;1558.7350150474447;1558.7661850722482;1568.2707540993492;23885.76114238905;24944.750552494243;25026.777213582816;25187;25252.621210681486;38635.61364386432;38733.2253354937;38736.22527549489;38747;38761.224775504896;188238;189008;189162;189454;189908;29991.400171996873;30264;32829.179270517474;33703.98888033363;34654.48018279778;40171.39742903917;40839.59160408358;41424.792876036634;41815.58184418117;41978.580214197464;30750.231244219074;30906.845465773426;30956.380872382877;31202.687973119977;32483;31557.52663710092;31685;32371.676283236866;32638.34723305568;32959.340813183124;40383.59616403916;40901.590984090966;40968.59031409648;40980.59019409887;41039.38440923329;32077.839610801795;32111.357772843945;32574;33111.83444082764;33483.83258083694;26247.868760656074;26560.867195663897;26606.334841629116;26669;27151 12:53:52 INFO - PID 21304 | |2;jquery.html;449.7317564468201;456.6757602102507;457.5515994325561;465.96039336656384;478.8491625138081;20004.19983200672;20218.39344819656;20783.792162078375;20899.477513062164;20975.265865694702;21998.560028799413;22051.66922496164;22260.443488912744;22292.8885355573;22293.888530557364;4200.474940632421;5485.149801780721;5700.600957932947;5703.9714801425935;5713.228714123603;5516.089845175541;5646.887062258752;5652.802151924683;5658.094704847225;5661.264035675356;5450.700211488366;5562.3047119110115;5618.971905140468;5625.437456254383;5625.831225063234;5591.1054231323;5596.860078498029;5602.7758889644365;5606.943930560683;5614.606977511576;4994.525520075624;5036.697798132123;5086.745662716849;5097.5667068299235;5103.209002604603;24933.750662493505;24989.250322490356;25136.371590710194;25142;25326.620100698503;2085.176355339632;2141.5823914336556;2163.448320678233;2180.705604743371;2182.236217323924;16701.582460438465;16884.155792210342;16977.3209071637;17085.82914170855;17206.22571984251;2175.8585691929975;2194.1662168375915;2197.483591356046;2215.711957445538;2224.343818573525;107791;109647.90352096537;111034.99999999919;111276;112626;12012.399380030964;12514.499420023098;12573.622791316275;12721.618351449471;12901.290429026307;17954.371596994042;17963.820361796214;17982.550436238937;17982.640347192984;17985.640287194183;9160.8625870612;9312.906870931203;9381.953090234505;9424.717258482257;9478.668246611336;8612.440191387539;8636.222739953435;8672.392932494791;8940.195382415613;8983.101689831095;7801.361714040002;7828.829324123739;8040.71857484997;8149.7147599833725;8175.386845986574;2181.2038605909047;2185.125949620133;2258.1419060756807;2259.5480903819303;2469.3085935937966;1041.57295508841;1054.2040759226734;1081.502508845924;1084.967450976472;1088.0425225801243;20587.794122058887;20602.793972060386;20682.58634827295;20683;20728.378148655564;1060.931039482431;1084.6908631040117;1089.4443833644898;1092.6285063078592;1097.5225776787124;11228.494717737558;11365.261258018369;11402.600908968147;11461.083113351078;11473.139514536277;437618;441350;442161;443713;450959;88661.55669221742;89367.55316223377;89420.5528972364;90425;91121;1180.9173357865038;1203.3261373630794;1244.9937750311371;1246.2958428487875;1248.8189212564128;16639.168041598114;17074.74387884158;17361.30554777795;17523.912380438018;18222.088895555433;42883.571164289206;43391;43643.34534982041;44050.832883395706;44256.11487770291;52046;52724.73637631941;53580;54283.91432171255;55115.44884551103;8908.55457227123;9252.693882232224;9415.2467802577;9515.762105947406;13753.243571603658;13295.872660374294;13542;15020;15446.150461724714;15604.297806598503;12875.935620321838;13296.468141274241;13653.931730341284;13814.792778108538;13836.169829810244;12000.03999680041;12087.214331068453;12147.696307592381;12702;12786.936065319614;13642.522511712043;13656.112352697042;13757.656058598615;13824.792628110788;13949.511767088103;13799.862001379857;13870.514531991332;13986.860131398556;13999.720005599627;14065.367058482598;13564.186148831102;13572.389242483914;13589.932050339685;13644.590662280147;13655.248961307223 12:53:52 INFO - PID 21304 | |3;mootools.html;1191.2911817468603;1296.4166125243642;1324.3444494974988;1341.7797286512368;1358.3547814787978;9689.61241550338;10869.45652717364;11069.335839849615;11141.331520108799;11157.944210278958;10931.836022459669;11005.064569511582;11017.28387654802;11022;11045.723856903582;2028.4725971247508;2107.6627739561673;2146.2595404585395;2186.3659538733828;2190.233418303597;2195.9341219763432;2260.6948062011666;2265.0373591223665;2266.46738016566;2269.909203631861;2173.652215645497;2183.6287831068757;2200.031985926187;2200.0649723867373;2202.053117159621;2140.283005193262;2147.291393840029;2147.366526874568;2148.32327816738;2151.214806595597;2156.3962090614655;2215.1693115081844;2218.1792736687366;2218.4786575154826;2219.1678120704737;11302.095832333476;11326.660200194008;11410.144239182095;11418.257813242113;11429.085673146128;6143.354947730469;6306.653134077624;6324.588901721373;6330.841728956767;6347.365263473662;3604.5494313210847;3669.559652841676;3766.322062028834;3833.750806197616;3841.4621952926614;1319.7954317080869;1325.9602211933657;1368.9178649281075;1412.7315809996069;1420.9218492982882;17392.739108913378;17432.999999999873;17534.736978945326;17537.123143842757;17548.824511754847;5283.867903302371;5487.4238204987905;5618.578606604521;5720.971395143081;5729.398413166641;14284.07153535017;14285.714285714435;14297.85702142986;14298.928505357406;14299.499517516837;6176.845578860564;6523.3150519194805;6566.1135746674545;6568.7372505099265;6576.934230657728;5136.794528218904;5300.681959082467;5862.14998825168;6014.578979471483;6023.69881505923;4374.234508960919;4385.561443855589;4435.933460998088;4509.458864936229;4558.566936141061;1345.4819894340553;1375.628580283318;1383.8270216222973;1401.2013152502975;1408.9718205636034;864.0970186155482;879.5865943006777;889.0886840988039;897.5243121145803;922.4050487435567;7368.852622947511;7514.47398682087;7732.149463559004;7817.296443320129;7839.412044096715;954.370115723619;978.8238117138983;984.5077461269366;985.4826216236534;991.2615101749243;4402.603765661106;4661.86014419568;4691.601213896857;4721.763911804396;4846.29728689338;15105.773413398807;15214.391424343125;15679.372825087097;15750.606234843992;16046.679066418606;15045.172515511533;15280.770788438182;15344.923275383551;15553.066815991077;15591.298391572407;9360.859587106199;9407.90592094084;9516.33385662997;9516.33385662997;9647.71056868295;6784;6818.011388348563;6834.419074378535;6920;6939.791806245821;13484.730305393641;13625.591232263048;13778.173309601456;13823.447062117402;13881.305934703427;13774.862251377357;13886;14107.365168567234;14155.150690958575;14347.56957291283;8146.266835984789;8389.538575378412;9401.482918439551;9691;9695.272854536079;11209.271397359145;11790.469428875893;11815.645530634094;11837.585684501;11840.1711880171;9762.853557196506;9764.218862491125;10066.899331006889;10079.244056695923;10374.844377334497;9803.656872009446;9922.355046921926;9980.101790838859;10160.949195253976;10201.948990255001;8562.443441176303;8613.526256055977;8706.912930870863;8708.564571771512;8710.303175745797;6476.870462590816;6563.113979612882;6581;6584.670766461753;6674.766383176566;6431.774887878902;6465.741370345321;6530.934690653033;6593.604383736991;6613.735450582115 12:53:52 INFO - PID 21304 | |4;prototype.html;398.354665441984;408.45063389740807;420.99999999999983;426.50099383721044;429.8624440179143;5794.5943783935145;5807.912881306784;5830.621009634371;5835;5874.853128671785;5524.917126243109;5667.943320566804;5668.121441176624;5683.5169010634045;5717.828465146042;4356.847510337147;4361.302191649337;4367.759773212472;4372.781360931956;4382.780860956956;4382.386465894777;4384.298512238042;4386.298192289234;4395.472543294809;4415.20526305265;4285.678574106939;4337.457817772778;4351.543087975764;4354.869353919387;4355.499117601469;4326.653867690593;4343.630791382705;4346.369776382423;4359.302511598129;4380;3843.5195600549932;3847.5575308839284;3850.5571859236265;3853.0560012796764;3853.421986702017;5549.528290095347;5550.5282051025715;5572.5263352614675;5643.435656434365;5656.4060773618585;5120.590352771769;5142.6914385137015;5143.459936706629;5145.794168233304;5149.2791009258735;5986.413600395855;6051;6064.848378790522;6072.815800918823;6103.847403814896;4278.807453664593;4310.978445107786;4323.962249060234;4327.891802704958;4342.500612429548;6094.299155597118;6153.415425534612;6247.125402443661;6301.842453938642;6367.235931688181;4379.211741886427;4384.912301753947;4394.692371533962;4399.438199439217;4403.713758605681;4237.533871274158;4338.717983331074;4353.303471444554;4404.564439737011;4468.664850136252;5120.18077107661;5129.435762066169;5137.280780690707;5140;5145.305383773218;6016;6142.539309551801;6147.354527774519;6148.815535533941;6150.692465376714;1514.9242537873063;1522.543237028887;1525.8632318922473;1530.3266562712372;1531.4410240262223;1003.508280942333;1024.5082360467018;1036.8600238967795;1041.8853926068127;1044;5886.264216972879;5887.470127688529;5892.823215303548;5896.646201227854;5915.526757859361;6220;6243.282022567372;6274.247090349188;6312.4634406076;6327.145835312266;5739.794643124907;5840.153177789197;5851.239338885917;5856.238688970492;5889.146073819272;3294.7034766871097;3323.4516304809918;3324.5345651608795;3326.151831283007;3342.4652055671463;6432.807015789534;6456.709448074848;6490.188726409199;6573.1783527059115;6606.438452731475;6350.841228969312;6362.809115726535;6365.2361716594305;6399.840003999844;6400.487960963112;6278.874422511524;6544.363909022744;6558.868822623521;6580.144581204413;6580.901286480611;6290.937090629035;6302.842428939313;6327.430531252209;6333.240011198685;6342.4291813735135;5949.434803693643;6032.728527216198;6100.664463454553;6119.571629985859;6267.341929097562;6574.211094668671;6574.474042076718;6582.144321238208;6621.1392518972225;6646.302138275605;4344.761038142932;4381.824727011011;4397.340398940057;4422;4422.943331350937;6275.121482992476;6306.0272028621675;6308.306086330408;6336.493080553637;6350.555461117678;6021.337652858095;6103.511719062553;6107.389261074035;6109.236345456818;6140.048292514667;6063.484603808725;6085.421884920926;6086.573939824347;6091.9086213707715;6104.908426373697;6090.604110732788;6098.133877077767;6116.877662446637;6118.663473509;6159.969200153971;5944.227250457413;6106.72519736604;6116;6143.877122457615;6145.10895920098;5945.821625351246;5960.821175364746;5961.344252132349;5978.432048955342;5986.401359864153 12:53:52 INFO - PID 21304 | |5;yui.html;846.8518009348362;862.4868203418968;863.7926897544589;869.4174902815113;883.6995421556669;15690.372385104596;16108.75836862448;16122.032678039297;16127.113008784512;16135.838641613595;17940;18037.90981045093;18405.815941840578;18536.721949170773;18579.349722759707;933.6498812945129;954.1412728544296;955.9187469065138;956.0535070280407;956.4500412262942;988.3921388346188;1012.2863381316155;1013.7921726046143;1014.295064929874;1023.9641612543562;1062.5962134388922;1065.0787069185137;1066.9253152279343;1070.6359837655195;1071.7481391872905;1057.6456886942883;1057.8624778778749;1060.6128763001489;1061.098066643347;1061.103367654331;777.9649915753805;782.2490409207168;783.7531177679012;784.262792974602;784.2980532423448;15416.46042388511;15719.92140039304;15895.125768082751;16383.508494745176;16633.334666613322;16625.50123496297;16805.915970420192;16876.66246675072;17028.40400585986;17390.652186956315;13944.651383715489;13963.441462341494;14121;14160.716785664332;14331.85668143326;3275.737940964717;3289.3914625794064;3292.8024318540965;3296.2089098616398;3296.9505457417918;93150.53424732832;93228;93427.53286233525;94143;94177.52911235468;12569.560065397667;12711.300878451773;12974;12996.350182490838;13006.349682515836;24475.38811529726;24624.753752462246;24719.25842224736;24762;24877.62683559748;7921.405894557931;8018.438709290411;8044.6379912902885;8056;8057.59712014397;3777.2823163598828;3853.5183102112237;3854.094287842355;3855;3870.283997460479;4704.317873908264;4853.466118726938;4885.438174609894;4900.338454308694;4902.142125128088;888.2940491238609;908.3913777768911;922.7877588154762;923.3398120343986;926.0276709455045;695.620886616795;713.4827250243532;719.129852878013;729.0704351951199;745.8881167824761;11576.47905844239;12226.694332641577;12698.492060317669;12798.872011279955;12819.935900320439;719.1154879498142;723.3778950102908;729.959852208123;730.3280981497036;738.5162718419443;5058.974705126451;5290.947090529123;5488.53347465462;5589.273394458775;5781.768729250867;71778.64110679414;73106;73695;75167.62416187994;78491.60754196193;62572.374276256654;63725.6715477726;63850.36149638537;65240.673796631665;68956.6552167236;54421;57609.711951439975;58837.705811471526;59623.403765962656;61056;11929;13006.154599950973;13060.355810014808;13088.672783180116;13107.475700972236;31446.371072577964;31697.20756981094;32015;32067.839660801546;32377.514337284487;39100;39306.60693393029;39618.60381396149;39959.40060899147;40218.39672404858;15779.684406312039;15984.360625574847;16085.35658573644;16248.593785155466;16410.589735256715;18190.5452363692;18428.723569146743;18578.628427431104;18698.813011869708;18927.526811829815;16248.67502649964;16281.67436651284;16322.591935201715;16342.428015019417;16695;16191.919040404722;16220.432284869972;16414.917925410773;16759.497215083567;16781;15681.294341754421;15809.367625294859;15861.762073568674;15894.8410515898;16157.838421615634;11605.593804216813;11825.408729563316;11963.401829908296;12106.394680266128;12524.561640342545;12751.094321520717;13413.740686287036;13493.595192144252;13518;13638.863611363759 12:53:52 INFO - PID 21304 | __end_tp_report 12:53:52 INFO - PID 21304 | __start_cc_report 12:53:52 INFO - PID 21304 | _x_x_mozilla_cycle_collect,2587 12:53:52 INFO - PID 21304 | __end_cc_report 12:53:52 INFO - PID 21304 | __startTimestamp1494446032015__endTimestamp 12:53:52 INFO - PID 21304 | 12:53:52 INFO - PID 21304 | ------- Summary: start ------- 12:53:52 INFO - PID 21304 | Number of tests: 6 12:53:52 INFO - PID 21304 | 12:53:52 INFO - PID 21304 | [#0] dojo.html Cycles:165 Average:5793.97 Median:6055.79 stddev:689.41 (11.4%) stddev-sans-first:663.87 12:53:52 INFO - PID 21304 | Values: 3329.6 3338.5 3370.1 3386.5 3399.8 5629.5 5694.9 5825.0 5867.6 5867.6 5694.8 5740.9 5754.4 5807.2 5887.8 5143.2 5158.0 5193.8 5197.5 5237.2 5151.1 5231.0 5248.7 5315.8 5322.9 5190.2 5204.0 5261.2 5269.3 5274.7 5100.5 5126.6 5147.3 5169.6 5180.4 5038.2 5044.8 5045.5 5057.4 5134.2 5722.0 5741.9 5746.1 5755.5 5797.7 6059.8 6091.2 6092.2 6142.3 6210.8 6337.7 6338.8 6349.8 6355.5 6365.9 5859.2 5881.6 5903.1 5908.3 5949.2 6142.4 6233.5 6302.9 6420.7 6432.6 6095.9 6104.5 6120.3 6136.9 6150.0 6294.8 6303.3 6307.2 6308.7 6311.0 6154.3 6277.7 6278.5 6278.5 6293.4 6133.8 6155.3 6192.5 6274.1 6286.5 4763.1 4766.9 4774.4 4793.6 4809.7 4245.6 4254.6 4259.2 4261.0 4293.9 5713.0 5738.9 5821.7 5890.5 5939.3 6317.4 6345.2 6377.4 6378.0 6383.1 5940.3 5947.6 5947.8 5950.0 6002.5 5384.1 5403.4 5441.9 5527.9 5538.1 6622.1 6646.7 6656.4 6661.0 6665.9 6291.9 6337.6 6353.2 6369.6 6374.0 6410.4 6472.2 6515.9 6607.8 6610.3 6124.1 6189.6 6206.0 6208.0 6214.3 6309.5 6326.8 6333.0 6334.2 6335.1 6027.8 6075.2 6128.7 6141.4 6146.9 6055.4 6088.6 6091.4 6099.8 6102.4 6089.5 6093.8 6102.1 6102.1 6102.3 6055.8 6059.1 6097.1 6098.5 6100.5 6001.9 6004.0 6031.8 6039.1 6049.5 12:53:52 INFO - PID 21304 | 12:53:52 INFO - PID 21304 | [#1] ext.html Cycles:180 Average:37222.85 Median:33593.91 stddev:53160.48 (158.2%) stddev-sans-first:53239.20 12:53:52 INFO - PID 21304 | Values: 785.1 802.3 1147.4 1149.6 1161.0 34737.3 37781.2 38247.2 38272.0 38307.6 39491.6 39902.4 39978.6 40019.8 40043.6 5799.2 7414.7 7491.9 7498.5 7541.4 5890.1 7331.8 7493.0 7503.8 7511.9 7580.4 7626.5 7629.7 7631.5 7634.0 5827.1 7521.4 7567.3 7576.4 7588.2 5901.9 7290.0 7494.4 7494.9 7498.4 36523.5 36854.0 36870.6 36879.0 36908.4 3457.0 3493.6 3503.2 3503.8 3504.4 28383.3 28397.6 28412.4 28436.4 28454.0 3768.9 3772.7 3778.4 3783.7 3817.7 180651.0 181121.0 181347.0 181449.0 182112.0 42100.8 42465.8 48749.0 48847.5 48975.8 49813.3 50630.2 50862.5 50982.2 51000.7 15656.1 15753.9 15780.5 15784.1 15799.9 12752.2 12786.6 12788.7 12801.4 12839.7 14545.7 14575.6 14603.3 14670.8 14680.3 5634.5 5716.5 5741.8 5841.5 5883.3 1067.5 1089.9 1094.3 1115.0 1122.8 25850.9 25865.4 25964.2 26034.5 26045.2 1202.1 1202.6 1211.5 1225.5 1235.2 12710.7 13510.1 13577.3 13698.5 13725.7 239177.0 239393.0 239783.0 240560.0 241270.0 52007.0 52583.2 52621.2 52645.0 52691.5 1497.2 1507.2 1558.7 1558.8 1568.3 23885.8 24944.8 25026.8 25187.0 25252.6 38635.6 38733.2 38736.2 38747.0 38761.2 188238.0 189008.0 189162.0 189454.0 189908.0 29991.4 30264.0 32829.2 33704.0 34654.5 40171.4 40839.6 41424.8 41815.6 41978.6 30750.2 30906.8 30956.4 31202.7 32483.0 31557.5 31685.0 32371.7 32638.3 32959.3 40383.6 40901.6 40968.6 40980.6 41039.4 32077.8 32111.4 32574.0 33111.8 33483.8 26247.9 26560.9 26606.3 26669.0 27151.0 12:53:52 INFO - PID 21304 | 12:53:52 INFO - PID 21304 | [#2] jquery.html Cycles:180 Average:29475.26 Median:2180.95 stddev:73798.05 (3383.7%) stddev-sans-first:73972.90 12:53:52 INFO - PID 21304 | Values: 449.7 456.7 457.6 466.0 478.8 20004.2 20218.4 20783.8 20899.5 20975.3 21998.6 22051.7 22260.4 22292.9 22293.9 4200.5 5485.1 5700.6 5704.0 5713.2 5516.1 5646.9 5652.8 5658.1 5661.3 5450.7 5562.3 5619.0 5625.4 5625.8 5591.1 5596.9 5602.8 5606.9 5614.6 4994.5 5036.7 5086.7 5097.6 5103.2 24933.8 24989.3 25136.4 25142.0 25326.6 2085.2 2141.6 2163.4 2180.7 2182.2 16701.6 16884.2 16977.3 17085.8 17206.2 2175.9 2194.2 2197.5 2215.7 2224.3 107791.0 109647.9 111035.0 111276.0 112626.0 12012.4 12514.5 12573.6 12721.6 12901.3 17954.4 17963.8 17982.6 17982.6 17985.6 9160.9 9312.9 9382.0 9424.7 9478.7 8612.4 8636.2 8672.4 8940.2 8983.1 7801.4 7828.8 8040.7 8149.7 8175.4 2181.2 2185.1 2258.1 2259.5 2469.3 1041.6 1054.2 1081.5 1085.0 1088.0 20587.8 20602.8 20682.6 20683.0 20728.4 1060.9 1084.7 1089.4 1092.6 1097.5 11228.5 11365.3 11402.6 11461.1 11473.1 437618.0 441350.0 442161.0 443713.0 450959.0 88661.6 89367.6 89420.6 90425.0 91121.0 1180.9 1203.3 1245.0 1246.3 1248.8 16639.2 17074.7 17361.3 17523.9 18222.1 42883.6 43391.0 43643.3 44050.8 44256.1 52046.0 52724.7 53580.0 54283.9 55115.4 8908.6 9252.7 9415.2 9515.8 13753.2 13295.9 13542.0 15020.0 15446.2 15604.3 12875.9 13296.5 13653.9 13814.8 13836.2 12000.0 12087.2 12147.7 12702.0 12786.9 13642.5 13656.1 13757.7 13824.8 13949.5 13799.9 13870.5 13986.9 13999.7 14065.4 13564.2 13572.4 13589.9 13644.6 13655.2 12:53:52 INFO - PID 21304 | 12:53:52 INFO - PID 21304 | [#3] mootools.html Cycles:180 Average:7331.12 Median:2262.87 stddev:4771.17 (210.8%) stddev-sans-first:4762.24 12:53:52 INFO - PID 21304 | Values: 1191.3 1296.4 1324.3 1341.8 1358.4 9689.6 10869.5 11069.3 11141.3 11157.9 10931.8 11005.1 11017.3 11022.0 11045.7 2028.5 2107.7 2146.3 2186.4 2190.2 2195.9 2260.7 2265.0 2266.5 2269.9 2173.7 2183.6 2200.0 2200.1 2202.1 2140.3 2147.3 2147.4 2148.3 2151.2 2156.4 2215.2 2218.2 2218.5 2219.2 11302.1 11326.7 11410.1 11418.3 11429.1 6143.4 6306.7 6324.6 6330.8 6347.4 3604.5 3669.6 3766.3 3833.8 3841.5 1319.8 1326.0 1368.9 1412.7 1420.9 17392.7 17433.0 17534.7 17537.1 17548.8 5283.9 5487.4 5618.6 5721.0 5729.4 14284.1 14285.7 14297.9 14298.9 14299.5 6176.8 6523.3 6566.1 6568.7 6576.9 5136.8 5300.7 5862.1 6014.6 6023.7 4374.2 4385.6 4435.9 4509.5 4558.6 1345.5 1375.6 1383.8 1401.2 1409.0 864.1 879.6 889.1 897.5 922.4 7368.9 7514.5 7732.1 7817.3 7839.4 954.4 978.8 984.5 985.5 991.3 4402.6 4661.9 4691.6 4721.8 4846.3 15105.8 15214.4 15679.4 15750.6 16046.7 15045.2 15280.8 15344.9 15553.1 15591.3 9360.9 9407.9 9516.3 9516.3 9647.7 6784.0 6818.0 6834.4 6920.0 6939.8 13484.7 13625.6 13778.2 13823.4 13881.3 13774.9 13886.0 14107.4 14155.2 14347.6 8146.3 8389.5 9401.5 9691.0 9695.3 11209.3 11790.5 11815.6 11837.6 11840.2 9762.9 9764.2 10066.9 10079.2 10374.8 9803.7 9922.4 9980.1 10160.9 10201.9 8562.4 8613.5 8706.9 8708.6 8710.3 6476.9 6563.1 6581.0 6584.7 6674.8 6431.8 6465.7 6530.9 6593.6 6613.7 12:53:52 INFO - PID 21304 | 12:53:52 INFO - PID 21304 | [#4] prototype.html Cycles:180 Average:5108.48 Median:5845.70 stddev:1530.21 (26.2%) stddev-sans-first:1493.11 12:53:52 INFO - PID 21304 | Values: 398.4 408.5 421.0 426.5 429.9 5794.6 5807.9 5830.6 5835.0 5874.9 5524.9 5667.9 5668.1 5683.5 5717.8 4356.8 4361.3 4367.8 4372.8 4382.8 4382.4 4384.3 4386.3 4395.5 4415.2 4285.7 4337.5 4351.5 4354.9 4355.5 4326.7 4343.6 4346.4 4359.3 4380.0 3843.5 3847.6 3850.6 3853.1 3853.4 5549.5 5550.5 5572.5 5643.4 5656.4 5120.6 5142.7 5143.5 5145.8 5149.3 5986.4 6051.0 6064.8 6072.8 6103.8 4278.8 4311.0 4324.0 4327.9 4342.5 6094.3 6153.4 6247.1 6301.8 6367.2 4379.2 4384.9 4394.7 4399.4 4403.7 4237.5 4338.7 4353.3 4404.6 4468.7 5120.2 5129.4 5137.3 5140.0 5145.3 6016.0 6142.5 6147.4 6148.8 6150.7 1514.9 1522.5 1525.9 1530.3 1531.4 1003.5 1024.5 1036.9 1041.9 1044.0 5886.3 5887.5 5892.8 5896.6 5915.5 6220.0 6243.3 6274.2 6312.5 6327.1 5739.8 5840.2 5851.2 5856.2 5889.1 3294.7 3323.5 3324.5 3326.2 3342.5 6432.8 6456.7 6490.2 6573.2 6606.4 6350.8 6362.8 6365.2 6399.8 6400.5 6278.9 6544.4 6558.9 6580.1 6580.9 6290.9 6302.8 6327.4 6333.2 6342.4 5949.4 6032.7 6100.7 6119.6 6267.3 6574.2 6574.5 6582.1 6621.1 6646.3 4344.8 4381.8 4397.3 4422.0 4422.9 6275.1 6306.0 6308.3 6336.5 6350.6 6021.3 6103.5 6107.4 6109.2 6140.0 6063.5 6085.4 6086.6 6091.9 6104.9 6090.6 6098.1 6116.9 6118.7 6160.0 5944.2 6106.7 6116.0 6143.9 6145.1 5945.8 5960.8 5961.3 5978.4 5986.4 12:53:52 INFO - PID 21304 | 12:53:52 INFO - PID 21304 | [#5] yui.html Cycles:180 Average:18036.80 Median:24672.01 stddev:21861.15 (88.6%) stddev-sans-first:21884.36 12:53:52 INFO - PID 21304 | Values: 846.9 862.5 863.8 869.4 883.7 15690.4 16108.8 16122.0 16127.1 16135.8 17940.0 18037.9 18405.8 18536.7 18579.3 933.6 954.1 955.9 956.1 956.5 988.4 1012.3 1013.8 1014.3 1024.0 1062.6 1065.1 1066.9 1070.6 1071.7 1057.6 1057.9 1060.6 1061.1 1061.1 778.0 782.2 783.8 784.3 784.3 15416.5 15719.9 15895.1 16383.5 16633.3 16625.5 16805.9 16876.7 17028.4 17390.7 13944.7 13963.4 14121.0 14160.7 14331.9 3275.7 3289.4 3292.8 3296.2 3297.0 93150.5 93228.0 93427.5 94143.0 94177.5 12569.6 12711.3 12974.0 12996.4 13006.3 24475.4 24624.8 24719.3 24762.0 24877.6 7921.4 8018.4 8044.6 8056.0 8057.6 3777.3 3853.5 3854.1 3855.0 3870.3 4704.3 4853.5 4885.4 4900.3 4902.1 888.3 908.4 922.8 923.3 926.0 695.6 713.5 719.1 729.1 745.9 11576.5 12226.7 12698.5 12798.9 12819.9 719.1 723.4 730.0 730.3 738.5 5059.0 5290.9 5488.5 5589.3 5781.8 71778.6 73106.0 73695.0 75167.6 78491.6 62572.4 63725.7 63850.4 65240.7 68956.7 54421.0 57609.7 58837.7 59623.4 61056.0 11929.0 13006.2 13060.4 13088.7 13107.5 31446.4 31697.2 32015.0 32067.8 32377.5 39100.0 39306.6 39618.6 39959.4 40218.4 15779.7 15984.4 16085.4 16248.6 16410.6 18190.5 18428.7 18578.6 18698.8 18927.5 16248.7 16281.7 16322.6 16342.4 16695.0 16191.9 16220.4 16414.9 16759.5 16781.0 15681.3 15809.4 15861.8 15894.8 16157.8 11605.6 11825.4 11963.4 12106.4 12524.6 12751.1 13413.7 13493.6 13518.0 13638.9 12:53:52 INFO - PID 21304 | -------- Summary: end -------- 12:53:52 INFO - PID 21304 | 12:53:52 INFO - TEST-INFO | 21304: exit 0 12:53:52 INFO - TEST-OK | dromaeo_css | took 1115967ms 12:53:52 INFO - TEST-START | kraken 12:53:52 INFO - operating with platform_type : linux_ 12:53:52 INFO - Initialising browser for kraken test... 12:53:52 INFO - TEST-INFO | started process 21633 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpvpB0gT/profile http://localhost:39358/getInfo.html) 12:53:56 INFO - PID 21633 | __metrics Screen width/height:1600/1200 12:53:56 INFO - PID 21633 | colorDepth:24 12:53:56 INFO - PID 21633 | Browser inner width/height: 1024/695 12:53:56 INFO - PID 21633 | __metrics 12:53:57 INFO - PID 21633 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 12:53:57 INFO - PID 21633 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 334: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:53:58 INFO - TEST-INFO | 21633: exit 0 12:53:58 INFO - Browser initialized. 12:53:58 INFO - Running cycle 1/1 for kraken test... 12:53:58 INFO - TEST-INFO | started process 21734 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpvpB0gT/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:54:10 INFO - PID 21734 | RSS: Main: 144932864 12:54:10 INFO - PID 21734 | 12:54:13 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39358/tests/kraken/driver.html?testName=audio-beat-detection) 12:54:13 INFO - PID 21734 | RSS: Main: 217661440 12:54:13 INFO - PID 21734 | 12:54:16 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39358/tests/kraken/driver.html?testName=audio-dft) 12:54:17 INFO - PID 21734 | RSS: Main: 178761728 12:54:17 INFO - PID 21734 | 12:54:19 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39358/tests/kraken/driver.html?testName=audio-fft) 12:54:20 INFO - PID 21734 | RSS: Main: 258551808 12:54:20 INFO - PID 21734 | 12:54:22 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39358/tests/kraken/driver.html?testName=audio-oscillator) 12:54:23 INFO - PID 21734 | RSS: Main: 169947136 12:54:23 INFO - PID 21734 | 12:54:25 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39358/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:54:25 INFO - PID 21734 | RSS: Main: 173277184 12:54:25 INFO - PID 21734 | 12:54:28 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39358/tests/kraken/driver.html?testName=imaging-darkroom) 12:54:29 INFO - PID 21734 | RSS: Main: 230469632 12:54:29 INFO - PID 21734 | 12:54:32 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39358/tests/kraken/driver.html?testName=imaging-desaturate) 12:54:33 INFO - PID 21734 | RSS: Main: 249225216 12:54:33 INFO - PID 21734 | 12:54:36 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39358/tests/kraken/driver.html?testName=json-parse-financial) 12:54:36 INFO - PID 21734 | RSS: Main: 264241152 12:54:36 INFO - PID 21734 | 12:54:38 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39358/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:54:38 INFO - PID 21734 | RSS: Main: 197963776 12:54:38 INFO - PID 21734 | 12:54:40 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39358/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:54:41 INFO - PID 21734 | RSS: Main: 203862016 12:54:41 INFO - PID 21734 | 12:54:43 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39358/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:54:43 INFO - PID 21734 | RSS: Main: 213041152 12:54:43 INFO - PID 21734 | 12:54:46 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39358/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:54:46 INFO - PID 21734 | RSS: Main: 221368320 12:54:46 INFO - PID 21734 | 12:54:49 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39358/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:54:50 INFO - PID 21734 | RSS: Main: 216653824 12:54:50 INFO - PID 21734 | 12:54:51 INFO - PID 21734 | Cycle 1(1): loaded http://localhost:39358/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39358/tests/kraken/driver.html?testName=ai-astar) 12:54:52 INFO - PID 21734 | RSS: Main: 266801152 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | __start_tp_report 12:54:52 INFO - PID 21734 | _x_x_mozilla_page_load 12:54:52 INFO - PID 21734 | _x_x_mozilla_page_load_details 12:54:52 INFO - PID 21734 | |i|pagename|runs| 12:54:52 INFO - PID 21734 | |0;ai-astar;110;111;109;111;111;110;109;108;108;109 12:54:52 INFO - PID 21734 | |1;audio-beat-detection;153;117;117;161;117;116;115;116;140;118 12:54:52 INFO - PID 21734 | |2;audio-dft;161;161;162;162;163;162;161;161;161;160 12:54:52 INFO - PID 21734 | |3;audio-fft;73;74;73;106;73;76;74;76;92;74 12:54:52 INFO - PID 21734 | |4;audio-oscillator;82;82;98;82;82;82;94;83;83;115 12:54:52 INFO - PID 21734 | |5;imaging-gaussian-blur;113;113;113;112;113;113;113;113;113;113 12:54:52 INFO - PID 21734 | |6;imaging-darkroom;147;147;147;146;147;146;147;148;147;148 12:54:52 INFO - PID 21734 | |7;imaging-desaturate;94;94;94;94;94;94;94;93;94;93 12:54:52 INFO - PID 21734 | |8;json-parse-financial;46;46;46;46;47;48;48;47;48;48 12:54:52 INFO - PID 21734 | |9;json-stringify-tinderbox;55;54;55;54;56;55;55;55;55;54 12:54:52 INFO - PID 21734 | |10;stanford-crypto-aes;78;80;78;79;79;78;78;80;79;79 12:54:52 INFO - PID 21734 | |11;stanford-crypto-ccm;125;123;124;125;130;121;123;122;172;129 12:54:52 INFO - PID 21734 | |12;stanford-crypto-pbkdf2;175;179;177;168;176;181;179;186;178;190 12:54:52 INFO - PID 21734 | |13;stanford-crypto-sha256-iterative;66;65;64;66;66;66;64;64;63;64 12:54:52 INFO - PID 21734 | __end_tp_report 12:54:52 INFO - PID 21734 | __start_cc_report 12:54:52 INFO - PID 21734 | _x_x_mozilla_cycle_collect,1702 12:54:52 INFO - PID 21734 | __end_cc_report 12:54:52 INFO - PID 21734 | __startTimestamp1494446092219__endTimestamp 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | ------- Summary: start ------- 12:54:52 INFO - PID 21734 | Number of tests: 14 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#0] ai-astar Cycles:10 Average:109.60 Median:110.00 stddev:1.17 (1.1%) stddev-sans-first:1.24 12:54:52 INFO - PID 21734 | Values: 110.0 111.0 109.0 111.0 111.0 110.0 109.0 108.0 108.0 109.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#1] audio-beat-detection Cycles:10 Average:127.00 Median:117.50 stddev:17.54 (14.9%) stddev-sans-first:15.88 12:54:52 INFO - PID 21734 | Values: 153.0 117.0 117.0 161.0 117.0 116.0 115.0 116.0 140.0 118.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#2] audio-dft Cycles:10 Average:161.40 Median:161.50 stddev:0.84 (0.5%) stddev-sans-first:0.88 12:54:52 INFO - PID 21734 | Values: 161.0 161.0 162.0 162.0 163.0 162.0 161.0 161.0 161.0 160.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#3] audio-fft Cycles:10 Average:79.10 Median:74.00 stddev:11.05 (14.9%) stddev-sans-first:11.50 12:54:52 INFO - PID 21734 | Values: 73.0 74.0 73.0 106.0 73.0 76.0 74.0 76.0 92.0 74.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#4] audio-oscillator Cycles:10 Average:88.30 Median:82.50 stddev:11.03 (13.4%) stddev-sans-first:11.46 12:54:52 INFO - PID 21734 | Values: 82.0 82.0 98.0 82.0 82.0 82.0 94.0 83.0 83.0 115.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#5] imaging-gaussian-blur Cycles:10 Average:112.90 Median:113.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 12:54:52 INFO - PID 21734 | Values: 113.0 113.0 113.0 112.0 113.0 113.0 113.0 113.0 113.0 113.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 12:54:52 INFO - PID 21734 | Values: 147.0 147.0 147.0 146.0 147.0 146.0 147.0 148.0 147.0 148.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#7] imaging-desaturate Cycles:10 Average:93.80 Median:94.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 12:54:52 INFO - PID 21734 | Values: 94.0 94.0 94.0 94.0 94.0 94.0 94.0 93.0 94.0 93.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#8] json-parse-financial Cycles:10 Average:47.00 Median:47.50 stddev:0.94 (2.0%) stddev-sans-first:0.93 12:54:52 INFO - PID 21734 | Values: 46.0 46.0 46.0 46.0 47.0 48.0 48.0 47.0 48.0 48.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#9] json-stringify-tinderbox Cycles:10 Average:54.80 Median:55.00 stddev:0.63 (1.1%) stddev-sans-first:0.67 12:54:52 INFO - PID 21734 | Values: 55.0 54.0 55.0 54.0 56.0 55.0 55.0 55.0 55.0 54.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#10] stanford-crypto-aes Cycles:10 Average:78.80 Median:79.00 stddev:0.79 (1.0%) stddev-sans-first:0.78 12:54:52 INFO - PID 21734 | Values: 78.0 80.0 78.0 79.0 79.0 78.0 78.0 80.0 79.0 79.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#11] stanford-crypto-ccm Cycles:10 Average:129.40 Median:125.00 stddev:15.24 (12.2%) stddev-sans-first:16.08 12:54:52 INFO - PID 21734 | Values: 125.0 123.0 124.0 125.0 130.0 121.0 123.0 122.0 172.0 129.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:178.90 Median:179.00 stddev:6.01 (3.4%) stddev-sans-first:6.20 12:54:52 INFO - PID 21734 | Values: 175.0 179.0 177.0 168.0 176.0 181.0 179.0 186.0 178.0 190.0 12:54:52 INFO - PID 21734 | 12:54:52 INFO - PID 21734 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.80 Median:65.50 stddev:1.14 (1.7%) stddev-sans-first:1.12 12:54:52 INFO - PID 21734 | Values: 66.0 65.0 64.0 66.0 66.0 66.0 64.0 64.0 63.0 64.0 12:54:52 INFO - PID 21734 | -------- Summary: end -------- 12:54:52 INFO - PID 21734 | 12:54:53 INFO - TEST-INFO | 21734: exit 0 12:54:53 INFO - TEST-OK | kraken | took 60465ms 12:54:53 INFO - SUITE-END | took 1176s 12:54:53 INFO - Completed test suite (00:19:36) 12:54:53 INFO - javascript benchmark 12:54:53 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7677.104700025206, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3329.633740288568, 3338.4992251162307, 3370.0732298617886, 3386.475096360065, 3399.8300084995744, 5629.549636029118, 5694.886102277952, 5824.970875145629, 5867.589268751189, 5867.647941123536, 5694.829155125353, 5740.913886291699, 5754.367019627848, 5807.216025836511, 5887.8233652990475, 5143.228515722643, 5158.0, 5193.818216362428, 5197.532222100011, 5237.240600112981, 5151.098557752397, 5231.0, 5248.68507889526, 5315.7873685052555, 5322.893542129155, 5190.247414124969, 5204.037253108149, 5261.184516399964, 5269.341332333458, 5274.683518988873, 5100.515451032146, 5126.564242039394, 5147.279380886679, 5169.586433085344, 5180.378354597472, 5038.168702164138, 5044.8234311798915, 5045.47022562633, 5057.418396884369, 5134.1528647773075, 5721.971390143022, 5741.913871291892, 5746.109353050284, 5755.539556835443, 5797.681127537984, 6059.757609695607, 6091.238595175603, 6092.20582258655, 6142.262928448615, 6210.813675589739, 6337.746490140389, 6338.809835704937, 6349.809505714836, 6355.523335749791, 6365.904511432333, 5859.1797148399255, 5881.617694849864, 5903.0555111182, 5908.261467316585, 5949.167116603722, 6142.389484469172, 6233.501319894398, 6302.905456418157, 6420.74317027323, 6432.614043157426, 6095.908561371583, 6104.519788040277, 6120.294761999619, 6136.929937132656, 6150.0, 6294.779682711083, 6303.338149494329, 6307.211598550181, 6308.684565771693, 6310.968445157837, 6154.261488621394, 6277.654728989858, 6278.466330361879, 6278.497720182374, 6293.402126797947, 6133.815985520441, 6155.261368635793, 6192.504599632019, 6274.090256912722, 6286.465650419766, 4763.1426343258545, 4766.904661906742, 4774.427068751703, 4793.592544633675, 4809.663323567387, 4245.5542168072525, 4254.595813397722, 4259.212045771542, 4260.978695106504, 4293.892652683708, 5712.971435142797, 5738.856528586735, 5821.650700957956, 5890.49930755882, 5939.346671866091, 6317.368263173737, 6345.17512723343, 6377.426031657174, 6378.0, 6383.074454204115, 5940.34656187819, 5947.6431414115295, 5947.821565353046, 5949.970250148722, 6002.519798416116, 5384.084705599979, 5403.405625381205, 5441.863953401117, 5527.889442211133, 5538.086215774432, 6622.072909792537, 6646.700898459581, 6656.36764507371, 6660.966695166687, 6665.900011499928, 6291.937080629135, 6337.6197428154455, 6353.205849268841, 6369.649669268235, 6374.0, 6410.423061924449, 6472.190976127984, 6515.869682606227, 6607.834804129935, 6610.305917878553, 6124.081387791867, 6189.597676151036, 6206.0, 6207.96896015517, 6214.25428948529, 6309.49524038085, 6326.778562750282, 6333.0, 6334.208223972004, 6335.1447554579545, 6027.849303767441, 6075.210222671025, 6128.693565321627, 6141.447269745744, 6146.877062458815, 6055.3944605540855, 6088.573799833969, 6091.360407157362, 6099.75600975956, 6102.389761023862, 6089.48239399656, 6093.817185484442, 6102.084687296941, 6102.145699602148, 6102.298235702773, 6055.788047418319, 6059.091136329585, 6097.058253825582, 6098.522998456991, 6100.460065610241, 6001.879962400815, 6004.039353703386, 6031.75872965094, 6039.124326972652, 6049.485793707408], "value": 5745.77061559544, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [785.0971382909653, 802.2739420824153, 1147.4148184425947, 1149.6091328948155, 1160.9941950290251, 34737.30525389494, 37781.24437511248, 38247.23505529888, 38272.0, 38307.61692383082, 39491.617793377234, 39902.401463978065, 39978.60021399785, 40019.79990100046, 40043.599564004355, 5799.159121927318, 7414.740484083059, 7491.8876216856515, 7498.47510674253, 7541.358984486298, 5890.057590785475, 7331.816704582401, 7493.0, 7503.7748867534065, 7511.924880751178, 7580.393568514533, 7626.50427722199, 7629.65666545004, 7631.542107473541, 7633.9618301908695, 5827.096799996008, 7521.435892308099, 7567.259530308005, 7576.356009739179, 7588.165301816795, 5901.911471327933, 7289.963550182269, 7494.362979146779, 7494.925050749477, 7498.362639175677, 36523.452148217795, 36854.0, 36870.63129368726, 36879.0, 36908.446373304425, 3456.9654303457146, 3493.5807703075793, 3503.194265318991, 3503.807290599016, 3504.4217704078796, 28383.290417739514, 28397.57403638947, 28412.431751365064, 28436.43127137446, 28454.0, 3768.943465847987, 3772.6793222576116, 3778.376567866299, 3783.659470647655, 3817.7136714746507, 180651.0, 181121.0, 181347.0, 181449.0, 182112.0, 42100.789496052326, 42465.787671061444, 48749.02501949941, 48847.511524885005, 48975.75512122488, 49813.25280120801, 50630.17752958383, 50862.491375086516, 50982.235266471034, 51000.74499627552, 15656.060636361855, 15753.921230394004, 15780.526584202493, 15784.131872746879, 15799.921000394925, 12752.234865908074, 12786.552470663482, 12788.744225115632, 12801.359932003548, 12839.743205136032, 14545.671677439486, 14575.635609109646, 14603.269836508132, 14670.779938300933, 14680.3393847275, 5634.5210657093785, 5716.514096301861, 5741.7990370337675, 5841.50347220491, 5883.264591926009, 1067.5196161727254, 1089.9073578745738, 1094.2777766673958, 1114.9888501114885, 1122.814735568622, 25850.870745646527, 25865.353366165997, 25964.22107336783, 26034.479310413684, 26045.218643440727, 1202.0549653349156, 1202.6271855724754, 1211.4730092409654, 1225.497546006151, 1235.2032938754453, 12710.682232944251, 13510.054296199369, 13577.253251071286, 13698.452061917611, 13725.725485490433, 239177.0, 239393.0, 239783.0, 240560.0, 241270.0, 52007.0, 52583.21125183125, 52621.2106818398, 52645.0, 52691.47308526943, 1497.236409431198, 1507.208715424411, 1558.7350150474447, 1558.7661850722482, 1568.2707540993492, 23885.76114238905, 24944.750552494243, 25026.777213582816, 25187.0, 25252.621210681486, 38635.61364386432, 38733.2253354937, 38736.22527549489, 38747.0, 38761.224775504896, 188238.0, 189008.0, 189162.0, 189454.0, 189908.0, 29991.400171996873, 30264.0, 32829.179270517474, 33703.98888033363, 34654.48018279778, 40171.39742903917, 40839.59160408358, 41424.792876036634, 41815.58184418117, 41978.580214197464, 30750.231244219074, 30906.845465773426, 30956.380872382877, 31202.687973119977, 32483.0, 31557.52663710092, 31685.0, 32371.676283236866, 32638.34723305568, 32959.340813183124, 40383.59616403916, 40901.590984090966, 40968.59031409648, 40980.59019409887, 41039.38440923329, 32077.839610801795, 32111.357772843945, 32574.0, 33111.83444082764, 33483.83258083694, 26247.868760656074, 26560.867195663897, 26606.334841629116, 26669.0, 27151.0], "value": 17086.145892692704, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [449.7317564468201, 456.6757602102507, 457.5515994325561, 465.96039336656384, 478.8491625138081, 20004.19983200672, 20218.39344819656, 20783.792162078375, 20899.477513062164, 20975.265865694702, 21998.560028799413, 22051.66922496164, 22260.443488912744, 22292.8885355573, 22293.888530557364, 4200.474940632421, 5485.149801780721, 5700.600957932947, 5703.9714801425935, 5713.228714123603, 5516.089845175541, 5646.887062258752, 5652.802151924683, 5658.094704847225, 5661.264035675356, 5450.700211488366, 5562.3047119110115, 5618.971905140468, 5625.437456254383, 5625.831225063234, 5591.1054231323, 5596.860078498029, 5602.7758889644365, 5606.943930560683, 5614.606977511576, 4994.525520075624, 5036.697798132123, 5086.745662716849, 5097.5667068299235, 5103.209002604603, 24933.750662493505, 24989.250322490356, 25136.371590710194, 25142.0, 25326.620100698503, 2085.176355339632, 2141.5823914336556, 2163.448320678233, 2180.705604743371, 2182.236217323924, 16701.582460438465, 16884.155792210342, 16977.3209071637, 17085.82914170855, 17206.22571984251, 2175.8585691929975, 2194.1662168375915, 2197.483591356046, 2215.711957445538, 2224.343818573525, 107791.0, 109647.90352096537, 111034.99999999919, 111276.0, 112626.0, 12012.399380030964, 12514.499420023098, 12573.622791316275, 12721.618351449471, 12901.290429026307, 17954.371596994042, 17963.820361796214, 17982.550436238937, 17982.640347192984, 17985.640287194183, 9160.8625870612, 9312.906870931203, 9381.953090234505, 9424.717258482257, 9478.668246611336, 8612.440191387539, 8636.222739953435, 8672.392932494791, 8940.195382415613, 8983.101689831095, 7801.361714040002, 7828.829324123739, 8040.71857484997, 8149.7147599833725, 8175.386845986574, 2181.2038605909047, 2185.125949620133, 2258.1419060756807, 2259.5480903819303, 2469.3085935937966, 1041.57295508841, 1054.2040759226734, 1081.502508845924, 1084.967450976472, 1088.0425225801243, 20587.794122058887, 20602.793972060386, 20682.58634827295, 20683.0, 20728.378148655564, 1060.931039482431, 1084.6908631040117, 1089.4443833644898, 1092.6285063078592, 1097.5225776787124, 11228.494717737558, 11365.261258018369, 11402.600908968147, 11461.083113351078, 11473.139514536277, 437618.0, 441350.0, 442161.0, 443713.0, 450959.0, 88661.55669221742, 89367.55316223377, 89420.5528972364, 90425.0, 91121.0, 1180.9173357865038, 1203.3261373630794, 1244.9937750311371, 1246.2958428487875, 1248.8189212564128, 16639.168041598114, 17074.74387884158, 17361.30554777795, 17523.912380438018, 18222.088895555433, 42883.571164289206, 43391.0, 43643.34534982041, 44050.832883395706, 44256.11487770291, 52046.0, 52724.73637631941, 53580.0, 54283.91432171255, 55115.44884551103, 8908.55457227123, 9252.693882232224, 9415.2467802577, 9515.762105947406, 13753.243571603658, 13295.872660374294, 13542.0, 15020.0, 15446.150461724714, 15604.297806598503, 12875.935620321838, 13296.468141274241, 13653.931730341284, 13814.792778108538, 13836.169829810244, 12000.03999680041, 12087.214331068453, 12147.696307592381, 12702.0, 12786.936065319614, 13642.522511712043, 13656.112352697042, 13757.656058598615, 13824.792628110788, 13949.511767088103, 13799.862001379857, 13870.514531991332, 13986.860131398556, 13999.720005599627, 14065.367058482598, 13564.186148831102, 13572.389242483914, 13589.932050339685, 13644.590662280147, 13655.248961307223], "value": 10272.983122470703, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1191.2911817468603, 1296.4166125243642, 1324.3444494974988, 1341.7797286512368, 1358.3547814787978, 9689.61241550338, 10869.45652717364, 11069.335839849615, 11141.331520108799, 11157.944210278958, 10931.836022459669, 11005.064569511582, 11017.28387654802, 11022.0, 11045.723856903582, 2028.4725971247508, 2107.6627739561673, 2146.2595404585395, 2186.3659538733828, 2190.233418303597, 2195.9341219763432, 2260.6948062011666, 2265.0373591223665, 2266.46738016566, 2269.909203631861, 2173.652215645497, 2183.6287831068757, 2200.031985926187, 2200.0649723867373, 2202.053117159621, 2140.283005193262, 2147.291393840029, 2147.366526874568, 2148.32327816738, 2151.214806595597, 2156.3962090614655, 2215.1693115081844, 2218.1792736687366, 2218.4786575154826, 2219.1678120704737, 11302.095832333476, 11326.660200194008, 11410.144239182095, 11418.257813242113, 11429.085673146128, 6143.354947730469, 6306.653134077624, 6324.588901721373, 6330.841728956767, 6347.365263473662, 3604.5494313210847, 3669.559652841676, 3766.322062028834, 3833.750806197616, 3841.4621952926614, 1319.7954317080869, 1325.9602211933657, 1368.9178649281075, 1412.7315809996069, 1420.9218492982882, 17392.739108913378, 17432.999999999873, 17534.736978945326, 17537.123143842757, 17548.824511754847, 5283.867903302371, 5487.4238204987905, 5618.578606604521, 5720.971395143081, 5729.398413166641, 14284.07153535017, 14285.714285714435, 14297.85702142986, 14298.928505357406, 14299.499517516837, 6176.845578860564, 6523.3150519194805, 6566.1135746674545, 6568.7372505099265, 6576.934230657728, 5136.794528218904, 5300.681959082467, 5862.14998825168, 6014.578979471483, 6023.69881505923, 4374.234508960919, 4385.561443855589, 4435.933460998088, 4509.458864936229, 4558.566936141061, 1345.4819894340553, 1375.628580283318, 1383.8270216222973, 1401.2013152502975, 1408.9718205636034, 864.0970186155482, 879.5865943006777, 889.0886840988039, 897.5243121145803, 922.4050487435567, 7368.852622947511, 7514.47398682087, 7732.149463559004, 7817.296443320129, 7839.412044096715, 954.370115723619, 978.8238117138983, 984.5077461269366, 985.4826216236534, 991.2615101749243, 4402.603765661106, 4661.86014419568, 4691.601213896857, 4721.763911804396, 4846.29728689338, 15105.773413398807, 15214.391424343125, 15679.372825087097, 15750.606234843992, 16046.679066418606, 15045.172515511533, 15280.770788438182, 15344.923275383551, 15553.066815991077, 15591.298391572407, 9360.859587106199, 9407.90592094084, 9516.33385662997, 9516.33385662997, 9647.71056868295, 6784.0, 6818.011388348563, 6834.419074378535, 6920.0, 6939.791806245821, 13484.730305393641, 13625.591232263048, 13778.173309601456, 13823.447062117402, 13881.305934703427, 13774.862251377357, 13886.0, 14107.365168567234, 14155.150690958575, 14347.56957291283, 8146.266835984789, 8389.538575378412, 9401.482918439551, 9691.0, 9695.272854536079, 11209.271397359145, 11790.469428875893, 11815.645530634094, 11837.585684501, 11840.1711880171, 9762.853557196506, 9764.218862491125, 10066.899331006889, 10079.244056695923, 10374.844377334497, 9803.656872009446, 9922.355046921926, 9980.101790838859, 10160.949195253976, 10201.948990255001, 8562.443441176303, 8613.526256055977, 8706.912930870863, 8708.564571771512, 8710.303175745797, 6476.870462590816, 6563.113979612882, 6581.0, 6584.670766461753, 6674.766383176566, 6431.774887878902, 6465.741370345321, 6530.934690653033, 6593.604383736991, 6613.735450582115], "value": 5452.598346608938, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [398.354665441984, 408.45063389740807, 420.99999999999983, 426.50099383721044, 429.8624440179143, 5794.5943783935145, 5807.912881306784, 5830.621009634371, 5835.0, 5874.853128671785, 5524.917126243109, 5667.943320566804, 5668.121441176624, 5683.5169010634045, 5717.828465146042, 4356.847510337147, 4361.302191649337, 4367.759773212472, 4372.781360931956, 4382.780860956956, 4382.386465894777, 4384.298512238042, 4386.298192289234, 4395.472543294809, 4415.20526305265, 4285.678574106939, 4337.457817772778, 4351.543087975764, 4354.869353919387, 4355.499117601469, 4326.653867690593, 4343.630791382705, 4346.369776382423, 4359.302511598129, 4380.0, 3843.5195600549932, 3847.5575308839284, 3850.5571859236265, 3853.0560012796764, 3853.421986702017, 5549.528290095347, 5550.5282051025715, 5572.5263352614675, 5643.435656434365, 5656.4060773618585, 5120.590352771769, 5142.6914385137015, 5143.459936706629, 5145.794168233304, 5149.2791009258735, 5986.413600395855, 6051.0, 6064.848378790522, 6072.815800918823, 6103.847403814896, 4278.807453664593, 4310.978445107786, 4323.962249060234, 4327.891802704958, 4342.500612429548, 6094.299155597118, 6153.415425534612, 6247.125402443661, 6301.842453938642, 6367.235931688181, 4379.211741886427, 4384.912301753947, 4394.692371533962, 4399.438199439217, 4403.713758605681, 4237.533871274158, 4338.717983331074, 4353.303471444554, 4404.564439737011, 4468.664850136252, 5120.18077107661, 5129.435762066169, 5137.280780690707, 5140.0, 5145.305383773218, 6016.0, 6142.539309551801, 6147.354527774519, 6148.815535533941, 6150.692465376714, 1514.9242537873063, 1522.543237028887, 1525.8632318922473, 1530.3266562712372, 1531.4410240262223, 1003.508280942333, 1024.5082360467018, 1036.8600238967795, 1041.8853926068127, 1044.0, 5886.264216972879, 5887.470127688529, 5892.823215303548, 5896.646201227854, 5915.526757859361, 6220.0, 6243.282022567372, 6274.247090349188, 6312.4634406076, 6327.145835312266, 5739.794643124907, 5840.153177789197, 5851.239338885917, 5856.238688970492, 5889.146073819272, 3294.7034766871097, 3323.4516304809918, 3324.5345651608795, 3326.151831283007, 3342.4652055671463, 6432.807015789534, 6456.709448074848, 6490.188726409199, 6573.1783527059115, 6606.438452731475, 6350.841228969312, 6362.809115726535, 6365.2361716594305, 6399.840003999844, 6400.487960963112, 6278.874422511524, 6544.363909022744, 6558.868822623521, 6580.144581204413, 6580.901286480611, 6290.937090629035, 6302.842428939313, 6327.430531252209, 6333.240011198685, 6342.4291813735135, 5949.434803693643, 6032.728527216198, 6100.664463454553, 6119.571629985859, 6267.341929097562, 6574.211094668671, 6574.474042076718, 6582.144321238208, 6621.1392518972225, 6646.302138275605, 4344.761038142932, 4381.824727011011, 4397.340398940057, 4422.0, 4422.943331350937, 6275.121482992476, 6306.0272028621675, 6308.306086330408, 6336.493080553637, 6350.555461117678, 6021.337652858095, 6103.511719062553, 6107.389261074035, 6109.236345456818, 6140.048292514667, 6063.484603808725, 6085.421884920926, 6086.573939824347, 6091.9086213707715, 6104.908426373697, 6090.604110732788, 6098.133877077767, 6116.877662446637, 6118.663473509, 6159.969200153971, 5944.227250457413, 6106.72519736604, 6116.0, 6143.877122457615, 6145.10895920098, 5945.821625351246, 5960.821175364746, 5961.344252132349, 5978.432048955342, 5986.401359864153], "value": 4636.171084073854, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [846.8518009348362, 862.4868203418968, 863.7926897544589, 869.4174902815113, 883.6995421556669, 15690.372385104596, 16108.75836862448, 16122.032678039297, 16127.113008784512, 16135.838641613595, 17940.0, 18037.90981045093, 18405.815941840578, 18536.721949170773, 18579.349722759707, 933.6498812945129, 954.1412728544296, 955.9187469065138, 956.0535070280407, 956.4500412262942, 988.3921388346188, 1012.2863381316155, 1013.7921726046143, 1014.295064929874, 1023.9641612543562, 1062.5962134388922, 1065.0787069185137, 1066.9253152279343, 1070.6359837655195, 1071.7481391872905, 1057.6456886942883, 1057.8624778778749, 1060.6128763001489, 1061.098066643347, 1061.103367654331, 777.9649915753805, 782.2490409207168, 783.7531177679012, 784.262792974602, 784.2980532423448, 15416.46042388511, 15719.92140039304, 15895.125768082751, 16383.508494745176, 16633.334666613322, 16625.50123496297, 16805.915970420192, 16876.66246675072, 17028.40400585986, 17390.652186956315, 13944.651383715489, 13963.441462341494, 14121.0, 14160.716785664332, 14331.85668143326, 3275.737940964717, 3289.3914625794064, 3292.8024318540965, 3296.2089098616398, 3296.9505457417918, 93150.53424732832, 93228.0, 93427.53286233525, 94143.0, 94177.52911235468, 12569.560065397667, 12711.300878451773, 12974.0, 12996.350182490838, 13006.349682515836, 24475.38811529726, 24624.753752462246, 24719.25842224736, 24762.0, 24877.62683559748, 7921.405894557931, 8018.438709290411, 8044.6379912902885, 8056.0, 8057.59712014397, 3777.2823163598828, 3853.5183102112237, 3854.094287842355, 3855.0, 3870.283997460479, 4704.317873908264, 4853.466118726938, 4885.438174609894, 4900.338454308694, 4902.142125128088, 888.2940491238609, 908.3913777768911, 922.7877588154762, 923.3398120343986, 926.0276709455045, 695.620886616795, 713.4827250243532, 719.129852878013, 729.0704351951199, 745.8881167824761, 11576.47905844239, 12226.694332641577, 12698.492060317669, 12798.872011279955, 12819.935900320439, 719.1154879498142, 723.3778950102908, 729.959852208123, 730.3280981497036, 738.5162718419443, 5058.974705126451, 5290.947090529123, 5488.53347465462, 5589.273394458775, 5781.768729250867, 71778.64110679414, 73106.0, 73695.0, 75167.62416187994, 78491.60754196193, 62572.374276256654, 63725.6715477726, 63850.36149638537, 65240.673796631665, 68956.6552167236, 54421.0, 57609.711951439975, 58837.705811471526, 59623.403765962656, 61056.0, 11929.0, 13006.154599950973, 13060.355810014808, 13088.672783180116, 13107.475700972236, 31446.371072577964, 31697.20756981094, 32015.0, 32067.839660801546, 32377.514337284487, 39100.0, 39306.60693393029, 39618.60381396149, 39959.40060899147, 40218.39672404858, 15779.684406312039, 15984.360625574847, 16085.35658573644, 16248.593785155466, 16410.589735256715, 18190.5452363692, 18428.723569146743, 18578.628427431104, 18698.813011869708, 18927.526811829815, 16248.67502649964, 16281.67436651284, 16322.591935201715, 16342.428015019417, 16695.0, 16191.919040404722, 16220.432284869972, 16414.917925410773, 16759.497215083567, 16781.0, 15681.294341754421, 15809.367625294859, 15861.762073568674, 15894.8410515898, 16157.838421615634, 11605.593804216813, 11825.408729563316, 11963.401829908296, 12106.394680266128, 12524.561640342545, 12751.094321520717, 13413.740686287036, 13493.595192144252, 13518.0, 13638.863611363759], "value": 8029.741991742406, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1472.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 111.0, 109.0, 111.0, 111.0, 110.0, 109.0, 108.0, 108.0, 109.0], "value": 109.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 117.0, 117.0, 161.0, 117.0, 116.0, 115.0, 116.0, 140.0, 118.0], "value": 127.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 162.0, 162.0, 163.0, 162.0, 161.0, 161.0, 161.0, 160.0], "value": 161.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 74.0, 73.0, 106.0, 73.0, 76.0, 74.0, 76.0, 92.0, 74.0], "value": 79.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 82.0, 98.0, 82.0, 82.0, 82.0, 94.0, 83.0, 83.0, 115.0], "value": 88.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 113.0, 113.0, 112.0, 113.0, 113.0, 113.0, 113.0, 113.0, 113.0], "value": 112.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 147.0, 146.0, 147.0, 146.0, 147.0, 148.0, 147.0, 148.0], "value": 147.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 93.0, 94.0, 93.0], "value": 93.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [46.0, 46.0, 46.0, 46.0, 47.0, 48.0, 48.0, 47.0, 48.0, 48.0], "value": 47.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 54.0, 55.0, 54.0, 56.0, 55.0, 55.0, 55.0, 55.0, 54.0], "value": 54.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 80.0, 78.0, 79.0, 79.0, 78.0, 78.0, 80.0, 79.0, 79.0], "value": 78.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [125.0, 123.0, 124.0, 125.0, 130.0, 121.0, 123.0, 122.0, 172.0, 129.0], "value": 129.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [175.0, 179.0, 177.0, 168.0, 176.0, 181.0, 179.0, 186.0, 178.0, 190.0], "value": 178.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 65.0, 64.0, 66.0, 66.0, 66.0, 64.0, 64.0, 63.0, 64.0], "value": 64.8, "unit": "score"}]}]} 12:54:53 INFO - Return code: 0 12:54:53 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 12:54:53 INFO - # TBPL SUCCESS # 12:54:53 INFO - Running post-action listener: _resource_record_post_action 12:54:53 INFO - [mozharness: 2017-05-10 19:54:53.544793Z] Finished run-tests step (success) 12:54:53 INFO - Running post-run listener: _resource_record_post_run 12:54:53 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 8192; Write bytes: 379592704; Read time: 108; Write time: 337632 12:54:53 INFO - TinderboxPrint: CPU usage
12.9% 12:54:53 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 108 12:54:53 INFO - TinderboxPrint: I/O write bytes / time
379,592,704 / 337,632 12:54:53 INFO - TinderboxPrint: CPU idle
8,301.0 (87.1%) 12:54:53 INFO - TinderboxPrint: CPU user
1,184.5 (12.4%) 12:54:53 INFO - TinderboxPrint: Swap in / out
0 / 0 12:54:53 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 113938432; Read time: 0; Write time: 105624 12:54:53 INFO - run-tests - Wall time: 1177s; CPU: 13.0%; Read bytes: 4096; Write bytes: 265076736; Read time: 92; Write time: 231980 12:54:54 INFO - Running post-run listener: _upload_blobber_files 12:54:54 INFO - Blob upload gear active. 12:54:54 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:54:54 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 12:54:54 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', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 12:54:54 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 Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 12:54:54 INFO - Traceback (most recent call last): 12:54:54 INFO - File "/builds/slave/test/build/venv/bin/blobberc.py", line 253, in 12:54:54 INFO - main() 12:54:54 INFO - File "/builds/slave/test/build/venv/bin/blobberc.py", line 232, in main 12:54:54 INFO - execfile(args['--auth'], credentials) 12:54:54 INFO - File "/builds/slave/test/oauth.txt", line 30 12:54:54 INFO - 'win7_vm_devedition' """w1nd3rs""",: 12:54:54 INFO - ^ 12:54:54 INFO - SyntaxError: invalid syntax 12:54:54 ERROR - Return code: 1 12:54:54 INFO - Setting buildbot property blobber_files to {} 12:54:54 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:54:54 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:54:54 INFO - Contents: 12:54:54 INFO - blobber_files:{} 12:54:54 INFO - Running post-run listener: copy_logs_to_upload_dir 12:54:54 INFO - Copying logs to upload dir... 12:54:54 INFO - mkdir: /builds/slave/test/build/upload/logs 12:54:54 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.751755 ========= master_lag: 0.41 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2017-05-10 12:54:54.343589) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-10 12:54:54.347724) ========= 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=5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{} build_url:https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011325 build_url: 'https://queue.taskcluster.net/v1/task/dDZ7T-uyRZ-H7DYWqmfTsw/artifacts/public/build/target.tar.bz2' blobber_files: '{}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-10 12:54:54.372438) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 12:54:54.372722) ========= 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=5bd038846534b2fdfa68eeae000001e2-1494444850.47974-1135115586 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004610 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-10 12:54:54.424080) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-10 12:54:54.426451) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-10 12:54:54.426750) ========= ========= Total master_lag: 0.53 =========