builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-086 starttime: 1491407743.81 results: success (0) revision: 720b9177c6856c1c4339d0fac1bf5149c0d53950 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:43.811568) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:43.812133) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:43.812550) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:43.828227) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:43.828607) ========= 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=438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-04-05 08:55:43-- 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% 224M=0s 2017-04-05 08:55:44 (224 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.105353 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:43.951228) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:43.952018) ========= 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=438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019421 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:44.003819) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:44.004179) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 720b9177c6856c1c4339d0fac1bf5149c0d53950 --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 720b9177c6856c1c4339d0fac1bf5149c0d53950 --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=438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-04-05 08:55:44,196 truncating revision to first 12 chars 2017-04-05 08:55:44,196 Setting DEBUG logging. 2017-04-05 08:55:44,196 attempt 1/10 2017-04-05 08:55:44,196 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/720b9177c685?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-04-05 08:55:44,834 unpacking tar archive at: mozilla-central-720b9177c685/testing/mozharness/ program finished with exit code 0 elapsedTime=0.945166 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:44.963945) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:44.964308) ========= script_repo_revision: 720b9177c6856c1c4339d0fac1bf5149c0d53950 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:44.964803) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:44.965112) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-05 08:55:44.976096) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2017-04-05 08:55:44.976401) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:55:45 INFO - MultiFileLogger online at 20170405 08:55:45 in /builds/slave/test 08:55:45 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 08:55:45 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:55:45 INFO - {'append_to_log': False, 08:55:45 INFO - 'base_work_dir': '/builds/slave/test', 08:55:45 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 08:55:45 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:55:45 INFO - 'branch': 'Firefox-Non-PGO', 08:55:45 INFO - 'buildbot_json_path': 'buildprops.json', 08:55:45 INFO - 'config_files': ('talos/linux_config.py',), 08:55:45 INFO - 'default_actions': ('clobber', 08:55:45 INFO - 'read-buildbot-config', 08:55:45 INFO - 'download-and-extract', 08:55:45 INFO - 'populate-webroot', 08:55:45 INFO - 'create-virtualenv', 08:55:45 INFO - 'install', 08:55:45 INFO - 'run-tests'), 08:55:45 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:55:45 INFO - 'download_minidump_stackwalk': True, 08:55:45 INFO - 'download_symbols': 'ondemand', 08:55:45 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:55:45 INFO - 'tooltool.py': '/tools/tooltool.py', 08:55:45 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:55:45 INFO - '/tools/misc-python/virtualenv.py')}, 08:55:45 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:55:45 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:55:45 INFO - 'gecko_profile': False, 08:55:45 INFO - 'gecko_profile_interval': 0, 08:55:45 INFO - 'installer_path': 'installer.exe', 08:55:45 INFO - 'log_level': 'info', 08:55:45 INFO - 'log_name': 'talos', 08:55:45 INFO - 'log_to_console': True, 08:55:45 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:55:45 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:55:45 INFO - 'opt_config_files': (), 08:55:45 INFO - 'pip_index': False, 08:55:45 INFO - 'suite': 'dromaeojs', 08:55:45 INFO - 'system_bits': '32', 08:55:45 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:55:45 INFO - 'title': 'talos-linux64-ix-086', 08:55:45 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:55:45 INFO - 'use_talos_json': True, 08:55:45 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:55:45 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:55:45 INFO - 'work_dir': 'build'} 08:55:45 INFO - [mozharness: 2017-04-05 15:55:45.268465Z] Running clobber step. 08:55:45 INFO - Running pre-action listener: _resource_record_pre_action 08:55:45 INFO - Running main action method: clobber 08:55:45 INFO - rmtree: /builds/slave/test/build 08:55:45 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:55:46 INFO - Running post-action listener: _resource_record_post_action 08:55:46 INFO - [mozharness: 2017-04-05 15:55:46.796817Z] Finished clobber step (success) 08:55:46 INFO - [mozharness: 2017-04-05 15:55:46.796916Z] Running read-buildbot-config step. 08:55:46 INFO - Running pre-action listener: _resource_record_pre_action 08:55:46 INFO - Running main action method: read_buildbot_config 08:55:46 INFO - Using buildbot properties: 08:55:46 INFO - { 08:55:46 INFO - "project": "", 08:55:46 INFO - "product": "firefox", 08:55:46 INFO - "who": "ffxbld@noreply.mozilla.org", 08:55:46 INFO - "installer_path": "public/build/target.tar.bz2", 08:55:46 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 08:55:46 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 08:55:46 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 08:55:46 INFO - "stage_platform": "linux64", 08:55:46 INFO - "basedir": "/builds/slave/test", 08:55:46 INFO - "buildnumber": 919, 08:55:46 INFO - "platform": "ubuntu64_hw", 08:55:46 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:55:46 INFO - "slavebuilddir": "test", 08:55:46 INFO - "taskId": "VRZV2_GqTcuxfAclSLFkTQ", 08:55:46 INFO - "branch": "mozilla-central", 08:55:46 INFO - "script_repo_revision": "production", 08:55:46 INFO - "revision": "720b9177c6856c1c4339d0fac1bf5149c0d53950", 08:55:46 INFO - "slavename": "talos-linux64-ix-086", 08:55:46 INFO - "repo_path": "mozilla-central" 08:55:46 INFO - } 08:55:46 INFO - Finding installer, test and symbols from parent task. 08:55:46 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VRZV2_GqTcuxfAclSLFkTQ'}, attempt #1 08:55:47 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VRZV2_GqTcuxfAclSLFkTQ'}, attempt #1 08:55:47 INFO - Task dependencies: W5ZZZIO2S4ugsa0nQ1ms-A 08:55:47 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A'}, attempt #1 08:55:48 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.tar.bz2 08:55:48 INFO - Set test_url: https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/test_packages.json 08:55:48 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.crashreporter-symbols.zip 08:55:48 INFO - Running post-action listener: _resource_record_post_action 08:55:48 INFO - [mozharness: 2017-04-05 15:55:48.354247Z] Finished read-buildbot-config step (success) 08:55:48 INFO - [mozharness: 2017-04-05 15:55:48.354465Z] Running download-and-extract step. 08:55:48 INFO - Running pre-action listener: _resource_record_pre_action 08:55:48 INFO - Running main action method: download_and_extract 08:55:48 INFO - mkdir: /builds/slave/test/build/tests 08:55: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')]} 08:55:48 INFO - trying https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.test_packages.json 08:55:48 INFO - Downloading https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 08:55:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 08:55:48 INFO - Downloaded 986 bytes. 08:55:48 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 08:55:48 INFO - Using the following test package requirements: 08:55:48 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 08:55:48 INFO - u'common': [u'target.common.tests.zip'], 08:55:48 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 08:55:48 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 08:55:48 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 08:55:48 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 08:55:48 INFO - u'mozbase': [u'target.common.tests.zip'], 08:55:48 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 08:55:48 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 08:55:48 INFO - u'web-platform': [u'target.common.tests.zip', 08:55:48 INFO - u'target.web-platform.tests.zip'], 08:55:48 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 08:55:48 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 08:55:48 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.common.tests.zip 08:55:48 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:55:48 INFO - Fetch https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.common.tests.zip into memory 08:55:50 INFO - Expected file size: 58238931 08:55:50 INFO - Obtained file size: 58238931 08:55:59 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 08:55:59 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.common.tests.zip 08:55:59 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:55:59 INFO - Fetch https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.common.tests.zip into memory 08:56:01 INFO - Expected file size: 58238931 08:56:01 INFO - Obtained file size: 58238931 08:56:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.talos.tests.zip 08:56:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.talos.tests.zip'}, attempt #1 08:56:11 INFO - Fetch https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.talos.tests.zip into memory 08:56:12 INFO - Expected file size: 14404152 08:56:12 INFO - Obtained file size: 14404152 08:56:13 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')]} 08:56:13 INFO - trying https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.tar.bz2 08:56:13 INFO - Downloading https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 08:56:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 08:56:14 INFO - Downloaded 57552224 bytes. 08:56:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.tar.bz2 08:56:14 INFO - mkdir: /builds/slave/test/properties 08:56:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:56:14 INFO - Writing to file /builds/slave/test/properties/build_url 08:56:14 INFO - Contents: 08:56:14 INFO - build_url:https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.tar.bz2 08:56:14 INFO - Running post-action listener: _resource_record_post_action 08:56:14 INFO - Running post-action listener: set_extra_try_arguments 08:56:14 INFO - [mozharness: 2017-04-05 15:56:14.488678Z] Finished download-and-extract step (success) 08:56:14 INFO - [mozharness: 2017-04-05 15:56:14.488801Z] Running populate-webroot step. 08:56:14 INFO - Running pre-action listener: _resource_record_pre_action 08:56:14 INFO - Running main action method: populate_webroot 08:56:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:56:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:56:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:56:14 INFO - '--tppagecycles', 08:56:14 INFO - '7'], 08:56:14 INFO - 'tests': ['tsvgm']}}, 08:56:14 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:56:14 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:56:14 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:56:14 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:56:14 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 08:56:14 INFO - 'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:56:14 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:56:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:56:14 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 08:56:14 INFO - 'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['damp', 'tps']}, 08:56:14 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:56:14 INFO - 'tests': ['damp', 'tps']}, 08:56:14 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['dromaeo_dom']}, 08:56:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:56:14 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['basic_compositor_video']}, 08:56:14 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:56:14 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['a11yr', 08:56:14 INFO - 'ts_paint', 08:56:14 INFO - 'tpaint', 08:56:14 INFO - 'sessionrestore', 08:56:14 INFO - 'sessionrestore_no_auto_restore', 08:56:14 INFO - 'tabpaint']}, 08:56:14 INFO - 'other-e10s': {'tests': ['a11yr', 08:56:14 INFO - 'ts_paint', 08:56:14 INFO - 'tpaint', 08:56:14 INFO - 'sessionrestore', 08:56:14 INFO - 'sessionrestore_no_auto_restore', 08:56:14 INFO - 'tabpaint']}, 08:56:14 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:56:14 INFO - 'ts_paint', 08:56:14 INFO - 'tpaint', 08:56:14 INFO - 'sessionrestore', 08:56:14 INFO - 'sessionrestore_no_auto_restore', 08:56:14 INFO - 'tabpaint']}, 08:56:14 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:56:14 INFO - 'ts_paint', 08:56:14 INFO - 'tpaint', 08:56:14 INFO - 'sessionrestore', 08:56:14 INFO - 'sessionrestore_no_auto_restore', 08:56:14 INFO - 'tabpaint']}, 08:56:14 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['a11yr', 08:56:14 INFO - 'ts_paint', 08:56:14 INFO - 'tpaint', 08:56:14 INFO - 'sessionrestore', 08:56:14 INFO - 'sessionrestore_no_auto_restore', 08:56:14 INFO - 'tabpaint']}, 08:56:14 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['a11yr', 08:56:14 INFO - 'ts_paint', 08:56:14 INFO - 'tpaint', 08:56:14 INFO - 'sessionrestore', 08:56:14 INFO - 'sessionrestore_no_auto_restore', 08:56:14 INFO - 'tabpaint']}, 08:56:14 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['tsvgx', 08:56:14 INFO - 'tsvgr_opacity', 08:56:14 INFO - 'tart', 08:56:14 INFO - 'tscrollx', 08:56:14 INFO - 'cart', 08:56:14 INFO - 'tsvg_static']}, 08:56:14 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:56:14 INFO - 'tsvgr_opacity', 08:56:14 INFO - 'tart', 08:56:14 INFO - 'tscrollx', 08:56:14 INFO - 'cart', 08:56:14 INFO - 'tsvg_static']}, 08:56:14 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 08:56:14 INFO - 'talos_options': ['--disable-e10s'], 08:56:14 INFO - 'tests': ['tp5o']}, 08:56:14 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:56:14 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 08:56:14 INFO - 'talos_options': ['--disable-e10s', 08:56:14 INFO - '--xperf_path', 08:56:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:56:14 INFO - 'tests': ['tp5n']}, 08:56:14 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:56:14 INFO - 'talos_options': ['--xperf_path', 08:56:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:56:14 INFO - 'tests': ['tp5n']}}, 08:56:14 INFO - 'talos.zip': {'path': '', 08:56:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:56:14 INFO - Running post-action listener: _resource_record_post_action 08:56:14 INFO - [mozharness: 2017-04-05 15:56:14.503734Z] Finished populate-webroot step (success) 08:56:14 INFO - [mozharness: 2017-04-05 15:56:14.503823Z] Running create-virtualenv step. 08:56:14 INFO - Running pre-action listener: _resource_record_pre_action 08:56:14 INFO - Running main action method: create_virtualenv 08:56:14 INFO - Creating virtualenv /builds/slave/test/build/venv 08:56:14 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 08:56:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:56:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:56:14 INFO - Using real prefix '/usr' 08:56:14 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:56:15 INFO - Installing distribute.............................................................................................................................................................................................done. 08:56:17 INFO - Installing pip.................done. 08:56:17 INFO - Return code: 0 08:56:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:56:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:56:17 INFO - Reading from file tmpfile_stdout 08:56:17 INFO - Output received: 08:56:17 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) 08:56:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:56:17 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')]} 08:56:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:17 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')]} 08:56:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:17 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:17 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 08:56:17 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 08:56:17 INFO - Using env: {'DISPLAY': ':0', 08:56:17 INFO - 'HOME': '/home/cltbld', 08:56:17 INFO - 'LANG': 'en_US.UTF-8', 08:56:17 INFO - 'LANGUAGE': 'en_US:en', 08:56:17 INFO - 'LOGNAME': 'cltbld', 08:56:17 INFO - 'MAIL': '/var/mail/cltbld', 08:56:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:17 INFO - 'MOZ_NO_REMOTE': '1', 08:56:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:17 INFO - 'NO_EM_RESTART': '1', 08:56:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:17 INFO - 'PWD': '/builds/slave/test', 08:56:17 INFO - 'SHELL': '/bin/bash', 08:56:17 INFO - 'SHLVL': '1', 08:56:17 INFO - 'TERM': 'linux', 08:56:17 INFO - 'TMOUT': '86400', 08:56:17 INFO - 'USER': 'cltbld', 08:56:17 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:17 INFO - '_': '/tools/buildbot/bin/python'} 08:56:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:17 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 08:56:17 INFO - Cleaning up... 08:56:17 INFO - Return code: 0 08:56:17 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:56:17 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')]} 08:56:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:17 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')]} 08:56:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:17 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:17 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 08:56:17 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 08:56:17 INFO - Using env: {'DISPLAY': ':0', 08:56:17 INFO - 'HOME': '/home/cltbld', 08:56:17 INFO - 'LANG': 'en_US.UTF-8', 08:56:17 INFO - 'LANGUAGE': 'en_US:en', 08:56:17 INFO - 'LOGNAME': 'cltbld', 08:56:17 INFO - 'MAIL': '/var/mail/cltbld', 08:56:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:17 INFO - 'MOZ_NO_REMOTE': '1', 08:56:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:17 INFO - 'NO_EM_RESTART': '1', 08:56:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:17 INFO - 'PWD': '/builds/slave/test', 08:56:17 INFO - 'SHELL': '/bin/bash', 08:56:17 INFO - 'SHLVL': '1', 08:56:17 INFO - 'TERM': 'linux', 08:56:17 INFO - 'TMOUT': '86400', 08:56:17 INFO - 'USER': 'cltbld', 08:56:17 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:17 INFO - '_': '/tools/buildbot/bin/python'} 08:56:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:17 INFO - Downloading/unpacking psutil>=3.1.1 08:56:17 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 08:56:17 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 08:56:17 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 08:56:17 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 08:56:17 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 08:56:17 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 08:56:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:56:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:56:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:56:19 INFO - Installing collected packages: psutil 08:56:19 INFO - Running setup.py install for psutil 08:56:19 INFO - building 'psutil._psutil_linux' extension 08:56:19 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 08:56:20 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 08:56:20 INFO - building 'psutil._psutil_posix' extension 08:56:20 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 08:56:20 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 08:56:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:56:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:56:20 INFO - Successfully installed psutil 08:56:20 INFO - Cleaning up... 08:56:20 INFO - Return code: 0 08:56:20 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:56:20 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')]} 08:56:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:20 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')]} 08:56:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:20 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:20 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 08:56:20 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 08:56:20 INFO - Using env: {'DISPLAY': ':0', 08:56:20 INFO - 'HOME': '/home/cltbld', 08:56:20 INFO - 'LANG': 'en_US.UTF-8', 08:56:20 INFO - 'LANGUAGE': 'en_US:en', 08:56:20 INFO - 'LOGNAME': 'cltbld', 08:56:20 INFO - 'MAIL': '/var/mail/cltbld', 08:56:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:20 INFO - 'MOZ_NO_REMOTE': '1', 08:56:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:20 INFO - 'NO_EM_RESTART': '1', 08:56:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:20 INFO - 'PWD': '/builds/slave/test', 08:56:20 INFO - 'SHELL': '/bin/bash', 08:56:20 INFO - 'SHLVL': '1', 08:56:20 INFO - 'TERM': 'linux', 08:56:20 INFO - 'TMOUT': '86400', 08:56:20 INFO - 'USER': 'cltbld', 08:56:20 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:20 INFO - '_': '/tools/buildbot/bin/python'} 08:56:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:20 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:56:20 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 08:56:20 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 08:56:20 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 08:56:20 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 08:56:20 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 08:56:20 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 08:56:22 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:56:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:56:22 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:56:22 INFO - Installing collected packages: mozsystemmonitor 08:56:22 INFO - Running setup.py install for mozsystemmonitor 08:56:22 INFO - Successfully installed mozsystemmonitor 08:56:22 INFO - Cleaning up... 08:56:22 INFO - Return code: 0 08:56:22 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:56:22 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')]} 08:56:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:22 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')]} 08:56:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:22 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:22 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 08:56:22 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 08:56:22 INFO - Using env: {'DISPLAY': ':0', 08:56:22 INFO - 'HOME': '/home/cltbld', 08:56:22 INFO - 'LANG': 'en_US.UTF-8', 08:56:22 INFO - 'LANGUAGE': 'en_US:en', 08:56:22 INFO - 'LOGNAME': 'cltbld', 08:56:22 INFO - 'MAIL': '/var/mail/cltbld', 08:56:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:22 INFO - 'MOZ_NO_REMOTE': '1', 08:56:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:22 INFO - 'NO_EM_RESTART': '1', 08:56:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:22 INFO - 'PWD': '/builds/slave/test', 08:56:22 INFO - 'SHELL': '/bin/bash', 08:56:22 INFO - 'SHLVL': '1', 08:56:22 INFO - 'TERM': 'linux', 08:56:22 INFO - 'TMOUT': '86400', 08:56:22 INFO - 'USER': 'cltbld', 08:56:22 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:22 INFO - '_': '/tools/buildbot/bin/python'} 08:56:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:23 INFO - Downloading/unpacking jsonschema==2.5.1 08:56:23 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 08:56:23 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 08:56:23 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 08:56:23 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 08:56:23 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 08:56:23 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 08:56:25 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:56:25 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:56:25 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 08:56:25 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 08:56:25 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 08:56:25 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 08:56:25 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 08:56:25 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 08:56:25 INFO - Downloading functools32-3.2.3-2.tar.gz 08:56:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:56:25 INFO - warning: no files found matching '*.txt' 08:56:25 INFO - no previously-included directories found matching 'build' 08:56:25 INFO - no previously-included directories found matching 'dist' 08:56:25 INFO - no previously-included directories found matching '.git*' 08:56:25 INFO - Installing collected packages: jsonschema, functools32 08:56:25 INFO - Running setup.py install for functools32 08:56:25 INFO - warning: no files found matching '*.txt' 08:56:25 INFO - no previously-included directories found matching 'build' 08:56:25 INFO - no previously-included directories found matching 'dist' 08:56:25 INFO - no previously-included directories found matching '.git*' 08:56:25 INFO - Successfully installed jsonschema functools32 08:56:25 INFO - Cleaning up... 08:56:25 INFO - Return code: 0 08:56:25 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:56:25 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')]} 08:56:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:25 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')]} 08:56:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:25 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:25 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 08:56:25 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 08:56:25 INFO - Using env: {'DISPLAY': ':0', 08:56:25 INFO - 'HOME': '/home/cltbld', 08:56:25 INFO - 'LANG': 'en_US.UTF-8', 08:56:25 INFO - 'LANGUAGE': 'en_US:en', 08:56:25 INFO - 'LOGNAME': 'cltbld', 08:56:25 INFO - 'MAIL': '/var/mail/cltbld', 08:56:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:25 INFO - 'MOZ_NO_REMOTE': '1', 08:56:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:25 INFO - 'NO_EM_RESTART': '1', 08:56:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:25 INFO - 'PWD': '/builds/slave/test', 08:56:25 INFO - 'SHELL': '/bin/bash', 08:56:25 INFO - 'SHLVL': '1', 08:56:25 INFO - 'TERM': 'linux', 08:56:25 INFO - 'TMOUT': '86400', 08:56:25 INFO - 'USER': 'cltbld', 08:56:25 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:25 INFO - '_': '/tools/buildbot/bin/python'} 08:56:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:25 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:56:25 INFO - Cleaning up... 08:56:25 INFO - Return code: 0 08:56:25 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:56:25 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')]} 08:56:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:25 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')]} 08:56:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:25 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:25 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 08:56:25 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 08:56:25 INFO - Using env: {'DISPLAY': ':0', 08:56:25 INFO - 'HOME': '/home/cltbld', 08:56:25 INFO - 'LANG': 'en_US.UTF-8', 08:56:25 INFO - 'LANGUAGE': 'en_US:en', 08:56:25 INFO - 'LOGNAME': 'cltbld', 08:56:25 INFO - 'MAIL': '/var/mail/cltbld', 08:56:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:25 INFO - 'MOZ_NO_REMOTE': '1', 08:56:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:25 INFO - 'NO_EM_RESTART': '1', 08:56:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:25 INFO - 'PWD': '/builds/slave/test', 08:56:25 INFO - 'SHELL': '/bin/bash', 08:56:25 INFO - 'SHLVL': '1', 08:56:25 INFO - 'TERM': 'linux', 08:56:25 INFO - 'TMOUT': '86400', 08:56:25 INFO - 'USER': 'cltbld', 08:56:25 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:25 INFO - '_': '/tools/buildbot/bin/python'} 08:56:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:26 INFO - Downloading/unpacking blobuploader==1.2.4 08:56:26 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 08:56:26 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 08:56:26 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 08:56:26 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 08:56:26 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 08:56:26 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 08:56:28 INFO - Downloading blobuploader-1.2.4.tar.gz 08:56:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:56:28 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:56:28 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 08:56:28 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 08:56:28 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 08:56:28 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 08:56:28 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 08:56:28 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 08:56:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:56:28 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:56:28 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 08:56:28 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 08:56:28 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 08:56:28 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 08:56:28 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 08:56:28 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 08:56:28 INFO - Downloading docopt-0.6.1.tar.gz 08:56:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:56:28 INFO - Installing collected packages: blobuploader, requests, docopt 08:56:28 INFO - Running setup.py install for blobuploader 08:56:28 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:56:28 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:56:28 INFO - Running setup.py install for requests 08:56:29 INFO - Running setup.py install for docopt 08:56:29 INFO - Successfully installed blobuploader requests docopt 08:56:29 INFO - Cleaning up... 08:56:29 INFO - Return code: 0 08:56:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:56:29 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')]} 08:56:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:29 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')]} 08:56:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:29 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:29 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 08:56:29 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 08:56:29 INFO - Using env: {'DISPLAY': ':0', 08:56:29 INFO - 'HOME': '/home/cltbld', 08:56:29 INFO - 'LANG': 'en_US.UTF-8', 08:56:29 INFO - 'LANGUAGE': 'en_US:en', 08:56:29 INFO - 'LOGNAME': 'cltbld', 08:56:29 INFO - 'MAIL': '/var/mail/cltbld', 08:56:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:29 INFO - 'MOZ_NO_REMOTE': '1', 08:56:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:29 INFO - 'NO_EM_RESTART': '1', 08:56:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:29 INFO - 'PWD': '/builds/slave/test', 08:56:29 INFO - 'SHELL': '/bin/bash', 08:56:29 INFO - 'SHLVL': '1', 08:56:29 INFO - 'TERM': 'linux', 08:56:29 INFO - 'TMOUT': '86400', 08:56:29 INFO - 'USER': 'cltbld', 08:56:29 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:29 INFO - '_': '/tools/buildbot/bin/python'} 08:56:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:56:29 INFO - Running setup.py (path:/tmp/pip-N5Juug-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:56:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:56:29 INFO - Running setup.py (path:/tmp/pip-jPfmJ1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:56:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:56:29 INFO - Running setup.py (path:/tmp/pip-iTdDfp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:56:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:56:29 INFO - Running setup.py (path:/tmp/pip-ZUzZ32-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:56:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:56:29 INFO - Running setup.py (path:/tmp/pip-Kyio3i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:56:30 INFO - Running setup.py (path:/tmp/pip-4X7hUy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:56:30 INFO - Running setup.py (path:/tmp/pip-OzeTZ0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:56:30 INFO - Running setup.py (path:/tmp/pip-of2PB3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:56:30 INFO - Running setup.py (path:/tmp/pip-H_oNo9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:56:30 INFO - Running setup.py (path:/tmp/pip-OHkW3k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:56:30 INFO - Running setup.py (path:/tmp/pip-t4LQyY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:56:30 INFO - Running setup.py (path:/tmp/pip-dy1IvT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:56:30 INFO - Running setup.py (path:/tmp/pip-49S7GC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:56:30 INFO - Running setup.py (path:/tmp/pip-t9RjsN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:56:30 INFO - Running setup.py (path:/tmp/pip-a7tkek-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:56:30 INFO - Running setup.py (path:/tmp/pip-JZa9mI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:56:30 INFO - Running setup.py (path:/tmp/pip-_7JOMr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:56:30 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:56:30 INFO - Running setup.py install for manifestparser 08:56:31 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Running setup.py install for mozcrash 08:56:31 INFO - Running setup.py install for mozdebug 08:56:31 INFO - Running setup.py install for mozdevice 08:56:31 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Running setup.py install for mozfile 08:56:31 INFO - Running setup.py install for mozhttpd 08:56:31 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Running setup.py install for mozinfo 08:56:31 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Running setup.py install for mozInstall 08:56:31 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Running setup.py install for mozleak 08:56:31 INFO - Running setup.py install for mozlog 08:56:31 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:56:31 INFO - Running setup.py install for moznetwork 08:56:32 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:56:32 INFO - Running setup.py install for mozprocess 08:56:32 INFO - Running setup.py install for mozprofile 08:56:32 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:56:32 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:56:32 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:56:32 INFO - Running setup.py install for mozrunner 08:56:32 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:56:32 INFO - Running setup.py install for mozscreenshot 08:56:32 INFO - Running setup.py install for moztest 08:56:32 INFO - Running setup.py install for mozversion 08:56:32 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:56:32 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:56:32 INFO - Cleaning up... 08:56:32 INFO - Return code: 0 08:56:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:56:32 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')]} 08:56:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:32 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')]} 08:56:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:32 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:32 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 08:56:32 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 08:56:32 INFO - Using env: {'DISPLAY': ':0', 08:56:32 INFO - 'HOME': '/home/cltbld', 08:56:32 INFO - 'LANG': 'en_US.UTF-8', 08:56:32 INFO - 'LANGUAGE': 'en_US:en', 08:56:32 INFO - 'LOGNAME': 'cltbld', 08:56:32 INFO - 'MAIL': '/var/mail/cltbld', 08:56:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:32 INFO - 'MOZ_NO_REMOTE': '1', 08:56:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:32 INFO - 'NO_EM_RESTART': '1', 08:56:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:32 INFO - 'PWD': '/builds/slave/test', 08:56:32 INFO - 'SHELL': '/bin/bash', 08:56:32 INFO - 'SHLVL': '1', 08:56:32 INFO - 'TERM': 'linux', 08:56:32 INFO - 'TMOUT': '86400', 08:56:32 INFO - 'USER': 'cltbld', 08:56:32 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:32 INFO - '_': '/tools/buildbot/bin/python'} 08:56:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:56:32 INFO - Running setup.py (path:/tmp/pip-v1ieoX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:56:33 INFO - Running setup.py (path:/tmp/pip-6eg80X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:56:33 INFO - Running setup.py (path:/tmp/pip-NMaYsd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:56:33 INFO - Running setup.py (path:/tmp/pip-WQBl9G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:56:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:56:33 INFO - Running setup.py (path:/tmp/pip-LhxzlB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:56:33 INFO - Running setup.py (path:/tmp/pip-LtyPTg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:56:33 INFO - Running setup.py (path:/tmp/pip-fD3oZJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:56:33 INFO - Running setup.py (path:/tmp/pip-IiHPH0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:56:33 INFO - Running setup.py (path:/tmp/pip-IKqeOi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:56:33 INFO - Running setup.py (path:/tmp/pip-J1nplN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:56:33 INFO - Running setup.py (path:/tmp/pip-0TKPie-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:56:33 INFO - Running setup.py (path:/tmp/pip-Qkzz7l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:56:33 INFO - Running setup.py (path:/tmp/pip-CrHCYT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:56:33 INFO - Running setup.py (path:/tmp/pip-0dPy3s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:56:33 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)) 08:56:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:56:33 INFO - Running setup.py (path:/tmp/pip-sDQtwb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:56:34 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)) 08:56:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:56:34 INFO - Running setup.py (path:/tmp/pip-ceky1C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:56:34 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)) 08:56:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:56:34 INFO - Running setup.py (path:/tmp/pip-Ianuwr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:56:34 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)) 08:56:34 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)) 08:56:34 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)) 08:56:34 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)) 08:56:34 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:56:34 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:56:34 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:56:34 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 08:56:34 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 08:56:34 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 08:56:34 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 08:56:34 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 08:56:34 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 08:56:36 INFO - Downloading blessings-1.6.tar.gz 08:56:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:56:36 INFO - Installing collected packages: blessings 08:56:36 INFO - Running setup.py install for blessings 08:56:36 INFO - Successfully installed blessings 08:56:36 INFO - Cleaning up... 08:56:36 INFO - Return code: 0 08:56:36 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:56:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:56:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:56:36 INFO - Reading from file tmpfile_stdout 08:56:36 INFO - Current package versions: 08:56:36 INFO - argparse == 1.2.1 08:56:36 INFO - blessings == 1.6 08:56:36 INFO - blobuploader == 1.2.4 08:56:36 INFO - docopt == 0.6.1 08:56:36 INFO - functools32 == 3.2.3-2 08:56:36 INFO - jsonschema == 2.5.1 08:56:36 INFO - manifestparser == 1.1 08:56:36 INFO - mozInstall == 1.12 08:56:36 INFO - mozcrash == 1.0 08:56:36 INFO - mozdebug == 0.1 08:56:36 INFO - mozdevice == 0.49 08:56:36 INFO - mozfile == 1.2 08:56:36 INFO - mozhttpd == 0.7 08:56:36 INFO - mozinfo == 0.9 08:56:36 INFO - mozleak == 0.1 08:56:36 INFO - mozlog == 3.4 08:56:36 INFO - moznetwork == 0.27 08:56:36 INFO - mozprocess == 0.25 08:56:36 INFO - mozprofile == 0.28 08:56:36 INFO - mozrunner == 6.13 08:56:36 INFO - mozscreenshot == 0.1 08:56:36 INFO - mozsystemmonitor == 0.3 08:56:36 INFO - moztest == 0.8 08:56:36 INFO - mozversion == 1.4 08:56:36 INFO - psutil == 3.1.1 08:56:36 INFO - requests == 1.2.3 08:56:36 INFO - wsgiref == 0.1.2 08:56:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:56:36 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')]} 08:56:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:36 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')]} 08:56:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:36 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:36 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 08:56:36 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 08:56:36 INFO - Using env: {'DISPLAY': ':0', 08:56:36 INFO - 'HOME': '/home/cltbld', 08:56:36 INFO - 'LANG': 'en_US.UTF-8', 08:56:36 INFO - 'LANGUAGE': 'en_US:en', 08:56:36 INFO - 'LOGNAME': 'cltbld', 08:56:36 INFO - 'MAIL': '/var/mail/cltbld', 08:56:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:36 INFO - 'MOZ_NO_REMOTE': '1', 08:56:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:36 INFO - 'NO_EM_RESTART': '1', 08:56:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:36 INFO - 'PWD': '/builds/slave/test', 08:56:36 INFO - 'SHELL': '/bin/bash', 08:56:36 INFO - 'SHLVL': '1', 08:56:36 INFO - 'TERM': 'linux', 08:56:36 INFO - 'TMOUT': '86400', 08:56:36 INFO - 'USER': 'cltbld', 08:56:36 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:36 INFO - '_': '/tools/buildbot/bin/python'} 08:56:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 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)) 08:56:37 INFO - Cleaning up... 08:56:37 INFO - Return code: 0 08:56:37 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:56:37 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')]} 08:56:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:56:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:37 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')]} 08:56:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:56:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:56:37 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 0x23571f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25f4b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, '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': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', '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 08:56:37 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 08:56:37 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 08:56:37 INFO - Using env: {'DISPLAY': ':0', 08:56:37 INFO - 'HOME': '/home/cltbld', 08:56:37 INFO - 'LANG': 'en_US.UTF-8', 08:56:37 INFO - 'LANGUAGE': 'en_US:en', 08:56:37 INFO - 'LOGNAME': 'cltbld', 08:56:37 INFO - 'MAIL': '/var/mail/cltbld', 08:56:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:37 INFO - 'MOZ_NO_REMOTE': '1', 08:56:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:37 INFO - 'NO_EM_RESTART': '1', 08:56:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:37 INFO - 'PWD': '/builds/slave/test', 08:56:37 INFO - 'SHELL': '/bin/bash', 08:56:37 INFO - 'SHLVL': '1', 08:56:37 INFO - 'TERM': 'linux', 08:56:37 INFO - 'TMOUT': '86400', 08:56:37 INFO - 'USER': 'cltbld', 08:56:37 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:37 INFO - '_': '/tools/buildbot/bin/python'} 08:56:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:56:37 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:56:37 INFO - Cleaning up... 08:56:37 INFO - Return code: 0 08:56:37 INFO - Running post-action listener: _resource_record_post_action 08:56:37 INFO - Running post-action listener: _start_resource_monitoring 08:56:37 INFO - Starting resource monitoring. 08:56:37 INFO - [mozharness: 2017-04-05 15:56:37.323865Z] Finished create-virtualenv step (success) 08:56:37 INFO - [mozharness: 2017-04-05 15:56:37.324449Z] Running install step. 08:56:37 INFO - Running pre-action listener: _resource_record_pre_action 08:56:37 INFO - Running main action method: install 08:56:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:56:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:56:37 INFO - Reading from file tmpfile_stdout 08:56:37 INFO - Detecting whether we're running mozinstall >=1.0... 08:56:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:56:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:56:37 INFO - Reading from file tmpfile_stdout 08:56:37 INFO - Output received: 08:56:37 INFO - Usage: mozinstall [options] installer 08:56:37 INFO - Options: 08:56:37 INFO - -h, --help show this help message and exit 08:56:37 INFO - -d DEST, --destination=DEST 08:56:37 INFO - Directory to install application into. [default: 08:56:37 INFO - "/builds/slave/test"] 08:56:37 INFO - --app=APP Application being installed. [default: firefox] 08:56:37 INFO - mkdir: /builds/slave/test/build/application 08:56:37 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'] 08:56:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 08:56:52 INFO - Reading from file tmpfile_stdout 08:56:52 INFO - Output received: 08:56:52 INFO - /builds/slave/test/build/application/firefox/firefox 08:56:52 INFO - Running post-action listener: _resource_record_post_action 08:56:52 INFO - [mozharness: 2017-04-05 15:56:52.723498Z] Finished install step (success) 08:56:52 INFO - [mozharness: 2017-04-05 15:56:52.723768Z] Running run-tests step. 08:56:52 INFO - Running pre-action listener: _resource_record_pre_action 08:56:52 INFO - Running main action method: run_tests 08:56:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:56:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:56:52 INFO - Python 2.7.3 08:56:52 INFO - Return code: 0 08:56:52 INFO - grabbing minidump binary from tooltool 08:56: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')]} 08:56:52 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 0x25f2290>, '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 0x25f2b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25f3040>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:56:52 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 08:56:52 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 08:56:52 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 08:56:52 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:56:52 INFO - Return code: 0 08:56:52 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:56:52 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:56:52 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:56:52 INFO - ENV: RUST_BACKTRACE is now 1 08:56:52 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:56:52 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:56:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-086', '--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 08:56:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-086 --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 08:56:52 INFO - Using env: {'DISPLAY': ':0', 08:56:52 INFO - 'HOME': '/home/cltbld', 08:56:52 INFO - 'LANG': 'en_US.UTF-8', 08:56:52 INFO - 'LANGUAGE': 'en_US:en', 08:56:52 INFO - 'LOGNAME': 'cltbld', 08:56:52 INFO - 'MAIL': '/var/mail/cltbld', 08:56:52 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:56:52 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:56:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:56:52 INFO - 'MOZ_NO_REMOTE': '1', 08:56:52 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:56:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:56:52 INFO - 'NO_EM_RESTART': '1', 08:56:52 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:56:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:56:52 INFO - 'PWD': '/builds/slave/test', 08:56:52 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:56:52 INFO - 'RUST_BACKTRACE': '1', 08:56:52 INFO - 'SHELL': '/bin/bash', 08:56:52 INFO - 'SHLVL': '1', 08:56:52 INFO - 'TERM': 'linux', 08:56:52 INFO - 'TMOUT': '86400', 08:56:52 INFO - 'USER': 'cltbld', 08:56:52 INFO - 'XDG_SESSION_COOKIE': '438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277', 08:56:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:56:52 INFO - '_': '/tools/buildbot/bin/python'} 08:56:52 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-086', '--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 08:56:53 INFO - mozversion application_buildid: 20170405151816 08:56:53 INFO - mozversion application_changeset: 720b9177c6856c1c4339d0fac1bf5149c0d53950 08:56:53 INFO - mozversion application_display_name: Nightly 08:56:53 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:56:53 INFO - mozversion application_name: Firefox 08:56:53 INFO - mozversion application_remotingname: firefox 08:56:53 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 08:56:53 INFO - mozversion application_vendor: Mozilla 08:56:53 INFO - mozversion application_version: 55.0a1 08:56:53 INFO - mozversion platform_buildid: 20170405151816 08:56:53 INFO - mozversion platform_changeset: 720b9177c6856c1c4339d0fac1bf5149c0d53950 08:56:53 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 08:56:53 INFO - mozversion platform_version: 55.0a1 08:56:53 INFO - using testdate: 1491407813 08:56:53 INFO - actual date: 1491407813 08:56:53 INFO - starting webserver on 'localhost:33016' 08:56:53 INFO - SUITE-START | Running 2 tests 08:56:53 INFO - TEST-START | dromaeo_css 08:56:53 INFO - operating with platform_type : linux_ 08:56:53 INFO - Initialising browser for dromaeo_css test... 08:56:53 INFO - TEST-INFO | started process 24703 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp6q5gLH/profile http://localhost:33016/getInfo.html) 08:56:57 INFO - PID 24703 | __metrics Screen width/height:1600/1200 08:56:57 INFO - PID 24703 | colorDepth:24 08:56:57 INFO - PID 24703 | Browser inner width/height: 1024/697 08:56:57 INFO - PID 24703 | __metrics 08:56:58 INFO - PID 24703 | 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" 08:56:58 INFO - PID 24703 | JavaScript error: resource:///modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:56:59 INFO - TEST-INFO | 24703: exit 0 08:56:59 INFO - Browser initialized. 08:56:59 INFO - Running cycle 1/1 for dromaeo_css test... 08:56:59 INFO - TEST-INFO | started process 24794 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp6q5gLH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:57:11 INFO - PID 24794 | RSS: Main: 153739264 08:57:11 INFO - PID 24794 | 09:00:18 INFO - PID 24794 | Cycle 1(1): loaded http://localhost:33016/tests/dromaeo/cssquery-dojo.html (next: http://localhost:33016/tests/dromaeo/cssquery-ext.html) 09:00:20 INFO - PID 24794 | RSS: Main: 332234752 09:00:20 INFO - PID 24794 | 09:02:01 INFO - PID 24794 | ************************* 09:02:01 INFO - PID 24794 | A coding exception was thrown and uncaught in a Task. 09:02:01 INFO - PID 24794 | 09:02:01 ERROR - PID 24794 | Full message: TypeError: NetworkError when attempting to fetch resource. 09:02:01 INFO - PID 24794 | Full stack: 09:02:01 INFO - PID 24794 | ************************* 09:02:01 INFO - PID 24794 | ************************* 09:02:01 INFO - PID 24794 | A coding exception was thrown and uncaught in a Task. 09:02:01 INFO - PID 24794 | 09:02:01 ERROR - PID 24794 | Full message: TypeError: NetworkError when attempting to fetch resource. 09:02:01 INFO - PID 24794 | Full stack: 09:02:01 INFO - PID 24794 | ************************* 09:02:01 INFO - PID 24794 | ************************* 09:02:01 INFO - PID 24794 | A coding exception was thrown and uncaught in a Task. 09:02:01 INFO - PID 24794 | 09:02:01 ERROR - PID 24794 | Full message: TypeError: NetworkError when attempting to fetch resource. 09:02:01 INFO - PID 24794 | Full stack: 09:02:01 INFO - PID 24794 | ************************* 09:02:01 INFO - PID 24794 | ************************* 09:02:01 INFO - PID 24794 | A coding exception was thrown and uncaught in a Task. 09:02:01 INFO - PID 24794 | 09:02:01 ERROR - PID 24794 | Full message: TypeError: NetworkError when attempting to fetch resource. 09:02:01 INFO - PID 24794 | Full stack: 09:02:01 INFO - PID 24794 | ************************* 09:03:22 INFO - PID 24794 | Cycle 1(1): loaded http://localhost:33016/tests/dromaeo/cssquery-ext.html (next: http://localhost:33016/tests/dromaeo/cssquery-jquery.html) 09:03:23 INFO - PID 24794 | RSS: Main: 238448640 09:03:23 INFO - PID 24794 | 09:06:25 INFO - PID 24794 | Cycle 1(1): loaded http://localhost:33016/tests/dromaeo/cssquery-jquery.html (next: http://localhost:33016/tests/dromaeo/cssquery-mootools.html) 09:06:26 INFO - PID 24794 | RSS: Main: 205746176 09:06:26 INFO - PID 24794 | 09:09:28 INFO - PID 24794 | Cycle 1(1): loaded http://localhost:33016/tests/dromaeo/cssquery-mootools.html (next: http://localhost:33016/tests/dromaeo/cssquery-prototype.html) 09:09:28 INFO - PID 24794 | RSS: Main: 228089856 09:09:28 INFO - PID 24794 | 09:12:32 INFO - PID 24794 | Cycle 1(1): loaded http://localhost:33016/tests/dromaeo/cssquery-prototype.html (next: http://localhost:33016/tests/dromaeo/cssquery-yui.html) 09:12:32 INFO - PID 24794 | RSS: Main: 181141504 09:12:32 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | Cycle 1(1): loaded http://localhost:33016/tests/dromaeo/cssquery-yui.html (next: http://localhost:33016/tests/dromaeo/cssquery-dojo.html) 09:15:35 INFO - PID 24794 | RSS: Main: 267743232 09:15:35 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | __start_tp_report 09:15:35 INFO - PID 24794 | _x_x_mozilla_page_load 09:15:35 INFO - PID 24794 | _x_x_mozilla_page_load_details 09:15:35 INFO - PID 24794 | |i|pagename|runs| 09:15:35 INFO - PID 24794 | |0;dojo.html;2718.9592156117656;2738.329109368205;2743;2775.958360624591;2779.402428477877;5251.054810134175;5292.973535132323;5330.973345133279;5334.333208348957;5368.141097424413;5331.733413329328;5333.626646134772;5398.703071331085;5409.675419474825;5427.050266203409;4665.440147182343;4716.976415117928;4718.834840780556;4826.251930950708;4832.903341933159;4796.952030479685;4802.255650374215;4819.42166939966;4842;4885.267209918505;4653.441587009581;4716.834910778106;4727.574518293336;4735.029318989599;4771.165046116916;4739.786709598042;4748.596369308613;4749.2876068589985;4752.691075080109;4755.334253204554;4696.365990591261;4699.882502937419;4707.411573553306;4721.032188401369;4722.952770472286;5169.327987361619;5228.529432351069;5238.083335416325;5247.23915032322;5282.049231138393;5684.715764211773;5684.857878553028;5689.118186681071;5689.573282003825;5708.029634962067;5765.769369225226;5770.567207459458;5775.682337471438;5789.942100578983;5807.680577568232;5268.789248430058;5365.08793505105;5371.785128594813;5394.757235924393;5434.809781657663;5971.790987315423;6015.127806468037;6020.036794112921;6020.337762846083;6040.667763272974;5550.58370622205;5628.634138780966;5646.576506761927;5648.887022259614;5728.026235539968;5831.883362332815;5846.853828654318;5855.2973643163095;5875.6474611523445;5882.852928676817;5746.683932383676;5756.5682573807135;5783.942160578425;5804.912926306109;5808.970955145197;5567.164925261243;5670.914936275959;5758.510526605285;5769.509591684754;5771.451712087345;4793.113274044313;4801.01579176268;4871.196252618278;4878.170710979142;4902.411710594752;4114.218298523271;4126.236646220459;4131.091159944807;4145.647619952338;4157.688173387008;4869.415670119608;4880.560749532559;4889.071076495526;4901.485344038896;4930.827421040246;5620.072688006433;5724.25584673998;5809.680467574324;5834.533237341003;5856.502197313191;4811.9518804811505;4813.4945830687975;4903.141950158708;4905.656604037755;4914.680545764514;5184.559312458483;5186.066508028515;5192.350956130484;5204.297419848272;5205.6616319939085;5446.400895901368;5451.991381594417;5459.29029226214;5465.098258787256;5501.834944951658;5657.434256574475;5686.57350698691;5762.942370576408;5771;5870.324912635102;5411.350637923474;5478.096114141122;5481.314835645544;5487.122060470306;5508.889822203613;5749.683767392834;5751.3673495916255;5754.424557544212;5755.1367294906095;5777.248957635648;5650.57620678459;5702.45826646468;5759.395263497272;5849.502792262535;5865.4134586541;5603.991281569357;5626.2685850839125;5627.493525582717;5630.18362337467;5639.746211420414;5603.327600687943;5608.803691870765;5613.943860561342;5633.971830140823;5652.773889044557;5518.144687573433;5562;5575.637583557056;5585.078462053878;5623.775048997994;5677.233573467694;5677.630953987978;5683.488486036111;5686.829395118153;5697.857553561194;5411.945880541144;5494.615376923737;5498.202760599611;5525.557955363642;5546.195801608664 09:15:35 INFO - PID 24794 | |1;ext.html;619.4579742725116;688.7313947560451;709.9041629380032;1064.9307794993324;1071.43749531496;27590.72409275909;27864.860675696593;28056.158315250574;28116.156515304574;28245;33616.327673446576;34031.31937361251;34167.316653666974;34249.14377140567;34316;7275.49071564992;7439.181690014121;7439.553626782384;7441.739539116132;7442.06974128234;5505.724713764316;7283.817904552376;7394.704211831548;7396.113990932305;7402.740904068359;5720.742566584493;7276.1268647762345;7433.81415464615;7437.479376443651;7445.627718614075;7461.925380746177;7523.849523009564;7528.51064680794;7532.585707786069;7540.245975402443;5549.694766787825;7250;7333.083364579427;7337.449691273123;7339.302766237199;25362.492750145077;31764;32301.838490807397;32348.514772278435;32377.352452951043;2909.6508418989647;2947.071672423201;2947.911562653124;2949.174231215242;2951.7786166037417;25524.744752552422;25596;25776;25796;25831.870840645675;3160.0993716790836;3190.8564114614896;3191.728703060243;3205.4871220604823;3228.6932741389533;153219.23390383087;153578;153653.23173384173;154302;154360;43218.56781432209;43352;43367.74741894307;43369.34945975813;43399;45013.32480012737;45053.54946450493;45053.54946450559;45095.09809803786;45163;12341.13612047166;12596.118271720892;12610.054245931591;12614.306213158365;12625.810612840814;10008;10011.699649010541;10013.39919604826;10017.39895606266;10019.499025048719;10703.25077244601;11027.393493357942;12235.327057011771;12770.744585108247;12878.742425151444;4894.25500333721;5084.51697088776;5091.722952719733;5115.155999260155;5217.556507696812;849.4478588917129;879.2218886285683;884.0271246844579;889.0709208876739;913.8720579118929;19947.700784488243;20365;20542.486437838874;21053.368398948056;21186;944.0229362609666;949.4730424614405;955.603424578806;955.6863837065797;961.0629636104882;10547.314424562379;10921.12630989519;11021.724456888482;11035.172362072877;11048.723781905355;214156.92921535292;214164;215092;215126;215317;41975;42458.36312455316;42513.57486425158;42587.787061065115;42588.787056064524;1208.2206976500283;1224.106402326289;1228.1587112827742;1232.6055662188014;1236.9196002259823;18994.6623622266;19114.52213694669;19348;20260.59478810445;20481.590368192254;30342;30423.54364684487;30426;30428;30437.064772369176;218791;218851;219098;219369;219523;28526;28822.71177288284;29107;29203.269918252212;29265.41469170562;27548.035818746248;28678;33750.324993500486;33776.15559611029;35100.82449587736;25153.49693006166;28208.43583128367;28244.576331355456;28264.85867570649;28772.136835894955;27674.723252767213;27760.722392775813;28109.297267567657;28315.43369132647;28644.713552864203;30155.396892061595;30762.69237307688;30845.537316940714;30944;30989.225269368446;26333.341666457727;26340.341491462867;26520.602190966765;27001.86499067492;27663.30841728973;21374.251901183383;22344.106235750387;22612.208572700536;22644.547109057396;22699.546009080055 09:15:35 INFO - PID 24794 | |2;jquery.html;408.5812042656279;412.9442525259089;425.5106627378514;436.89296122449997;442.1952047273963;12059.698507537316;17046.659066818655;17866.464006079823;17868.195931183094;18712.438626841184;14437.855621443783;15992.360305587763;17882.821171788277;18758.06209689517;18973.810261897375;5492;5771.942280577204;5790.247267855173;5827.766889324422;5838.41615838417;5634.915476267859;5764.740586673589;5877.617954832944;5889.057750759879;5891.469767720904;5762.798302059428;5805.883882322372;5809.3609702932645;5814.5057670098095;5815.651060936336;5427.402985671573;5614.27014488118;5766.452187042224;5769.451902069297;5775.480206781389;5027.572656324217;5034.622403319766;5039;5039.294498770175;5045;21420.35738927819;21459.78540214609;21954.231601893858;21989.450263743536;22114.88942555293;1639.6556723088165;1679.672463869546;1679.6808606364873;1679.8740094492962;1679.9496015119566;14581.19803410812;14685.192314422702;15128.773068403983;15134.621634459116;15280.31238594266;2027.807358300959;2083.0418007716466;2102.16964299101;2107.9367618971455;2112.630289699312;84593.29761256755;85713.14286857114;87726.5613671934;87956.56021719851;89229.55385223098;10630.946845265724;10824.67525974222;10977.12183025356;11113.38855865895;11115;15556.844431555766;15567.610809729847;15589.610259743597;15611;15638.687226255639;6474.773382931575;6701.932980670131;7282.235365286675;7559.470837041355;7769.92230077692;6691.665416729144;6786.762463313859;6968.338007889242;6981.441484681213;6989.615571143534;6895.827604309932;7001.789946301619;7037.577745335297;7058.611776352247;7079.504434689522;2067.901080403392;2121.713568668241;2124.468882779305;2138.6685063815135;2163.0590693048575;829.6639860856363;841.8989721233492;854.1543871567104;885.4908427654125;894.2220268366563;16259.430919917746;16457.506274811774;16877.746833797504;16988.405405810736;17113.572160696083;859.5358506406595;865.9696910608099;869.56087175977;888.5468411110251;896.0412358776047;8936.8659470108;9390.812183756287;9436.150746432717;9500.382475139093;9541.47521886289;413011;424227;427702;441731;442081;84303;84832.57583712041;85823;86582;88354.55822720846;1050.7373156710823;1050.8371202463477;1078.8381742738652;1084.2681190196586;1088.2545456362418;14220.502282420066;14294.78430843221;14302;14364.569062928129;14966.17686027279;41388;41676.37485437781;42741.78629106835;42863.42775439298;43328;53280;53975.19037214366;54405.72797135989;55829.441705584046;56174.43825561855;8036.718714844952;8052.798680033046;8084.959575202086;8158.388120891075;8248.381371397048;12060.457279422622;12490.87509124897;12561.371931403575;12586.24482531051;12735.29955852437;9392.154706076486;10053.798924021332;10306.278560500694;10642.255042146975;10917.617883374043;8984.86522702173;9009.099090090938;9037.277017838425;9237.261019118589;9288.535573221447;10067.89932100699;10538.789224215627;10654.307470014424;10996.505157268102;11046.834297485384;10944.288621239593;11028.669139925814;11235.247993527242;11292.209545332076;11417.629884413924;10749.570017199538;10815.134789216687;10920;10982.725431864268;11057.11543076568 09:15:35 INFO - PID 24794 | |3;mootools.html;1283.7111649878777;1293.4567481657698;1297.8637243089474;1335.285622192127;1339.1697147768384;9772.657956971507;10217.948910255456;10219.386836789789;10227.335223210486;10230.846537301946;9972.152367048791;10349.948250258738;10414.218933579974;10420.114290285335;10422.426766527838;2277.943051423715;2308.5844547981355;2317.6523521471745;2321.442853715105;2323.7095363079616;1959.7746259180235;2053.5995480881234;2200.3508964855328;2284.166279308049;2349.9412514687097;2242.8766417847014;2346.4720437901506;2348.5772560939026;2350.306659535441;2352.6353415220583;2275.215050807485;2319.489712263299;2326.2904814031713;2331.25399872041;2358.3160883343808;2292;2299.5745787029455;2318.7449380568123;2320.8607483550873;2321.988390058039;10169.389836609827;10404.323718958243;10420.374777513374;10425.687229383131;10428.582856685724;5432.456754324576;5618.971905140489;5626.043572592669;5630.634008789416;5630.746616402231;3329.5671562696934;3550.378683730337;3598.082488965297;3603.6036036036016;3613.4579813027995;1094.6770702642739;1147.506572173965;1151.3840095548926;1152.4813833774836;1159.4666453431432;15235.847641523555;15350.462733804263;15364.231788410647;15376.846231537653;15422.305996230085;4924.581410580141;5093.567046800989;5145.279660847485;5172.405173405106;5201.063808514504;11422.828657570142;11451.141164412702;11476.942615287036;11479.540818367172;11485.0811935045;5701.800436984686;5751.511121554631;5757.0788673811985;5767.971160144172;5769.769209231584;5094.745262736848;5234.110201265794;5253.632245742761;5277.155655095166;5284.656497327662;3840.8847734568008;3933.2330195612153;3933.350997085506;3990.6607938324987;4015.8393664253103;1055.6041484443333;1087.276960821061;1166.650004998497;1169.4094482286562;1191.74377508836;656.1961597043679;661.4642139866627;663.1776597019757;663.714602720825;676.9763058293034;5481.835544933659;5547.140193270049;5564.387917329091;5586.86032849182;5699.202111704365;503.2702581257192;505.4541095616725;509.41417370024766;515.584954111936;636.885450461692;3571.142925697866;3758.6241375862196;3780.2628487444686;3791.8862434127022;3885.611438856148;12722.745545089047;13334.733305334034;13468;13587;13594.45622175102;13105.475780968845;13452.461901524026;13458;13478.123921945042;13638.659033524242;9568.856467152998;9571.473568953774;9659;9671;9698.418094914328;5686.289213848269;5824.504917082096;5835.153902684002;5861.35525092248;5966.463018328372;11849.348285844017;11964.820527691918;12056.397180140782;12226.144169908377;12380.380980951097;12091.879081209427;12228.205166664138;12420.751584968431;12521.436535355748;12536.498540058295;7716.807079822825;7920.801979950547;7935.1271360149185;7935.444518883623;7941.205879412244;8991.77520561965;9062.682806101755;9068.183863452321;9148.222401095714;9191.080891911022;8046.356291496783;8249.670013199644;8254.793630159294;8299.585020748818;8498.107698691796;7691.923080769121;7972.6412311444965;8007.239312265326;8007.679692812455;8070.47541909774;6978.546394484342;7132.8216794578475;7140.107486564179;7142.678579463833;7151.7854464366155;5192.1952097424955;5205.869853253699;5323.547498462674;5342.8931421372135;5448.073827449422;5282.418933917343;5355.758990845344;5366.275552800478;5458.836234912959;5540.390557038642 09:15:35 INFO - PID 24794 | |4;prototype.html;376.2869362557953;395.5846361320613;400.29348200426233;405.97970101494917;409.1326388057319;5114.872128196797;5224.503672151149;5336.973315133424;5359.624826262163;5396.568274538037;5055.418626857912;5155.922661160085;5215.1655735082395;5217.373915130181;5223.399309079457;4132.772697501651;4150.958490415095;4151.190517849021;4155.4182414462;4165.062860856314;3910.902227444308;3981.7610943343493;4178.247915375231;4201.327787553992;4214.325707886739;3966.6628336591425;3972.1261322509004;3973.1259122992897;3974.940375894364;3980.1442689821683;3955.7626542407547;3958.703097267702;3966.087799806032;3974.9205015899665;3975.403689446577;3511.5961664408665;3515.1739341254784;3518.190816112283;3518.296340731864;3521.542199514047;4904.386951631046;5065.873353166164;5085;5087.414947281073;5120.564751996085;4659.207934651117;4668.226074091857;4673;4678.976605116953;4681.836135735233;5523.889522209573;5527.447255274481;5541;5550.27846379972;5565.16522521625;3834.750741201813;3902.941455878164;3933.1150491139265;3936.3308237599676;3938.7439816411843;5733;5805.303363596396;5819.912701309484;5844;5854.677992710442;4029.5567487576345;4036.5357983832237;4047.291723948297;4049.6962727795535;4056.452378928866;4019.577944315863;4069.5320038195987;4099.241640296555;4100.138970816102;4144.461220041436;4681.953180468152;4699.130660827758;4701.294805779161;4702.294655801588;4711.3639658646325;5575.107982722826;5575.825428083051;5588.608797384225;5605.775768969277;5607.80372686954;1351.1015174908773;1384.5500212431;1395.9511417100352;1411.9294035298399;1426.8501807310083;931.1712575807537;941.8916824565263;969.7333233360882;969.8652576485529;970.2965350121106;4793.784279707422;4805.879853003633;4811.975940120277;4815.951840481621;4829.275608658659;5714.828460165656;5719.599628025998;5724.513416359656;5733.168690539848;5738.483536481736;4650.37219975299;4757.500462451462;4796.544328288807;4806.8798280043275;4819.3012013257885;3002.9249268768017;3025.9257963423106;3048.4055609156003;3056.5109582467144;3059.1587313488967;5422.15956526739;5431.402545719968;5443.836684899459;5444.727763611803;5455.290812194389;5729.541636669056;5789.88420231593;5814.127880817911;5845.269341332333;5905.350411454737;5340.599455040965;5351;5367.329083864517;5369.597280203922;5370.382406023279;5516.613837031369;5702.800401985911;5704.885902282014;5705.033382641086;5720.971395142998;5567.860803479945;5585.832425027093;5610.326760788732;5617.213590097472;5631.88736225265;5350.866228344323;5352.805349806717;5358;5392.838214853561;5393.595480339069;3945.4157526819977;4009.6591789697036;4023.3361495352938;4056.3104272274372;4080.693947953856;5473.8357849264585;5658.830235092953;5662.98963867821;5716;5727.284089488814;5312.62811603184;5456.454354564512;5522.66863988162;5523.33719953592;5548.445155484419;5313.176457648916;5507.586930980113;5529.30883639545;5555.2778138841695;5559.249501317432;5308.230306605444;5412.78348866041;5488.9725551371985;5490.752916118704;5500.559955203494;5585.553155747449;5591;5614.9719251403485;5622.578306626938;5628.85927851807;5184.781576329635;5393.595480338912;5471.972640136773;5477.370102438271;5485.6982865942755 09:15:35 INFO - PID 24794 | |5;yui.html;728.0789800901857;729.3035151430383;732.783828770513;736.4476642518113;751.4927423988806;12995.935020324898;13414.128081674684;13869.098508596946;13905.026648134623;14196.432142714279;13244.139130956506;13376.665583360396;13671.658208544792;13690.247036413019;13695;671.5869740109846;891.8082612238368;893.8748575199477;899.1772528136747;899.9010108888017;850.8893843800297;851.1786126388034;853.2150421612132;855.2260204514924;909.4906852162777;892.4779004282502;897.7351681254013;900.7342833863993;902.6434558349448;964.802215545815;878.227160099115;888.8311220868014;893.9987214319971;894.6287290774321;958.9424634521916;659.8383396067994;660.2506155513527;660.6630618384611;680.3808534233873;710.2294010998073;12410.379481025913;12510.249385036836;12594.055445841506;12619.936900315532;12977;10215.89784102157;12655.620331390073;12657.810132848015;13132.6716832079;13134.540291089766;11639.767204655944;11818.231814932002;11898.821517677241;12117.33354665493;12286.815697764541;2872.2819295176205;2908.1130255272133;2910.3451723362286;2911.577821215933;2912.5485549739824;67539.3246067543;67632;67813.66093169502;68608.6569567149;69164;10260.640877569249;10574.221654449044;10574.577016919236;10712.679069488484;10852.62015829458;19173.904130479536;20721.68917466239;21104.261350852645;21437.356879293646;21603;6650.035744817072;6651.43462805667;6690.5316627836555;6727.529072964943;6989.1962424321855;3351.614564325134;3403.812790296508;3475.14858859581;3494.7728397654073;3525.065857547752;3478.2000139967445;3525.8413371398346;3550.396432606463;3574.3744844652083;3589.838457269429;731.3673672273445;754.2306847016013;757.2541047068632;758.5714071549556;761.0448886647222;591.4735885062298;596.0820336681548;599.6881621556767;599.8200539838031;627.9623222606658;8263.297619702273;9715.854262186072;9801.460919649346;9933.552990115462;9958.900410995942;575.200471344831;581.5783556921283;589.6933594530819;610.2067312493829;610.3804638292048;3826.5408151022057;3885.154551587973;3950.664193543581;4029.1941611677194;4050.837966481308;57785;57803.421965780646;58015;58799.88601766733;61149;51449.48550514447;53091.734541327045;53136.468635313155;53525.46474535283;53954.460455395725;45159.77420112944;45289.773551132035;45819.99999999933;46598.76700616543;47807.521924781;9432.858507122535;9551.761205969906;9824.568364770907;9895.901040989498;9985.800283994426;24316.51366972615;25005;25562.872185638953;25663.10179143721;26418.603720944586;41241.58758412377;43056.138877222904;43507.898669146074;43913.34129988117;44367.55632443763;12175.208611440228;12274.570390036306;12302.384880755748;12378.504859805507;12452.81320780171;13370.933145334211;13405.597832065054;13410;13481.59555213345;14061.086029408056;12062.879371206176;12202.816957745463;12277;12404.937975310426;12524.561640342545;11415.60045398407;11518.596849110241;11578.189526733384;11660.18378713482;12299.815502767287;11331.943340283246;11469.369184694922;11473.541058357572;11577.479013444246;12081.093917956365;8932.776680583038;8961.462312261285;9129.726108216764;9175.587098580714;9609.231261499202;10029.348092373972;10292.65873015873;10424.843627345444;10593.682189534326;10613.150947924301 09:15:35 INFO - PID 24794 | __end_tp_report 09:15:35 INFO - PID 24794 | __start_cc_report 09:15:35 INFO - PID 24794 | _x_x_mozilla_cycle_collect,1756 09:15:35 INFO - PID 24794 | __end_cc_report 09:15:35 INFO - PID 24794 | __startTimestamp1491408935797__endTimestamp 09:15:35 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | ------- Summary: start ------- 09:15:35 INFO - PID 24794 | Number of tests: 6 09:15:35 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | [#0] dojo.html Cycles:165 Average:5278.94 Median:5481.31 stddev:631.50 (11.5%) stddev-sans-first:600.65 09:15:35 INFO - PID 24794 | Values: 2719.0 2738.3 2743.0 2776.0 2779.4 5251.1 5293.0 5331.0 5334.3 5368.1 5331.7 5333.6 5398.7 5409.7 5427.1 4665.4 4717.0 4718.8 4826.3 4832.9 4797.0 4802.3 4819.4 4842.0 4885.3 4653.4 4716.8 4727.6 4735.0 4771.2 4739.8 4748.6 4749.3 4752.7 4755.3 4696.4 4699.9 4707.4 4721.0 4723.0 5169.3 5228.5 5238.1 5247.2 5282.0 5684.7 5684.9 5689.1 5689.6 5708.0 5765.8 5770.6 5775.7 5789.9 5807.7 5268.8 5365.1 5371.8 5394.8 5434.8 5971.8 6015.1 6020.0 6020.3 6040.7 5550.6 5628.6 5646.6 5648.9 5728.0 5831.9 5846.9 5855.3 5875.6 5882.9 5746.7 5756.6 5783.9 5804.9 5809.0 5567.2 5670.9 5758.5 5769.5 5771.5 4793.1 4801.0 4871.2 4878.2 4902.4 4114.2 4126.2 4131.1 4145.6 4157.7 4869.4 4880.6 4889.1 4901.5 4930.8 5620.1 5724.3 5809.7 5834.5 5856.5 4812.0 4813.5 4903.1 4905.7 4914.7 5184.6 5186.1 5192.4 5204.3 5205.7 5446.4 5452.0 5459.3 5465.1 5501.8 5657.4 5686.6 5762.9 5771.0 5870.3 5411.4 5478.1 5481.3 5487.1 5508.9 5749.7 5751.4 5754.4 5755.1 5777.2 5650.6 5702.5 5759.4 5849.5 5865.4 5604.0 5626.3 5627.5 5630.2 5639.7 5603.3 5608.8 5613.9 5634.0 5652.8 5518.1 5562.0 5575.6 5585.1 5623.8 5677.2 5677.6 5683.5 5686.8 5697.9 5411.9 5494.6 5498.2 5525.6 5546.2 09:15:35 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | [#1] ext.html Cycles:180 Average:33353.21 Median:16106.24 stddev:51561.01 (320.1%) stddev-sans-first:51647.07 09:15:35 INFO - PID 24794 | Values: 619.5 688.7 709.9 1064.9 1071.4 27590.7 27864.9 28056.2 28116.2 28245.0 33616.3 34031.3 34167.3 34249.1 34316.0 7275.5 7439.2 7439.6 7441.7 7442.1 5505.7 7283.8 7394.7 7396.1 7402.7 5720.7 7276.1 7433.8 7437.5 7445.6 7461.9 7523.8 7528.5 7532.6 7540.2 5549.7 7250.0 7333.1 7337.4 7339.3 25362.5 31764.0 32301.8 32348.5 32377.4 2909.7 2947.1 2947.9 2949.2 2951.8 25524.7 25596.0 25776.0 25796.0 25831.9 3160.1 3190.9 3191.7 3205.5 3228.7 153219.2 153578.0 153653.2 154302.0 154360.0 43218.6 43352.0 43367.7 43369.3 43399.0 45013.3 45053.5 45053.5 45095.1 45163.0 12341.1 12596.1 12610.1 12614.3 12625.8 10008.0 10011.7 10013.4 10017.4 10019.5 10703.3 11027.4 12235.3 12770.7 12878.7 4894.3 5084.5 5091.7 5115.2 5217.6 849.4 879.2 884.0 889.1 913.9 19947.7 20365.0 20542.5 21053.4 21186.0 944.0 949.5 955.6 955.7 961.1 10547.3 10921.1 11021.7 11035.2 11048.7 214156.9 214164.0 215092.0 215126.0 215317.0 41975.0 42458.4 42513.6 42587.8 42588.8 1208.2 1224.1 1228.2 1232.6 1236.9 18994.7 19114.5 19348.0 20260.6 20481.6 30342.0 30423.5 30426.0 30428.0 30437.1 218791.0 218851.0 219098.0 219369.0 219523.0 28526.0 28822.7 29107.0 29203.3 29265.4 27548.0 28678.0 33750.3 33776.2 35100.8 25153.5 28208.4 28244.6 28264.9 28772.1 27674.7 27760.7 28109.3 28315.4 28644.7 30155.4 30762.7 30845.5 30944.0 30989.2 26333.3 26340.3 26520.6 27001.9 27663.3 21374.3 22344.1 22612.2 22644.5 22699.5 09:15:35 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | [#2] jquery.html Cycles:180 Average:26905.33 Median:21583.65 stddev:71266.85 (330.2%) stddev-sans-first:71439.00 09:15:35 INFO - PID 24794 | Values: 408.6 412.9 425.5 436.9 442.2 12059.7 17046.7 17866.5 17868.2 18712.4 14437.9 15992.4 17882.8 18758.1 18973.8 5492.0 5771.9 5790.2 5827.8 5838.4 5634.9 5764.7 5877.6 5889.1 5891.5 5762.8 5805.9 5809.4 5814.5 5815.7 5427.4 5614.3 5766.5 5769.5 5775.5 5027.6 5034.6 5039.0 5039.3 5045.0 21420.4 21459.8 21954.2 21989.5 22114.9 1639.7 1679.7 1679.7 1679.9 1679.9 14581.2 14685.2 15128.8 15134.6 15280.3 2027.8 2083.0 2102.2 2107.9 2112.6 84593.3 85713.1 87726.6 87956.6 89229.6 10630.9 10824.7 10977.1 11113.4 11115.0 15556.8 15567.6 15589.6 15611.0 15638.7 6474.8 6701.9 7282.2 7559.5 7769.9 6691.7 6786.8 6968.3 6981.4 6989.6 6895.8 7001.8 7037.6 7058.6 7079.5 2067.9 2121.7 2124.5 2138.7 2163.1 829.7 841.9 854.2 885.5 894.2 16259.4 16457.5 16877.7 16988.4 17113.6 859.5 866.0 869.6 888.5 896.0 8936.9 9390.8 9436.2 9500.4 9541.5 413011.0 424227.0 427702.0 441731.0 442081.0 84303.0 84832.6 85823.0 86582.0 88354.6 1050.7 1050.8 1078.8 1084.3 1088.3 14220.5 14294.8 14302.0 14364.6 14966.2 41388.0 41676.4 42741.8 42863.4 43328.0 53280.0 53975.2 54405.7 55829.4 56174.4 8036.7 8052.8 8085.0 8158.4 8248.4 12060.5 12490.9 12561.4 12586.2 12735.3 9392.2 10053.8 10306.3 10642.3 10917.6 8984.9 9009.1 9037.3 9237.3 9288.5 10067.9 10538.8 10654.3 10996.5 11046.8 10944.3 11028.7 11235.2 11292.2 11417.6 10749.6 10815.1 10920.0 10982.7 11057.1 09:15:35 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | [#3] mootools.html Cycles:180 Average:6390.30 Median:3786.07 stddev:4110.00 (108.6%) stddev-sans-first:4103.62 09:15:35 INFO - PID 24794 | Values: 1283.7 1293.5 1297.9 1335.3 1339.2 9772.7 10217.9 10219.4 10227.3 10230.8 9972.2 10349.9 10414.2 10420.1 10422.4 2277.9 2308.6 2317.7 2321.4 2323.7 1959.8 2053.6 2200.4 2284.2 2349.9 2242.9 2346.5 2348.6 2350.3 2352.6 2275.2 2319.5 2326.3 2331.3 2358.3 2292.0 2299.6 2318.7 2320.9 2322.0 10169.4 10404.3 10420.4 10425.7 10428.6 5432.5 5619.0 5626.0 5630.6 5630.7 3329.6 3550.4 3598.1 3603.6 3613.5 1094.7 1147.5 1151.4 1152.5 1159.5 15235.8 15350.5 15364.2 15376.8 15422.3 4924.6 5093.6 5145.3 5172.4 5201.1 11422.8 11451.1 11476.9 11479.5 11485.1 5701.8 5751.5 5757.1 5768.0 5769.8 5094.7 5234.1 5253.6 5277.2 5284.7 3840.9 3933.2 3933.4 3990.7 4015.8 1055.6 1087.3 1166.7 1169.4 1191.7 656.2 661.5 663.2 663.7 677.0 5481.8 5547.1 5564.4 5586.9 5699.2 503.3 505.5 509.4 515.6 636.9 3571.1 3758.6 3780.3 3791.9 3885.6 12722.7 13334.7 13468.0 13587.0 13594.5 13105.5 13452.5 13458.0 13478.1 13638.7 9568.9 9571.5 9659.0 9671.0 9698.4 5686.3 5824.5 5835.2 5861.4 5966.5 11849.3 11964.8 12056.4 12226.1 12380.4 12091.9 12228.2 12420.8 12521.4 12536.5 7716.8 7920.8 7935.1 7935.4 7941.2 8991.8 9062.7 9068.2 9148.2 9191.1 8046.4 8249.7 8254.8 8299.6 8498.1 7691.9 7972.6 8007.2 8007.7 8070.5 6978.5 7132.8 7140.1 7142.7 7151.8 5192.2 5205.9 5323.5 5342.9 5448.1 5282.4 5355.8 5366.3 5458.8 5540.4 09:15:35 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | [#4] prototype.html Cycles:180 Average:4583.58 Median:5220.39 stddev:1334.70 (25.6%) stddev-sans-first:1300.55 09:15:35 INFO - PID 24794 | Values: 376.3 395.6 400.3 406.0 409.1 5114.9 5224.5 5337.0 5359.6 5396.6 5055.4 5155.9 5215.2 5217.4 5223.4 4132.8 4151.0 4151.2 4155.4 4165.1 3910.9 3981.8 4178.2 4201.3 4214.3 3966.7 3972.1 3973.1 3974.9 3980.1 3955.8 3958.7 3966.1 3974.9 3975.4 3511.6 3515.2 3518.2 3518.3 3521.5 4904.4 5065.9 5085.0 5087.4 5120.6 4659.2 4668.2 4673.0 4679.0 4681.8 5523.9 5527.4 5541.0 5550.3 5565.2 3834.8 3902.9 3933.1 3936.3 3938.7 5733.0 5805.3 5819.9 5844.0 5854.7 4029.6 4036.5 4047.3 4049.7 4056.5 4019.6 4069.5 4099.2 4100.1 4144.5 4682.0 4699.1 4701.3 4702.3 4711.4 5575.1 5575.8 5588.6 5605.8 5607.8 1351.1 1384.6 1396.0 1411.9 1426.9 931.2 941.9 969.7 969.9 970.3 4793.8 4805.9 4812.0 4816.0 4829.3 5714.8 5719.6 5724.5 5733.2 5738.5 4650.4 4757.5 4796.5 4806.9 4819.3 3002.9 3025.9 3048.4 3056.5 3059.2 5422.2 5431.4 5443.8 5444.7 5455.3 5729.5 5789.9 5814.1 5845.3 5905.4 5340.6 5351.0 5367.3 5369.6 5370.4 5516.6 5702.8 5704.9 5705.0 5721.0 5567.9 5585.8 5610.3 5617.2 5631.9 5350.9 5352.8 5358.0 5392.8 5393.6 3945.4 4009.7 4023.3 4056.3 4080.7 5473.8 5658.8 5663.0 5716.0 5727.3 5312.6 5456.5 5522.7 5523.3 5548.4 5313.2 5507.6 5529.3 5555.3 5559.2 5308.2 5412.8 5489.0 5490.8 5500.6 5585.6 5591.0 5615.0 5622.6 5628.9 5184.8 5393.6 5472.0 5477.4 5485.7 09:15:35 INFO - PID 24794 | 09:15:35 INFO - PID 24794 | [#5] yui.html Cycles:180 Average:14386.86 Median:42148.86 stddev:17293.72 (41.0%) stddev-sans-first:17311.82 09:15:35 INFO - PID 24794 | Values: 728.1 729.3 732.8 736.4 751.5 12995.9 13414.1 13869.1 13905.0 14196.4 13244.1 13376.7 13671.7 13690.2 13695.0 671.6 891.8 893.9 899.2 899.9 850.9 851.2 853.2 855.2 909.5 892.5 897.7 900.7 902.6 964.8 878.2 888.8 894.0 894.6 958.9 659.8 660.3 660.7 680.4 710.2 12410.4 12510.2 12594.1 12619.9 12977.0 10215.9 12655.6 12657.8 13132.7 13134.5 11639.8 11818.2 11898.8 12117.3 12286.8 2872.3 2908.1 2910.3 2911.6 2912.5 67539.3 67632.0 67813.7 68608.7 69164.0 10260.6 10574.2 10574.6 10712.7 10852.6 19173.9 20721.7 21104.3 21437.4 21603.0 6650.0 6651.4 6690.5 6727.5 6989.2 3351.6 3403.8 3475.1 3494.8 3525.1 3478.2 3525.8 3550.4 3574.4 3589.8 731.4 754.2 757.3 758.6 761.0 591.5 596.1 599.7 599.8 628.0 8263.3 9715.9 9801.5 9933.6 9958.9 575.2 581.6 589.7 610.2 610.4 3826.5 3885.2 3950.7 4029.2 4050.8 57785.0 57803.4 58015.0 58799.9 61149.0 51449.5 53091.7 53136.5 53525.5 53954.5 45159.8 45289.8 45820.0 46598.8 47807.5 9432.9 9551.8 9824.6 9895.9 9985.8 24316.5 25005.0 25562.9 25663.1 26418.6 41241.6 43056.1 43507.9 43913.3 44367.6 12175.2 12274.6 12302.4 12378.5 12452.8 13370.9 13405.6 13410.0 13481.6 14061.1 12062.9 12202.8 12277.0 12404.9 12524.6 11415.6 11518.6 11578.2 11660.2 12299.8 11331.9 11469.4 11473.5 11577.5 12081.1 8932.8 8961.5 9129.7 9175.6 9609.2 10029.3 10292.7 10424.8 10593.7 10613.2 09:15:35 INFO - PID 24794 | -------- Summary: end -------- 09:15:35 INFO - PID 24794 | 09:15:36 INFO - TEST-INFO | 24794: exit 0 09:15:36 INFO - TEST-OK | dromaeo_css | took 1123647ms 09:15:36 INFO - TEST-START | kraken 09:15:36 INFO - operating with platform_type : linux_ 09:15:36 INFO - Initialising browser for kraken test... 09:15:36 INFO - TEST-INFO | started process 25119 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4yHIpc/profile http://localhost:33016/getInfo.html) 09:15:40 INFO - PID 25119 | __metrics Screen width/height:1600/1200 09:15:40 INFO - PID 25119 | colorDepth:24 09:15:40 INFO - PID 25119 | Browser inner width/height: 1024/697 09:15:40 INFO - PID 25119 | __metrics 09:15:41 INFO - PID 25119 | 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" 09:15:41 INFO - PID 25119 | JavaScript error: resource:///modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:15:42 INFO - TEST-INFO | 25119: exit 0 09:15:42 INFO - Browser initialized. 09:15:42 INFO - Running cycle 1/1 for kraken test... 09:15:42 INFO - TEST-INFO | started process 25216 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4yHIpc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:15:55 INFO - PID 25216 | RSS: Main: 154112000 09:15:55 INFO - PID 25216 | 09:15:57 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:33016/tests/kraken/driver.html?testName=audio-beat-detection) 09:15:58 INFO - PID 25216 | RSS: Main: 208474112 09:15:58 INFO - PID 25216 | 09:16:01 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:33016/tests/kraken/driver.html?testName=audio-dft) 09:16:02 INFO - PID 25216 | RSS: Main: 187875328 09:16:02 INFO - PID 25216 | 09:16:05 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:33016/tests/kraken/driver.html?testName=audio-fft) 09:16:05 INFO - PID 25216 | RSS: Main: 270827520 09:16:05 INFO - PID 25216 | 09:16:07 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:33016/tests/kraken/driver.html?testName=audio-oscillator) 09:16:08 INFO - PID 25216 | RSS: Main: 181153792 09:16:08 INFO - PID 25216 | 09:16:10 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:33016/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:16:11 INFO - PID 25216 | RSS: Main: 184889344 09:16:11 INFO - PID 25216 | 09:16:14 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:33016/tests/kraken/driver.html?testName=imaging-darkroom) 09:16:15 INFO - PID 25216 | RSS: Main: 224198656 09:16:15 INFO - PID 25216 | 09:16:18 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:33016/tests/kraken/driver.html?testName=imaging-desaturate) 09:16:19 INFO - PID 25216 | RSS: Main: 219439104 09:16:19 INFO - PID 25216 | 09:16:22 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:33016/tests/kraken/driver.html?testName=json-parse-financial) 09:16:23 INFO - PID 25216 | RSS: Main: 221102080 09:16:23 INFO - PID 25216 | 09:16:24 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:33016/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:16:25 INFO - PID 25216 | RSS: Main: 184750080 09:16:25 INFO - PID 25216 | 09:16:27 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:33016/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:16:27 INFO - PID 25216 | RSS: Main: 191102976 09:16:27 INFO - PID 25216 | 09:16:29 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:33016/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:16:30 INFO - PID 25216 | RSS: Main: 200978432 09:16:30 INFO - PID 25216 | 09:16:33 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:33016/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:16:34 INFO - PID 25216 | RSS: Main: 210284544 09:16:34 INFO - PID 25216 | 09:16:37 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:33016/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:16:37 INFO - PID 25216 | RSS: Main: 207171584 09:16:37 INFO - PID 25216 | 09:16:39 INFO - PID 25216 | Cycle 1(1): loaded http://localhost:33016/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:33016/tests/kraken/driver.html?testName=ai-astar) 09:16:40 INFO - PID 25216 | RSS: Main: 275685376 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | __start_tp_report 09:16:40 INFO - PID 25216 | _x_x_mozilla_page_load 09:16:40 INFO - PID 25216 | _x_x_mozilla_page_load_details 09:16:40 INFO - PID 25216 | |i|pagename|runs| 09:16:40 INFO - PID 25216 | |0;ai-astar;105;115;113;112;112;112;110;113;111;111 09:16:40 INFO - PID 25216 | |1;audio-beat-detection;155;126;126;164;127;124;124;124;151;127 09:16:40 INFO - PID 25216 | |2;audio-dft;165;162;167;166;163;164;165;163;164;164 09:16:40 INFO - PID 25216 | |3;audio-fft;77;77;75;109;80;82;78;76;96;80 09:16:40 INFO - PID 25216 | |4;audio-oscillator;83;83;108;84;84;84;111;84;83;106 09:16:40 INFO - PID 25216 | |5;imaging-gaussian-blur;114;114;115;113;114;114;114;114;115;114 09:16:40 INFO - PID 25216 | |6;imaging-darkroom;151;151;150;150;151;150;149;151;149;150 09:16:40 INFO - PID 25216 | |7;imaging-desaturate;96;94;95;95;95;95;95;95;95;96 09:16:40 INFO - PID 25216 | |8;json-parse-financial;54;55;55;55;56;55;58;55;55;56 09:16:40 INFO - PID 25216 | |9;json-stringify-tinderbox;55;57;56;55;55;56;56;56;56;56 09:16:40 INFO - PID 25216 | |10;stanford-crypto-aes;90;83;82;84;83;84;83;83;83;83 09:16:40 INFO - PID 25216 | |11;stanford-crypto-ccm;137;137;147;142;145;150;136;151;178;132 09:16:40 INFO - PID 25216 | |12;stanford-crypto-pbkdf2;187;210;198;199;204;198;197;200;194;192 09:16:40 INFO - PID 25216 | |13;stanford-crypto-sha256-iterative;74;74;74;71;71;79;71;70;71;68 09:16:40 INFO - PID 25216 | __end_tp_report 09:16:40 INFO - PID 25216 | __start_cc_report 09:16:40 INFO - PID 25216 | _x_x_mozilla_cycle_collect,1980 09:16:40 INFO - PID 25216 | __end_cc_report 09:16:40 INFO - PID 25216 | __startTimestamp1491409000017__endTimestamp 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | ------- Summary: start ------- 09:16:40 INFO - PID 25216 | Number of tests: 14 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#0] ai-astar Cycles:10 Average:111.40 Median:112.00 stddev:2.63 (2.4%) stddev-sans-first:1.45 09:16:40 INFO - PID 25216 | Values: 105.0 115.0 113.0 112.0 112.0 112.0 110.0 113.0 111.0 111.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#1] audio-beat-detection Cycles:10 Average:134.80 Median:127.00 stddev:15.45 (12.2%) stddev-sans-first:14.56 09:16:40 INFO - PID 25216 | Values: 155.0 126.0 126.0 164.0 127.0 124.0 124.0 124.0 151.0 127.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#2] audio-dft Cycles:10 Average:164.30 Median:164.50 stddev:1.49 (0.9%) stddev-sans-first:1.56 09:16:40 INFO - PID 25216 | Values: 165.0 162.0 167.0 166.0 163.0 164.0 165.0 163.0 164.0 164.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#3] audio-fft Cycles:10 Average:83.00 Median:79.00 stddev:10.92 (13.8%) stddev-sans-first:11.37 09:16:40 INFO - PID 25216 | Values: 77.0 77.0 75.0 109.0 80.0 82.0 78.0 76.0 96.0 80.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#4] audio-oscillator Cycles:10 Average:91.00 Median:83.50 stddev:12.03 (14.4%) stddev-sans-first:12.40 09:16:40 INFO - PID 25216 | Values: 83.0 83.0 108.0 84.0 84.0 84.0 111.0 84.0 83.0 106.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#5] imaging-gaussian-blur Cycles:10 Average:114.10 Median:114.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 09:16:40 INFO - PID 25216 | Values: 114.0 114.0 115.0 113.0 114.0 114.0 114.0 114.0 115.0 114.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#6] imaging-darkroom Cycles:10 Average:150.20 Median:150.50 stddev:0.79 (0.5%) stddev-sans-first:0.78 09:16:40 INFO - PID 25216 | Values: 151.0 151.0 150.0 150.0 151.0 150.0 149.0 151.0 149.0 150.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.57 (0.6%) stddev-sans-first:0.50 09:16:40 INFO - PID 25216 | Values: 96.0 94.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 96.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#8] json-parse-financial Cycles:10 Average:55.40 Median:55.00 stddev:1.07 (2.0%) stddev-sans-first:1.01 09:16:40 INFO - PID 25216 | Values: 54.0 55.0 55.0 55.0 56.0 55.0 58.0 55.0 55.0 56.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#9] json-stringify-tinderbox Cycles:10 Average:55.80 Median:56.00 stddev:0.63 (1.1%) stddev-sans-first:0.60 09:16:40 INFO - PID 25216 | Values: 55.0 57.0 56.0 55.0 55.0 56.0 56.0 56.0 56.0 56.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#10] stanford-crypto-aes Cycles:10 Average:83.80 Median:83.00 stddev:2.25 (2.7%) stddev-sans-first:0.60 09:16:40 INFO - PID 25216 | Values: 90.0 83.0 82.0 84.0 83.0 84.0 83.0 83.0 83.0 83.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#11] stanford-crypto-ccm Cycles:10 Average:145.50 Median:146.00 stddev:13.07 (9.0%) stddev-sans-first:13.50 09:16:40 INFO - PID 25216 | Values: 137.0 137.0 147.0 142.0 145.0 150.0 136.0 151.0 178.0 132.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:197.90 Median:198.50 stddev:6.31 (3.2%) stddev-sans-first:5.33 09:16:40 INFO - PID 25216 | Values: 187.0 210.0 198.0 199.0 204.0 198.0 197.0 200.0 194.0 192.0 09:16:40 INFO - PID 25216 | 09:16:40 INFO - PID 25216 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.30 Median:72.50 stddev:3.06 (4.2%) stddev-sans-first:3.18 09:16:40 INFO - PID 25216 | Values: 74.0 74.0 74.0 71.0 71.0 79.0 71.0 70.0 71.0 68.0 09:16:40 INFO - PID 25216 | -------- Summary: end -------- 09:16:40 INFO - PID 25216 | 09:16:41 INFO - TEST-INFO | 25216: exit 0 09:16:41 INFO - TEST-OK | kraken | took 64689ms 09:16:41 INFO - SUITE-END | took 1188s 09:16:41 INFO - Completed test suite (00:19:48) 09:16:41 INFO - javascript benchmark 09:16:41 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6671.343460255147, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2718.9592156117656, 2738.329109368205, 2743.0, 2775.958360624591, 2779.402428477877, 5251.054810134175, 5292.973535132323, 5330.973345133279, 5334.333208348957, 5368.141097424413, 5331.733413329328, 5333.626646134772, 5398.703071331085, 5409.675419474825, 5427.050266203409, 4665.440147182343, 4716.976415117928, 4718.834840780556, 4826.251930950708, 4832.903341933159, 4796.952030479685, 4802.255650374215, 4819.42166939966, 4842.0, 4885.267209918505, 4653.441587009581, 4716.834910778106, 4727.574518293336, 4735.029318989599, 4771.165046116916, 4739.786709598042, 4748.596369308613, 4749.2876068589985, 4752.691075080109, 4755.334253204554, 4696.365990591261, 4699.882502937419, 4707.411573553306, 4721.032188401369, 4722.952770472286, 5169.327987361619, 5228.529432351069, 5238.083335416325, 5247.23915032322, 5282.049231138393, 5684.715764211773, 5684.857878553028, 5689.118186681071, 5689.573282003825, 5708.029634962067, 5765.769369225226, 5770.567207459458, 5775.682337471438, 5789.942100578983, 5807.680577568232, 5268.789248430058, 5365.08793505105, 5371.785128594813, 5394.757235924393, 5434.809781657663, 5971.790987315423, 6015.127806468037, 6020.036794112921, 6020.337762846083, 6040.667763272974, 5550.58370622205, 5628.634138780966, 5646.576506761927, 5648.887022259614, 5728.026235539968, 5831.883362332815, 5846.853828654318, 5855.2973643163095, 5875.6474611523445, 5882.852928676817, 5746.683932383676, 5756.5682573807135, 5783.942160578425, 5804.912926306109, 5808.970955145197, 5567.164925261243, 5670.914936275959, 5758.510526605285, 5769.509591684754, 5771.451712087345, 4793.113274044313, 4801.01579176268, 4871.196252618278, 4878.170710979142, 4902.411710594752, 4114.218298523271, 4126.236646220459, 4131.091159944807, 4145.647619952338, 4157.688173387008, 4869.415670119608, 4880.560749532559, 4889.071076495526, 4901.485344038896, 4930.827421040246, 5620.072688006433, 5724.25584673998, 5809.680467574324, 5834.533237341003, 5856.502197313191, 4811.9518804811505, 4813.4945830687975, 4903.141950158708, 4905.656604037755, 4914.680545764514, 5184.559312458483, 5186.066508028515, 5192.350956130484, 5204.297419848272, 5205.6616319939085, 5446.400895901368, 5451.991381594417, 5459.29029226214, 5465.098258787256, 5501.834944951658, 5657.434256574475, 5686.57350698691, 5762.942370576408, 5771.0, 5870.324912635102, 5411.350637923474, 5478.096114141122, 5481.314835645544, 5487.122060470306, 5508.889822203613, 5749.683767392834, 5751.3673495916255, 5754.424557544212, 5755.1367294906095, 5777.248957635648, 5650.57620678459, 5702.45826646468, 5759.395263497272, 5849.502792262535, 5865.4134586541, 5603.991281569357, 5626.2685850839125, 5627.493525582717, 5630.18362337467, 5639.746211420414, 5603.327600687943, 5608.803691870765, 5613.943860561342, 5633.971830140823, 5652.773889044557, 5518.144687573433, 5562.0, 5575.637583557056, 5585.078462053878, 5623.775048997994, 5677.233573467694, 5677.630953987978, 5683.488486036111, 5686.829395118153, 5697.857553561194, 5411.945880541144, 5494.615376923737, 5498.202760599611, 5525.557955363642, 5546.195801608664], "value": 5232.012861882685, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [619.4579742725116, 688.7313947560451, 709.9041629380032, 1064.9307794993324, 1071.43749531496, 27590.72409275909, 27864.860675696593, 28056.158315250574, 28116.156515304574, 28245.0, 33616.327673446576, 34031.31937361251, 34167.316653666974, 34249.14377140567, 34316.0, 7275.49071564992, 7439.181690014121, 7439.553626782384, 7441.739539116132, 7442.06974128234, 5505.724713764316, 7283.817904552376, 7394.704211831548, 7396.113990932305, 7402.740904068359, 5720.742566584493, 7276.1268647762345, 7433.81415464615, 7437.479376443651, 7445.627718614075, 7461.925380746177, 7523.849523009564, 7528.51064680794, 7532.585707786069, 7540.245975402443, 5549.694766787825, 7250.0, 7333.083364579427, 7337.449691273123, 7339.302766237199, 25362.492750145077, 31764.0, 32301.838490807397, 32348.514772278435, 32377.352452951043, 2909.6508418989647, 2947.071672423201, 2947.911562653124, 2949.174231215242, 2951.7786166037417, 25524.744752552422, 25596.0, 25776.0, 25796.0, 25831.870840645675, 3160.0993716790836, 3190.8564114614896, 3191.728703060243, 3205.4871220604823, 3228.6932741389533, 153219.23390383087, 153578.0, 153653.23173384173, 154302.0, 154360.0, 43218.56781432209, 43352.0, 43367.74741894307, 43369.34945975813, 43399.0, 45013.32480012737, 45053.54946450493, 45053.54946450559, 45095.09809803786, 45163.0, 12341.13612047166, 12596.118271720892, 12610.054245931591, 12614.306213158365, 12625.810612840814, 10008.0, 10011.699649010541, 10013.39919604826, 10017.39895606266, 10019.499025048719, 10703.25077244601, 11027.393493357942, 12235.327057011771, 12770.744585108247, 12878.742425151444, 4894.25500333721, 5084.51697088776, 5091.722952719733, 5115.155999260155, 5217.556507696812, 849.4478588917129, 879.2218886285683, 884.0271246844579, 889.0709208876739, 913.8720579118929, 19947.700784488243, 20365.0, 20542.486437838874, 21053.368398948056, 21186.0, 944.0229362609666, 949.4730424614405, 955.603424578806, 955.6863837065797, 961.0629636104882, 10547.314424562379, 10921.12630989519, 11021.724456888482, 11035.172362072877, 11048.723781905355, 214156.92921535292, 214164.0, 215092.0, 215126.0, 215317.0, 41975.0, 42458.36312455316, 42513.57486425158, 42587.787061065115, 42588.787056064524, 1208.2206976500283, 1224.106402326289, 1228.1587112827742, 1232.6055662188014, 1236.9196002259823, 18994.6623622266, 19114.52213694669, 19348.0, 20260.59478810445, 20481.590368192254, 30342.0, 30423.54364684487, 30426.0, 30428.0, 30437.064772369176, 218791.0, 218851.0, 219098.0, 219369.0, 219523.0, 28526.0, 28822.71177288284, 29107.0, 29203.269918252212, 29265.41469170562, 27548.035818746248, 28678.0, 33750.324993500486, 33776.15559611029, 35100.82449587736, 25153.49693006166, 28208.43583128367, 28244.576331355456, 28264.85867570649, 28772.136835894955, 27674.723252767213, 27760.722392775813, 28109.297267567657, 28315.43369132647, 28644.713552864203, 30155.396892061595, 30762.69237307688, 30845.537316940714, 30944.0, 30989.225269368446, 26333.341666457727, 26340.341491462867, 26520.602190966765, 27001.86499067492, 27663.30841728973, 21374.251901183383, 22344.106235750387, 22612.208572700536, 22644.547109057396, 22699.546009080055], "value": 14656.69339482014, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [408.5812042656279, 412.9442525259089, 425.5106627378514, 436.89296122449997, 442.1952047273963, 12059.698507537316, 17046.659066818655, 17866.464006079823, 17868.195931183094, 18712.438626841184, 14437.855621443783, 15992.360305587763, 17882.821171788277, 18758.06209689517, 18973.810261897375, 5492.0, 5771.942280577204, 5790.247267855173, 5827.766889324422, 5838.41615838417, 5634.915476267859, 5764.740586673589, 5877.617954832944, 5889.057750759879, 5891.469767720904, 5762.798302059428, 5805.883882322372, 5809.3609702932645, 5814.5057670098095, 5815.651060936336, 5427.402985671573, 5614.27014488118, 5766.452187042224, 5769.451902069297, 5775.480206781389, 5027.572656324217, 5034.622403319766, 5039.0, 5039.294498770175, 5045.0, 21420.35738927819, 21459.78540214609, 21954.231601893858, 21989.450263743536, 22114.88942555293, 1639.6556723088165, 1679.672463869546, 1679.6808606364873, 1679.8740094492962, 1679.9496015119566, 14581.19803410812, 14685.192314422702, 15128.773068403983, 15134.621634459116, 15280.31238594266, 2027.807358300959, 2083.0418007716466, 2102.16964299101, 2107.9367618971455, 2112.630289699312, 84593.29761256755, 85713.14286857114, 87726.5613671934, 87956.56021719851, 89229.55385223098, 10630.946845265724, 10824.67525974222, 10977.12183025356, 11113.38855865895, 11115.0, 15556.844431555766, 15567.610809729847, 15589.610259743597, 15611.0, 15638.687226255639, 6474.773382931575, 6701.932980670131, 7282.235365286675, 7559.470837041355, 7769.92230077692, 6691.665416729144, 6786.762463313859, 6968.338007889242, 6981.441484681213, 6989.615571143534, 6895.827604309932, 7001.789946301619, 7037.577745335297, 7058.611776352247, 7079.504434689522, 2067.901080403392, 2121.713568668241, 2124.468882779305, 2138.6685063815135, 2163.0590693048575, 829.6639860856363, 841.8989721233492, 854.1543871567104, 885.4908427654125, 894.2220268366563, 16259.430919917746, 16457.506274811774, 16877.746833797504, 16988.405405810736, 17113.572160696083, 859.5358506406595, 865.9696910608099, 869.56087175977, 888.5468411110251, 896.0412358776047, 8936.8659470108, 9390.812183756287, 9436.150746432717, 9500.382475139093, 9541.47521886289, 413011.0, 424227.0, 427702.0, 441731.0, 442081.0, 84303.0, 84832.57583712041, 85823.0, 86582.0, 88354.55822720846, 1050.7373156710823, 1050.8371202463477, 1078.8381742738652, 1084.2681190196586, 1088.2545456362418, 14220.502282420066, 14294.78430843221, 14302.0, 14364.569062928129, 14966.17686027279, 41388.0, 41676.37485437781, 42741.78629106835, 42863.42775439298, 43328.0, 53280.0, 53975.19037214366, 54405.72797135989, 55829.441705584046, 56174.43825561855, 8036.718714844952, 8052.798680033046, 8084.959575202086, 8158.388120891075, 8248.381371397048, 12060.457279422622, 12490.87509124897, 12561.371931403575, 12586.24482531051, 12735.29955852437, 9392.154706076486, 10053.798924021332, 10306.278560500694, 10642.255042146975, 10917.617883374043, 8984.86522702173, 9009.099090090938, 9037.277017838425, 9237.261019118589, 9288.535573221447, 10067.89932100699, 10538.789224215627, 10654.307470014424, 10996.505157268102, 11046.834297485384, 10944.288621239593, 11028.669139925814, 11235.247993527242, 11292.209545332076, 11417.629884413924, 10749.570017199538, 10815.134789216687, 10920.0, 10982.725431864268, 11057.11543076568], "value": 8918.703182617028, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1283.7111649878777, 1293.4567481657698, 1297.8637243089474, 1335.285622192127, 1339.1697147768384, 9772.657956971507, 10217.948910255456, 10219.386836789789, 10227.335223210486, 10230.846537301946, 9972.152367048791, 10349.948250258738, 10414.218933579974, 10420.114290285335, 10422.426766527838, 2277.943051423715, 2308.5844547981355, 2317.6523521471745, 2321.442853715105, 2323.7095363079616, 1959.7746259180235, 2053.5995480881234, 2200.3508964855328, 2284.166279308049, 2349.9412514687097, 2242.8766417847014, 2346.4720437901506, 2348.5772560939026, 2350.306659535441, 2352.6353415220583, 2275.215050807485, 2319.489712263299, 2326.2904814031713, 2331.25399872041, 2358.3160883343808, 2292.0, 2299.5745787029455, 2318.7449380568123, 2320.8607483550873, 2321.988390058039, 10169.389836609827, 10404.323718958243, 10420.374777513374, 10425.687229383131, 10428.582856685724, 5432.456754324576, 5618.971905140489, 5626.043572592669, 5630.634008789416, 5630.746616402231, 3329.5671562696934, 3550.378683730337, 3598.082488965297, 3603.6036036036016, 3613.4579813027995, 1094.6770702642739, 1147.506572173965, 1151.3840095548926, 1152.4813833774836, 1159.4666453431432, 15235.847641523555, 15350.462733804263, 15364.231788410647, 15376.846231537653, 15422.305996230085, 4924.581410580141, 5093.567046800989, 5145.279660847485, 5172.405173405106, 5201.063808514504, 11422.828657570142, 11451.141164412702, 11476.942615287036, 11479.540818367172, 11485.0811935045, 5701.800436984686, 5751.511121554631, 5757.0788673811985, 5767.971160144172, 5769.769209231584, 5094.745262736848, 5234.110201265794, 5253.632245742761, 5277.155655095166, 5284.656497327662, 3840.8847734568008, 3933.2330195612153, 3933.350997085506, 3990.6607938324987, 4015.8393664253103, 1055.6041484443333, 1087.276960821061, 1166.650004998497, 1169.4094482286562, 1191.74377508836, 656.1961597043679, 661.4642139866627, 663.1776597019757, 663.714602720825, 676.9763058293034, 5481.835544933659, 5547.140193270049, 5564.387917329091, 5586.86032849182, 5699.202111704365, 503.2702581257192, 505.4541095616725, 509.41417370024766, 515.584954111936, 636.885450461692, 3571.142925697866, 3758.6241375862196, 3780.2628487444686, 3791.8862434127022, 3885.611438856148, 12722.745545089047, 13334.733305334034, 13468.0, 13587.0, 13594.45622175102, 13105.475780968845, 13452.461901524026, 13458.0, 13478.123921945042, 13638.659033524242, 9568.856467152998, 9571.473568953774, 9659.0, 9671.0, 9698.418094914328, 5686.289213848269, 5824.504917082096, 5835.153902684002, 5861.35525092248, 5966.463018328372, 11849.348285844017, 11964.820527691918, 12056.397180140782, 12226.144169908377, 12380.380980951097, 12091.879081209427, 12228.205166664138, 12420.751584968431, 12521.436535355748, 12536.498540058295, 7716.807079822825, 7920.801979950547, 7935.1271360149185, 7935.444518883623, 7941.205879412244, 8991.77520561965, 9062.682806101755, 9068.183863452321, 9148.222401095714, 9191.080891911022, 8046.356291496783, 8249.670013199644, 8254.793630159294, 8299.585020748818, 8498.107698691796, 7691.923080769121, 7972.6412311444965, 8007.239312265326, 8007.679692812455, 8070.47541909774, 6978.546394484342, 7132.8216794578475, 7140.107486564179, 7142.678579463833, 7151.7854464366155, 5192.1952097424955, 5205.869853253699, 5323.547498462674, 5342.8931421372135, 5448.073827449422, 5282.418933917343, 5355.758990845344, 5366.275552800478, 5458.836234912959, 5540.390557038642], "value": 4767.200671748517, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [376.2869362557953, 395.5846361320613, 400.29348200426233, 405.97970101494917, 409.1326388057319, 5114.872128196797, 5224.503672151149, 5336.973315133424, 5359.624826262163, 5396.568274538037, 5055.418626857912, 5155.922661160085, 5215.1655735082395, 5217.373915130181, 5223.399309079457, 4132.772697501651, 4150.958490415095, 4151.190517849021, 4155.4182414462, 4165.062860856314, 3910.902227444308, 3981.7610943343493, 4178.247915375231, 4201.327787553992, 4214.325707886739, 3966.6628336591425, 3972.1261322509004, 3973.1259122992897, 3974.940375894364, 3980.1442689821683, 3955.7626542407547, 3958.703097267702, 3966.087799806032, 3974.9205015899665, 3975.403689446577, 3511.5961664408665, 3515.1739341254784, 3518.190816112283, 3518.296340731864, 3521.542199514047, 4904.386951631046, 5065.873353166164, 5085.0, 5087.414947281073, 5120.564751996085, 4659.207934651117, 4668.226074091857, 4673.0, 4678.976605116953, 4681.836135735233, 5523.889522209573, 5527.447255274481, 5541.0, 5550.27846379972, 5565.16522521625, 3834.750741201813, 3902.941455878164, 3933.1150491139265, 3936.3308237599676, 3938.7439816411843, 5733.0, 5805.303363596396, 5819.912701309484, 5844.0, 5854.677992710442, 4029.5567487576345, 4036.5357983832237, 4047.291723948297, 4049.6962727795535, 4056.452378928866, 4019.577944315863, 4069.5320038195987, 4099.241640296555, 4100.138970816102, 4144.461220041436, 4681.953180468152, 4699.130660827758, 4701.294805779161, 4702.294655801588, 4711.3639658646325, 5575.107982722826, 5575.825428083051, 5588.608797384225, 5605.775768969277, 5607.80372686954, 1351.1015174908773, 1384.5500212431, 1395.9511417100352, 1411.9294035298399, 1426.8501807310083, 931.1712575807537, 941.8916824565263, 969.7333233360882, 969.8652576485529, 970.2965350121106, 4793.784279707422, 4805.879853003633, 4811.975940120277, 4815.951840481621, 4829.275608658659, 5714.828460165656, 5719.599628025998, 5724.513416359656, 5733.168690539848, 5738.483536481736, 4650.37219975299, 4757.500462451462, 4796.544328288807, 4806.8798280043275, 4819.3012013257885, 3002.9249268768017, 3025.9257963423106, 3048.4055609156003, 3056.5109582467144, 3059.1587313488967, 5422.15956526739, 5431.402545719968, 5443.836684899459, 5444.727763611803, 5455.290812194389, 5729.541636669056, 5789.88420231593, 5814.127880817911, 5845.269341332333, 5905.350411454737, 5340.599455040965, 5351.0, 5367.329083864517, 5369.597280203922, 5370.382406023279, 5516.613837031369, 5702.800401985911, 5704.885902282014, 5705.033382641086, 5720.971395142998, 5567.860803479945, 5585.832425027093, 5610.326760788732, 5617.213590097472, 5631.88736225265, 5350.866228344323, 5352.805349806717, 5358.0, 5392.838214853561, 5393.595480339069, 3945.4157526819977, 4009.6591789697036, 4023.3361495352938, 4056.3104272274372, 4080.693947953856, 5473.8357849264585, 5658.830235092953, 5662.98963867821, 5716.0, 5727.284089488814, 5312.62811603184, 5456.454354564512, 5522.66863988162, 5523.33719953592, 5548.445155484419, 5313.176457648916, 5507.586930980113, 5529.30883639545, 5555.2778138841695, 5559.249501317432, 5308.230306605444, 5412.78348866041, 5488.9725551371985, 5490.752916118704, 5500.559955203494, 5585.553155747449, 5591.0, 5614.9719251403485, 5622.578306626938, 5628.85927851807, 5184.781576329635, 5393.595480338912, 5471.972640136773, 5477.370102438271, 5485.6982865942755], "value": 4179.699237489806, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [728.0789800901857, 729.3035151430383, 732.783828770513, 736.4476642518113, 751.4927423988806, 12995.935020324898, 13414.128081674684, 13869.098508596946, 13905.026648134623, 14196.432142714279, 13244.139130956506, 13376.665583360396, 13671.658208544792, 13690.247036413019, 13695.0, 671.5869740109846, 891.8082612238368, 893.8748575199477, 899.1772528136747, 899.9010108888017, 850.8893843800297, 851.1786126388034, 853.2150421612132, 855.2260204514924, 909.4906852162777, 892.4779004282502, 897.7351681254013, 900.7342833863993, 902.6434558349448, 964.802215545815, 878.227160099115, 888.8311220868014, 893.9987214319971, 894.6287290774321, 958.9424634521916, 659.8383396067994, 660.2506155513527, 660.6630618384611, 680.3808534233873, 710.2294010998073, 12410.379481025913, 12510.249385036836, 12594.055445841506, 12619.936900315532, 12977.0, 10215.89784102157, 12655.620331390073, 12657.810132848015, 13132.6716832079, 13134.540291089766, 11639.767204655944, 11818.231814932002, 11898.821517677241, 12117.33354665493, 12286.815697764541, 2872.2819295176205, 2908.1130255272133, 2910.3451723362286, 2911.577821215933, 2912.5485549739824, 67539.3246067543, 67632.0, 67813.66093169502, 68608.6569567149, 69164.0, 10260.640877569249, 10574.221654449044, 10574.577016919236, 10712.679069488484, 10852.62015829458, 19173.904130479536, 20721.68917466239, 21104.261350852645, 21437.356879293646, 21603.0, 6650.035744817072, 6651.43462805667, 6690.5316627836555, 6727.529072964943, 6989.1962424321855, 3351.614564325134, 3403.812790296508, 3475.14858859581, 3494.7728397654073, 3525.065857547752, 3478.2000139967445, 3525.8413371398346, 3550.396432606463, 3574.3744844652083, 3589.838457269429, 731.3673672273445, 754.2306847016013, 757.2541047068632, 758.5714071549556, 761.0448886647222, 591.4735885062298, 596.0820336681548, 599.6881621556767, 599.8200539838031, 627.9623222606658, 8263.297619702273, 9715.854262186072, 9801.460919649346, 9933.552990115462, 9958.900410995942, 575.200471344831, 581.5783556921283, 589.6933594530819, 610.2067312493829, 610.3804638292048, 3826.5408151022057, 3885.154551587973, 3950.664193543581, 4029.1941611677194, 4050.837966481308, 57785.0, 57803.421965780646, 58015.0, 58799.88601766733, 61149.0, 51449.48550514447, 53091.734541327045, 53136.468635313155, 53525.46474535283, 53954.460455395725, 45159.77420112944, 45289.773551132035, 45819.99999999933, 46598.76700616543, 47807.521924781, 9432.858507122535, 9551.761205969906, 9824.568364770907, 9895.901040989498, 9985.800283994426, 24316.51366972615, 25005.0, 25562.872185638953, 25663.10179143721, 26418.603720944586, 41241.58758412377, 43056.138877222904, 43507.898669146074, 43913.34129988117, 44367.55632443763, 12175.208611440228, 12274.570390036306, 12302.384880755748, 12378.504859805507, 12452.81320780171, 13370.933145334211, 13405.597832065054, 13410.0, 13481.59555213345, 14061.086029408056, 12062.879371206176, 12202.816957745463, 12277.0, 12404.937975310426, 12524.561640342545, 11415.60045398407, 11518.596849110241, 11578.189526733384, 11660.18378713482, 12299.815502767287, 11331.943340283246, 11469.369184694922, 11473.541058357572, 11577.479013444246, 12081.093917956365, 8932.776680583038, 8961.462312261285, 9129.726108216764, 9175.587098580714, 9609.231261499202, 10029.348092373972, 10292.65873015873, 10424.843627345444, 10593.682189534326, 10613.150947924301], "value": 6468.922430957121, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1554.6, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 115.0, 113.0, 112.0, 112.0, 112.0, 110.0, 113.0, 111.0, 111.0], "value": 111.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 126.0, 126.0, 164.0, 127.0, 124.0, 124.0, 124.0, 151.0, 127.0], "value": 134.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 162.0, 167.0, 166.0, 163.0, 164.0, 165.0, 163.0, 164.0, 164.0], "value": 164.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 75.0, 109.0, 80.0, 82.0, 78.0, 76.0, 96.0, 80.0], "value": 83.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 108.0, 84.0, 84.0, 84.0, 111.0, 84.0, 83.0, 106.0], "value": 91.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 115.0, 113.0, 114.0, 114.0, 114.0, 114.0, 115.0, 114.0], "value": 114.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 151.0, 150.0, 150.0, 151.0, 150.0, 149.0, 151.0, 149.0, 150.0], "value": 150.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 94.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0], "value": 95.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 55.0, 55.0, 55.0, 56.0, 55.0, 58.0, 55.0, 55.0, 56.0], "value": 55.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 57.0, 56.0, 55.0, 55.0, 56.0, 56.0, 56.0, 56.0, 56.0], "value": 55.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 83.0, 82.0, 84.0, 83.0, 84.0, 83.0, 83.0, 83.0, 83.0], "value": 83.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [137.0, 137.0, 147.0, 142.0, 145.0, 150.0, 136.0, 151.0, 178.0, 132.0], "value": 145.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [187.0, 210.0, 198.0, 199.0, 204.0, 198.0, 197.0, 200.0, 194.0, 192.0], "value": 197.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 74.0, 71.0, 71.0, 79.0, 71.0, 70.0, 71.0, 68.0], "value": 72.3, "unit": "score"}]}]} 09:16:41 INFO - Return code: 0 09:16:41 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:16:41 ERROR - # TBPL SUCCESS # 09:16:41 INFO - Running post-action listener: _resource_record_post_action 09:16:41 INFO - [mozharness: 2017-04-05 16:16:41.828107Z] Finished run-tests step (success) 09:16:41 INFO - Running post-run listener: _resource_record_post_run 09:16:41 INFO - Total resource usage - Wall time: 1204s; CPU: 13.0%; Read bytes: 0; Write bytes: 359178240; Read time: 0; Write time: 202988 09:16:41 INFO - TinderboxPrint: CPU usage
13.0% 09:16:41 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 09:16:41 INFO - TinderboxPrint: I/O write bytes / time
359,178,240 / 202,988 09:16:41 INFO - TinderboxPrint: CPU idle
8,359.2 (87.0%) 09:16:41 INFO - TinderboxPrint: CPU user
1,204.8 (12.5%) 09:16:41 INFO - TinderboxPrint: Swap in / out
0 / 0 09:16:41 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 100790272; Read time: 0; Write time: 83728 09:16:41 INFO - run-tests - Wall time: 1189s; CPU: 13.0%; Read bytes: 0; Write bytes: 257101824; Read time: 0; Write time: 119212 09:16:42 INFO - Running post-run listener: _upload_blobber_files 09:16:42 INFO - Blob upload gear active. 09:16:42 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:16:42 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 09:16:42 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-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:16:42 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-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:16:42 INFO - (blobuploader) - INFO - Open directory for files ... 09:16:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:16:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:16:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:16:46 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:16:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:16:46 INFO - (blobuploader) - INFO - Done attempting. 09:16:46 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:16:46 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:16:46 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:16:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:16:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:16:46 INFO - (blobuploader) - INFO - Done attempting. 09:16:46 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 09:16:46 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:16:46 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:16:47 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:16:47 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:16:47 INFO - (blobuploader) - INFO - Done attempting. 09:16:47 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 09:16:47 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:16:47 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:16:48 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 09:16:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:16:48 INFO - (blobuploader) - INFO - Done attempting. 09:16:48 INFO - (blobuploader) - INFO - Iteration through files over. 09:16:48 INFO - Return code: 0 09:16:48 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:16:48 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:16:48 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d519dcd772310ce4da1ddced62b5a3b845d1322623376264994ae90612d4f6cb9188edbff138ab35c7401238e179e9a452de9f4a8e9ee551f70c78ac51885c21", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8e9f923aca6cc8bf54ec92d92df65045f120a1504fa58cda19b8af6df19dcf486c4c3ca526e9b37714a4d3e6cde6088005cfe7ef32a5465f678709b6b47f04d4", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d62b6b06649f7d2d06222da4ce5471eb991bb9d08a0296ca804aa7d9cbc71194aa1768c2c2767c01e2f7a8de3500c07fa0009c90f63d8d77a0aa653edf7f9578", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ac922e181fefeca740c2721c8110b99c3c3af3736d586aeddd31e1a982b23fbfcaafc24b25ef7bd5bb1daab93b797514d09244f2d9bda96f21d774fe3303ccd1"} 09:16:48 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:16:48 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:16:48 INFO - Contents: 09:16:48 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d519dcd772310ce4da1ddced62b5a3b845d1322623376264994ae90612d4f6cb9188edbff138ab35c7401238e179e9a452de9f4a8e9ee551f70c78ac51885c21", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8e9f923aca6cc8bf54ec92d92df65045f120a1504fa58cda19b8af6df19dcf486c4c3ca526e9b37714a4d3e6cde6088005cfe7ef32a5465f678709b6b47f04d4", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d62b6b06649f7d2d06222da4ce5471eb991bb9d08a0296ca804aa7d9cbc71194aa1768c2c2767c01e2f7a8de3500c07fa0009c90f63d8d77a0aa653edf7f9578", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ac922e181fefeca740c2721c8110b99c3c3af3736d586aeddd31e1a982b23fbfcaafc24b25ef7bd5bb1daab93b797514d09244f2d9bda96f21d774fe3303ccd1"} 09:16:48 INFO - Running post-run listener: copy_logs_to_upload_dir 09:16:48 INFO - Copying logs to upload dir... 09:16:48 INFO - mkdir: /builds/slave/test/build/upload/logs 09:16:48 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1263.545069 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2017-04-05 09:16:48.534726) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-05 09:16:48.538260) ========= 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=438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d519dcd772310ce4da1ddced62b5a3b845d1322623376264994ae90612d4f6cb9188edbff138ab35c7401238e179e9a452de9f4a8e9ee551f70c78ac51885c21", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8e9f923aca6cc8bf54ec92d92df65045f120a1504fa58cda19b8af6df19dcf486c4c3ca526e9b37714a4d3e6cde6088005cfe7ef32a5465f678709b6b47f04d4", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d62b6b06649f7d2d06222da4ce5471eb991bb9d08a0296ca804aa7d9cbc71194aa1768c2c2767c01e2f7a8de3500c07fa0009c90f63d8d77a0aa653edf7f9578", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ac922e181fefeca740c2721c8110b99c3c3af3736d586aeddd31e1a982b23fbfcaafc24b25ef7bd5bb1daab93b797514d09244f2d9bda96f21d774fe3303ccd1"} build_url:https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011198 build_url: 'https://queue.taskcluster.net/v1/task/W5ZZZIO2S4ugsa0nQ1ms-A/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d519dcd772310ce4da1ddced62b5a3b845d1322623376264994ae90612d4f6cb9188edbff138ab35c7401238e179e9a452de9f4a8e9ee551f70c78ac51885c21", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8e9f923aca6cc8bf54ec92d92df65045f120a1504fa58cda19b8af6df19dcf486c4c3ca526e9b37714a4d3e6cde6088005cfe7ef32a5465f678709b6b47f04d4", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d62b6b06649f7d2d06222da4ce5471eb991bb9d08a0296ca804aa7d9cbc71194aa1768c2c2767c01e2f7a8de3500c07fa0009c90f63d8d77a0aa653edf7f9578", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ac922e181fefeca740c2721c8110b99c3c3af3736d586aeddd31e1a982b23fbfcaafc24b25ef7bd5bb1daab93b797514d09244f2d9bda96f21d774fe3303ccd1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-05 09:16:48.569723) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-05 09:16:48.570287) ========= 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=438111f3d31ce799eff2119d000001bc-1491407742.865706-1405908277 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004429 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-05 09:16:48.656110) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-05 09:16:48.656662) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-05 09:16:48.657202) ========= ========= Total master_lag: 0.18 =========