builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-040 starttime: 1490614849.5 results: success (0) revision: 40527edab13ccbae51459acccd480fd6b394885f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:49.495634) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:49.496132) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:49.496522) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:49.511412) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-27 04:40:49.511733) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-03-27 04:40:51-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 228M=0s 2017-03-27 04:40:52 (228 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=1.267989 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-27 04:40:50.793591) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:50.793930) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015379 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:50.845261) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 3 secs) (at 2017-03-27 04:40:50.845800) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 40527edab13ccbae51459acccd480fd6b394885f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 40527edab13ccbae51459acccd480fd6b394885f --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=9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-03-27 04:40:52,926 truncating revision to first 12 chars 2017-03-27 04:40:52,926 Setting DEBUG logging. 2017-03-27 04:40:52,926 attempt 1/10 2017-03-27 04:40:52,926 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/40527edab13c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-27 04:40:56,077 unpacking tar archive at: mozilla-aurora-40527edab13c/testing/mozharness/ program finished with exit code 0 elapsedTime=3.953847 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 3 secs) (at 2017-03-27 04:40:54.814023) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:54.814362) ========= script_repo_revision: 40527edab13ccbae51459acccd480fd6b394885f ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:54.814762) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:54.815074) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-27 04:40:54.825268) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 59 secs) (at 2017-03-27 04:40:54.825563) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:40:56 INFO - MultiFileLogger online at 20170327 04:40:56 in /builds/slave/test 04:40:56 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 04:40:56 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:40:57 INFO - {'append_to_log': False, 04:40:57 INFO - 'base_work_dir': '/builds/slave/test', 04:40:57 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 04:40:57 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:40:57 INFO - 'branch': 'Mozilla-Aurora', 04:40:57 INFO - 'buildbot_json_path': 'buildprops.json', 04:40:57 INFO - 'config_files': ('talos/linux_config.py',), 04:40:57 INFO - 'default_actions': ('clobber', 04:40:57 INFO - 'read-buildbot-config', 04:40:57 INFO - 'download-and-extract', 04:40:57 INFO - 'populate-webroot', 04:40:57 INFO - 'create-virtualenv', 04:40:57 INFO - 'install', 04:40:57 INFO - 'run-tests'), 04:40:57 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:40:57 INFO - 'download_minidump_stackwalk': True, 04:40:57 INFO - 'download_symbols': 'ondemand', 04:40:57 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:40:57 INFO - 'tooltool.py': '/tools/tooltool.py', 04:40:57 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:40:57 INFO - '/tools/misc-python/virtualenv.py')}, 04:40:57 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:40:57 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:40:57 INFO - 'gecko_profile': False, 04:40:57 INFO - 'gecko_profile_interval': 0, 04:40:57 INFO - 'installer_path': 'installer.exe', 04:40:57 INFO - 'log_level': 'info', 04:40:57 INFO - 'log_name': 'talos', 04:40:57 INFO - 'log_to_console': True, 04:40:57 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:40:57 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:40:57 INFO - 'opt_config_files': (), 04:40:57 INFO - 'pip_index': False, 04:40:57 INFO - 'suite': 'dromaeojs', 04:40:57 INFO - 'system_bits': '32', 04:40:57 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:40:57 INFO - 'title': 'talos-linux64-ix-040', 04:40:57 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:40:57 INFO - 'use_talos_json': True, 04:40:57 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:40:57 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:40:57 INFO - 'work_dir': 'build'} 04:40:57 INFO - [mozharness: 2017-03-27 11:40:57.008118Z] Running clobber step. 04:40:57 INFO - Running pre-action listener: _resource_record_pre_action 04:40:57 INFO - Running main action method: clobber 04:40:57 INFO - rmtree: /builds/slave/test/build 04:40:57 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:40:57 INFO - Running post-action listener: _resource_record_post_action 04:40:57 INFO - [mozharness: 2017-03-27 11:40:57.962481Z] Finished clobber step (success) 04:40:57 INFO - [mozharness: 2017-03-27 11:40:57.962581Z] Running read-buildbot-config step. 04:40:57 INFO - Running pre-action listener: _resource_record_pre_action 04:40:57 INFO - Running main action method: read_buildbot_config 04:40:57 INFO - Using buildbot properties: 04:40:57 INFO - { 04:40:57 INFO - "project": "", 04:40:57 INFO - "product": "firefox", 04:40:57 INFO - "who": "cbook@mozilla.com", 04:40:57 INFO - "installer_path": "public/build/target.tar.bz2", 04:40:57 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 04:40:57 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-aurora/", 04:40:57 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 04:40:57 INFO - "stage_platform": "linux64-pgo", 04:40:57 INFO - "basedir": "/builds/slave/test", 04:40:57 INFO - "buildnumber": 1117, 04:40:57 INFO - "platform": "ubuntu64_hw", 04:40:57 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 04:40:57 INFO - "slavebuilddir": "test", 04:40:57 INFO - "taskId": "c4WE-ce4RH2d4-11Icnntg", 04:40:57 INFO - "branch": "mozilla-aurora", 04:40:57 INFO - "script_repo_revision": "production", 04:40:57 INFO - "revision": "40527edab13ccbae51459acccd480fd6b394885f", 04:40:57 INFO - "slavename": "talos-linux64-ix-040", 04:40:57 INFO - "repo_path": "releases/mozilla-aurora" 04:40:57 INFO - } 04:40:57 INFO - Finding installer, test and symbols from parent task. 04:40:57 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/c4WE-ce4RH2d4-11Icnntg'}, attempt #1 04:40:59 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/c4WE-ce4RH2d4-11Icnntg'}, attempt #1 04:41:01 INFO - Task dependencies: A_SPqbwxTpqT6Ns8olz7xQ 04:41:01 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ'}, attempt #1 04:41:02 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.tar.bz2 04:41:02 INFO - Set test_url: https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/test_packages.json 04:41:02 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.crashreporter-symbols.zip 04:41:02 INFO - Running post-action listener: _resource_record_post_action 04:41:02 INFO - [mozharness: 2017-03-27 11:41:02.609570Z] Finished read-buildbot-config step (success) 04:41:02 INFO - [mozharness: 2017-03-27 11:41:02.609791Z] Running download-and-extract step. 04:41:02 INFO - Running pre-action listener: _resource_record_pre_action 04:41:02 INFO - Running main action method: download_and_extract 04:41:02 INFO - mkdir: /builds/slave/test/build/tests 04:41:02 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')]} 04:41:02 INFO - trying https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.test_packages.json 04:41:02 INFO - Downloading https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 04:41:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 04:41:04 INFO - Downloaded 896 bytes. 04:41:04 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 04:41:04 INFO - Using the following test package requirements: 04:41:04 INFO - {u'common': [u'target.common.tests.zip'], 04:41:04 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 04:41:04 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 04:41:04 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 04:41:04 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 04:41:04 INFO - u'mozbase': [u'target.common.tests.zip'], 04:41:04 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 04:41:04 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 04:41:04 INFO - u'web-platform': [u'target.common.tests.zip', 04:41:04 INFO - u'target.web-platform.tests.zip'], 04:41:04 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 04:41:04 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 04:41:04 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.common.tests.zip 04:41:04 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:41:04 INFO - Fetch https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.common.tests.zip into memory 04:41:34 INFO - Expected file size: 59538221 04:41:34 INFO - Obtained file size: 59538221 04:41:44 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 04:41:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.common.tests.zip 04:41:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:41:44 INFO - Fetch https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.common.tests.zip into memory 04:41:47 INFO - Expected file size: 59538221 04:41:47 INFO - Obtained file size: 59538221 04:41:57 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.talos.tests.zip 04:41:57 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 04:41:57 INFO - Fetch https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.talos.tests.zip into memory 04:41:59 INFO - Expected file size: 14404438 04:41:59 INFO - Obtained file size: 14404438 04:41:59 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')]} 04:41:59 INFO - trying https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.tar.bz2 04:41:59 INFO - Downloading https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 04:41:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 04:42:14 INFO - Downloaded 66661698 bytes. 04:42:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.tar.bz2 04:42:14 INFO - mkdir: /builds/slave/test/properties 04:42:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:42:14 INFO - Writing to file /builds/slave/test/properties/build_url 04:42:14 INFO - Contents: 04:42:14 INFO - build_url:https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.tar.bz2 04:42:14 INFO - Running post-action listener: _resource_record_post_action 04:42:14 INFO - Running post-action listener: set_extra_try_arguments 04:42:14 INFO - [mozharness: 2017-03-27 11:42:14.292017Z] Finished download-and-extract step (success) 04:42:14 INFO - [mozharness: 2017-03-27 11:42:14.292250Z] Running populate-webroot step. 04:42:14 INFO - Running pre-action listener: _resource_record_pre_action 04:42:14 INFO - Running main action method: populate_webroot 04:42:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:42:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:42:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:42:14 INFO - '--tppagecycles', 04:42:14 INFO - '7'], 04:42:14 INFO - 'tests': ['tsvgm']}}, 04:42:14 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:42:14 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:42:14 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:42:14 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:42:14 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 04:42:14 INFO - 'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:42:14 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 04:42:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:42:14 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 04:42:14 INFO - 'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['damp', 'tps']}, 04:42:14 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 04:42:14 INFO - 'tests': ['damp', 'tps']}, 04:42:14 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['dromaeo_dom']}, 04:42:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:42:14 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['basic_compositor_video']}, 04:42:14 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 04:42:14 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['a11yr', 04:42:14 INFO - 'ts_paint', 04:42:14 INFO - 'tpaint', 04:42:14 INFO - 'sessionrestore', 04:42:14 INFO - 'sessionrestore_no_auto_restore', 04:42:14 INFO - 'tabpaint']}, 04:42:14 INFO - 'other-e10s': {'tests': ['a11yr', 04:42:14 INFO - 'ts_paint', 04:42:14 INFO - 'tpaint', 04:42:14 INFO - 'sessionrestore', 04:42:14 INFO - 'sessionrestore_no_auto_restore', 04:42:14 INFO - 'tabpaint']}, 04:42:14 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:42:14 INFO - 'ts_paint', 04:42:14 INFO - 'tpaint', 04:42:14 INFO - 'sessionrestore', 04:42:14 INFO - 'sessionrestore_no_auto_restore', 04:42:14 INFO - 'tabpaint']}, 04:42:14 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:42:14 INFO - 'ts_paint', 04:42:14 INFO - 'tpaint', 04:42:14 INFO - 'sessionrestore', 04:42:14 INFO - 'sessionrestore_no_auto_restore', 04:42:14 INFO - 'tabpaint']}, 04:42:14 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['a11yr', 04:42:14 INFO - 'ts_paint', 04:42:14 INFO - 'tpaint', 04:42:14 INFO - 'sessionrestore', 04:42:14 INFO - 'sessionrestore_no_auto_restore', 04:42:14 INFO - 'tabpaint']}, 04:42:14 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['a11yr', 04:42:14 INFO - 'ts_paint', 04:42:14 INFO - 'tpaint', 04:42:14 INFO - 'sessionrestore', 04:42:14 INFO - 'sessionrestore_no_auto_restore', 04:42:14 INFO - 'tabpaint']}, 04:42:14 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['tsvgx', 04:42:14 INFO - 'tsvgr_opacity', 04:42:14 INFO - 'tart', 04:42:14 INFO - 'tscrollx', 04:42:14 INFO - 'cart', 04:42:14 INFO - 'tsvg_static']}, 04:42:14 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:42:14 INFO - 'tsvgr_opacity', 04:42:14 INFO - 'tart', 04:42:14 INFO - 'tscrollx', 04:42:14 INFO - 'cart', 04:42:14 INFO - 'tsvg_static']}, 04:42:14 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 04:42:14 INFO - 'talos_options': ['--disable-e10s'], 04:42:14 INFO - 'tests': ['tp5o']}, 04:42:14 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 04:42:14 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 04:42:14 INFO - 'talos_options': ['--disable-e10s', 04:42:14 INFO - '--xperf_path', 04:42:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:42:14 INFO - 'tests': ['tp5n']}, 04:42:14 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 04:42:14 INFO - 'talos_options': ['--xperf_path', 04:42:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:42:14 INFO - 'tests': ['tp5n']}}, 04:42:14 INFO - 'talos.zip': {'path': '', 04:42:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:42:14 INFO - Running post-action listener: _resource_record_post_action 04:42:14 INFO - [mozharness: 2017-03-27 11:42:14.310005Z] Finished populate-webroot step (success) 04:42:14 INFO - [mozharness: 2017-03-27 11:42:14.310094Z] Running create-virtualenv step. 04:42:14 INFO - Running pre-action listener: _resource_record_pre_action 04:42:14 INFO - Running main action method: create_virtualenv 04:42:14 INFO - Creating virtualenv /builds/slave/test/build/venv 04:42: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 04:42:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:42:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:42:14 INFO - Using real prefix '/usr' 04:42:14 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:42:14 INFO - Installing distribute.............................................................................................................................................................................................done. 04:42:16 INFO - Installing pip.................done. 04:42:16 INFO - Return code: 0 04:42:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 04:42:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 04:42:17 INFO - Reading from file tmpfile_stdout 04:42:17 INFO - Output received: 04:42: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) 04:42:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:42: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')]} 04:42:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42: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')]} 04:42:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42: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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42: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 04:42: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 04:42:17 INFO - Using env: {'DISPLAY': ':0', 04:42:17 INFO - 'HOME': '/home/cltbld', 04:42:17 INFO - 'LANG': 'en_US.UTF-8', 04:42:17 INFO - 'LANGUAGE': 'en_US:en', 04:42:17 INFO - 'LOGNAME': 'cltbld', 04:42:17 INFO - 'MAIL': '/var/mail/cltbld', 04:42:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:17 INFO - 'MOZ_NO_REMOTE': '1', 04:42:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:17 INFO - 'NO_EM_RESTART': '1', 04:42:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:17 INFO - 'PWD': '/builds/slave/test', 04:42:17 INFO - 'SHELL': '/bin/bash', 04:42:17 INFO - 'SHLVL': '1', 04:42:17 INFO - 'TERM': 'linux', 04:42:17 INFO - 'TMOUT': '86400', 04:42:17 INFO - 'USER': 'cltbld', 04:42:17 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:17 INFO - '_': '/tools/buildbot/bin/python'} 04:42:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42: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 04:42:17 INFO - Cleaning up... 04:42:17 INFO - Return code: 0 04:42:17 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:42: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')]} 04:42:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42: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')]} 04:42:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:18 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:18 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 04:42:18 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 04:42:18 INFO - Using env: {'DISPLAY': ':0', 04:42:18 INFO - 'HOME': '/home/cltbld', 04:42:18 INFO - 'LANG': 'en_US.UTF-8', 04:42:18 INFO - 'LANGUAGE': 'en_US:en', 04:42:18 INFO - 'LOGNAME': 'cltbld', 04:42:18 INFO - 'MAIL': '/var/mail/cltbld', 04:42:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:18 INFO - 'MOZ_NO_REMOTE': '1', 04:42:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:18 INFO - 'NO_EM_RESTART': '1', 04:42:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:18 INFO - 'PWD': '/builds/slave/test', 04:42:18 INFO - 'SHELL': '/bin/bash', 04:42:18 INFO - 'SHLVL': '1', 04:42:18 INFO - 'TERM': 'linux', 04:42:18 INFO - 'TMOUT': '86400', 04:42:18 INFO - 'USER': 'cltbld', 04:42:18 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:18 INFO - '_': '/tools/buildbot/bin/python'} 04:42:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:18 INFO - Downloading/unpacking psutil>=3.1.1 04:42:18 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 04:42:18 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 04:42:18 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 04:42:18 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 04:42:18 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 04:42:18 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 04:42:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:42:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:42:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:42:23 INFO - Installing collected packages: psutil 04:42:23 INFO - Running setup.py install for psutil 04:42:23 INFO - building 'psutil._psutil_linux' extension 04:42:23 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 04:42:23 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 04:42:23 INFO - building 'psutil._psutil_posix' extension 04:42:23 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 04:42:23 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 04:42:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:42:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:42:23 INFO - Successfully installed psutil 04:42:23 INFO - Cleaning up... 04:42:23 INFO - Return code: 0 04:42:23 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:42:23 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')]} 04:42:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:23 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')]} 04:42:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:23 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:23 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 04:42:23 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 04:42:23 INFO - Using env: {'DISPLAY': ':0', 04:42:23 INFO - 'HOME': '/home/cltbld', 04:42:23 INFO - 'LANG': 'en_US.UTF-8', 04:42:23 INFO - 'LANGUAGE': 'en_US:en', 04:42:23 INFO - 'LOGNAME': 'cltbld', 04:42:23 INFO - 'MAIL': '/var/mail/cltbld', 04:42:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:23 INFO - 'MOZ_NO_REMOTE': '1', 04:42:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:23 INFO - 'NO_EM_RESTART': '1', 04:42:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:23 INFO - 'PWD': '/builds/slave/test', 04:42:23 INFO - 'SHELL': '/bin/bash', 04:42:23 INFO - 'SHLVL': '1', 04:42:23 INFO - 'TERM': 'linux', 04:42:23 INFO - 'TMOUT': '86400', 04:42:23 INFO - 'USER': 'cltbld', 04:42:23 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:23 INFO - '_': '/tools/buildbot/bin/python'} 04:42:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:23 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:42: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 04:42: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 04:42: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 04:42: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 04:42: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 04:42: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 04:42:26 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:42:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:42:26 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:42:26 INFO - Installing collected packages: mozsystemmonitor 04:42:26 INFO - Running setup.py install for mozsystemmonitor 04:42:26 INFO - Successfully installed mozsystemmonitor 04:42:26 INFO - Cleaning up... 04:42:26 INFO - Return code: 0 04:42:26 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:42:26 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')]} 04:42:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:26 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')]} 04:42:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:27 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:27 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 04:42:27 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 04:42:27 INFO - Using env: {'DISPLAY': ':0', 04:42:27 INFO - 'HOME': '/home/cltbld', 04:42:27 INFO - 'LANG': 'en_US.UTF-8', 04:42:27 INFO - 'LANGUAGE': 'en_US:en', 04:42:27 INFO - 'LOGNAME': 'cltbld', 04:42:27 INFO - 'MAIL': '/var/mail/cltbld', 04:42:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:27 INFO - 'MOZ_NO_REMOTE': '1', 04:42:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:27 INFO - 'NO_EM_RESTART': '1', 04:42:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:27 INFO - 'PWD': '/builds/slave/test', 04:42:27 INFO - 'SHELL': '/bin/bash', 04:42:27 INFO - 'SHLVL': '1', 04:42:27 INFO - 'TERM': 'linux', 04:42:27 INFO - 'TMOUT': '86400', 04:42:27 INFO - 'USER': 'cltbld', 04:42:27 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:27 INFO - '_': '/tools/buildbot/bin/python'} 04:42:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:27 INFO - Downloading/unpacking jsonschema==2.5.1 04:42:27 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 04:42:27 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 04:42:27 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 04:42:27 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 04:42:27 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 04:42:27 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 04:42:30 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:42:30 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:42:30 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 04:42:30 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 04:42:30 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 04:42:30 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 04:42:30 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 04:42:30 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 04:42:30 INFO - Downloading functools32-3.2.3-2.tar.gz 04:42:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:42:30 INFO - warning: no files found matching '*.txt' 04:42:30 INFO - no previously-included directories found matching 'build' 04:42:30 INFO - no previously-included directories found matching 'dist' 04:42:30 INFO - no previously-included directories found matching '.git*' 04:42:30 INFO - Installing collected packages: jsonschema, functools32 04:42:30 INFO - Running setup.py install for functools32 04:42:30 INFO - warning: no files found matching '*.txt' 04:42:30 INFO - no previously-included directories found matching 'build' 04:42:30 INFO - no previously-included directories found matching 'dist' 04:42:30 INFO - no previously-included directories found matching '.git*' 04:42:31 INFO - Successfully installed jsonschema functools32 04:42:31 INFO - Cleaning up... 04:42:31 INFO - Return code: 0 04:42:31 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:42:31 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')]} 04:42:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:31 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')]} 04:42:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:32 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:32 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 04:42:32 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 04:42:32 INFO - Using env: {'DISPLAY': ':0', 04:42:32 INFO - 'HOME': '/home/cltbld', 04:42:32 INFO - 'LANG': 'en_US.UTF-8', 04:42:32 INFO - 'LANGUAGE': 'en_US:en', 04:42:32 INFO - 'LOGNAME': 'cltbld', 04:42:32 INFO - 'MAIL': '/var/mail/cltbld', 04:42:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:32 INFO - 'MOZ_NO_REMOTE': '1', 04:42:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:32 INFO - 'NO_EM_RESTART': '1', 04:42:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:32 INFO - 'PWD': '/builds/slave/test', 04:42:32 INFO - 'SHELL': '/bin/bash', 04:42:32 INFO - 'SHLVL': '1', 04:42:32 INFO - 'TERM': 'linux', 04:42:32 INFO - 'TMOUT': '86400', 04:42:32 INFO - 'USER': 'cltbld', 04:42:32 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:32 INFO - '_': '/tools/buildbot/bin/python'} 04:42:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:32 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:42:32 INFO - Cleaning up... 04:42:32 INFO - Return code: 0 04:42:32 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:42: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')]} 04:42:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42: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')]} 04:42:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:32 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:32 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 04:42:32 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 04:42:32 INFO - Using env: {'DISPLAY': ':0', 04:42:32 INFO - 'HOME': '/home/cltbld', 04:42:32 INFO - 'LANG': 'en_US.UTF-8', 04:42:32 INFO - 'LANGUAGE': 'en_US:en', 04:42:32 INFO - 'LOGNAME': 'cltbld', 04:42:32 INFO - 'MAIL': '/var/mail/cltbld', 04:42:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:32 INFO - 'MOZ_NO_REMOTE': '1', 04:42:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:32 INFO - 'NO_EM_RESTART': '1', 04:42:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:32 INFO - 'PWD': '/builds/slave/test', 04:42:32 INFO - 'SHELL': '/bin/bash', 04:42:32 INFO - 'SHLVL': '1', 04:42:32 INFO - 'TERM': 'linux', 04:42:32 INFO - 'TMOUT': '86400', 04:42:32 INFO - 'USER': 'cltbld', 04:42:32 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:32 INFO - '_': '/tools/buildbot/bin/python'} 04:42:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:33 INFO - Downloading/unpacking blobuploader==1.2.4 04:42:33 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 04:42:33 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 04:42:33 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 04:42:33 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 04:42:33 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 04:42:33 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 04:42:37 INFO - Downloading blobuploader-1.2.4.tar.gz 04:42:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:42:37 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:42:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:42:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:42:37 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 04:42:37 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 04:42:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:42:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:42:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:42:37 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:42:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:42:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:42:37 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 04:42:37 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 04:42:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:42:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:42:37 INFO - Downloading docopt-0.6.1.tar.gz 04:42:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:42:37 INFO - Installing collected packages: blobuploader, requests, docopt 04:42:37 INFO - Running setup.py install for blobuploader 04:42:37 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:42:37 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:42:37 INFO - Running setup.py install for requests 04:42:38 INFO - Running setup.py install for docopt 04:42:38 INFO - Successfully installed blobuploader requests docopt 04:42:38 INFO - Cleaning up... 04:42:38 INFO - Return code: 0 04:42:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:42:38 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')]} 04:42:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:38 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')]} 04:42:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:38 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:38 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 04:42:38 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 04:42:38 INFO - Using env: {'DISPLAY': ':0', 04:42:38 INFO - 'HOME': '/home/cltbld', 04:42:38 INFO - 'LANG': 'en_US.UTF-8', 04:42:38 INFO - 'LANGUAGE': 'en_US:en', 04:42:38 INFO - 'LOGNAME': 'cltbld', 04:42:38 INFO - 'MAIL': '/var/mail/cltbld', 04:42:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:38 INFO - 'MOZ_NO_REMOTE': '1', 04:42:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:38 INFO - 'NO_EM_RESTART': '1', 04:42:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:38 INFO - 'PWD': '/builds/slave/test', 04:42:38 INFO - 'SHELL': '/bin/bash', 04:42:38 INFO - 'SHLVL': '1', 04:42:38 INFO - 'TERM': 'linux', 04:42:38 INFO - 'TMOUT': '86400', 04:42:38 INFO - 'USER': 'cltbld', 04:42:38 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:38 INFO - '_': '/tools/buildbot/bin/python'} 04:42:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:42:39 INFO - Running setup.py (path:/tmp/pip-Lp9hCQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:42:39 INFO - Running setup.py (path:/tmp/pip-dJfraL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:42:39 INFO - Running setup.py (path:/tmp/pip-i3g7R6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:42:39 INFO - Running setup.py (path:/tmp/pip-NUAtiC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:42:39 INFO - Running setup.py (path:/tmp/pip-3G6sn4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:42:39 INFO - Running setup.py (path:/tmp/pip-haGF3P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:42:39 INFO - Running setup.py (path:/tmp/pip-AAtEXJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:42:39 INFO - Running setup.py (path:/tmp/pip-ZSAnc_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:42:39 INFO - Running setup.py (path:/tmp/pip-g4rjLs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:42:39 INFO - Running setup.py (path:/tmp/pip-tghyTP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:42:39 INFO - Running setup.py (path:/tmp/pip-ALVT1r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:42:39 INFO - Running setup.py (path:/tmp/pip-YL8DkI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:42:39 INFO - Running setup.py (path:/tmp/pip-AOhZAO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:42:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:42:39 INFO - Running setup.py (path:/tmp/pip-BiDO5r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:42:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:42:40 INFO - Running setup.py (path:/tmp/pip-0zjegG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:42:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:42:40 INFO - Running setup.py (path:/tmp/pip-J2MHXi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:42:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:42:40 INFO - Running setup.py (path:/tmp/pip-XqEl6k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:42:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:42:40 INFO - Running setup.py install for manifestparser 04:42:40 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:42:40 INFO - Running setup.py install for mozcrash 04:42:40 INFO - Running setup.py install for mozdebug 04:42:40 INFO - Running setup.py install for mozdevice 04:42:40 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:42:40 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:42:40 INFO - Running setup.py install for mozfile 04:42:40 INFO - Running setup.py install for mozhttpd 04:42:40 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:42:40 INFO - Running setup.py install for mozinfo 04:42:40 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:42:40 INFO - Running setup.py install for mozInstall 04:42:41 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Running setup.py install for mozleak 04:42:41 INFO - Running setup.py install for mozlog 04:42:41 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Running setup.py install for moznetwork 04:42:41 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Running setup.py install for mozprocess 04:42:41 INFO - Running setup.py install for mozprofile 04:42:41 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Running setup.py install for mozrunner 04:42:41 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:42:41 INFO - Running setup.py install for mozscreenshot 04:42:41 INFO - Running setup.py install for moztest 04:42:41 INFO - Running setup.py install for mozversion 04:42:42 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:42:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:42:42 INFO - Cleaning up... 04:42:42 INFO - Return code: 0 04:42:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:42:42 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')]} 04:42:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:42 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')]} 04:42:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:42 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:42 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 04:42:42 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 04:42:42 INFO - Using env: {'DISPLAY': ':0', 04:42:42 INFO - 'HOME': '/home/cltbld', 04:42:42 INFO - 'LANG': 'en_US.UTF-8', 04:42:42 INFO - 'LANGUAGE': 'en_US:en', 04:42:42 INFO - 'LOGNAME': 'cltbld', 04:42:42 INFO - 'MAIL': '/var/mail/cltbld', 04:42:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:42 INFO - 'MOZ_NO_REMOTE': '1', 04:42:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:42 INFO - 'NO_EM_RESTART': '1', 04:42:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:42 INFO - 'PWD': '/builds/slave/test', 04:42:42 INFO - 'SHELL': '/bin/bash', 04:42:42 INFO - 'SHLVL': '1', 04:42:42 INFO - 'TERM': 'linux', 04:42:42 INFO - 'TMOUT': '86400', 04:42:42 INFO - 'USER': 'cltbld', 04:42:42 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:42 INFO - '_': '/tools/buildbot/bin/python'} 04:42:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:42:42 INFO - Running setup.py (path:/tmp/pip-vD4QId-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:42:42 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)) 04:42:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:42:42 INFO - Running setup.py (path:/tmp/pip-zyByDn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:42:42 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)) 04:42:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:42:42 INFO - Running setup.py (path:/tmp/pip-J3GTPo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:42:43 INFO - Running setup.py (path:/tmp/pip-qiCIfS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:42:43 INFO - Running setup.py (path:/tmp/pip-AZ5QH6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:42:43 INFO - Running setup.py (path:/tmp/pip-yHE7P8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:42:43 INFO - Running setup.py (path:/tmp/pip-ylc7Rd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:42:43 INFO - Running setup.py (path:/tmp/pip-pkJD98-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:42:43 INFO - Running setup.py (path:/tmp/pip-FQJDCO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:42:43 INFO - Running setup.py (path:/tmp/pip-CgFD9m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:42:43 INFO - Running setup.py (path:/tmp/pip-3Ki_TO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:42:43 INFO - Running setup.py (path:/tmp/pip-DGr_Ru-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:42:43 INFO - Running setup.py (path:/tmp/pip-H6A93R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:42:43 INFO - Running setup.py (path:/tmp/pip-6TUq6U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:42:43 INFO - Running setup.py (path:/tmp/pip-UJeHMF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:42:43 INFO - Running setup.py (path:/tmp/pip-s1Lk5i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:42:43 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)) 04:42:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:42:43 INFO - Running setup.py (path:/tmp/pip-tUcrzY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:42:44 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)) 04:42:44 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)) 04:42:44 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)) 04:42:44 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)) 04:42:44 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)) 04:42:44 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)) 04:42:44 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:42:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:42:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:42:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:42:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:42:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:42:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:42:48 INFO - Downloading blessings-1.6.tar.gz 04:42:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:42:48 INFO - Installing collected packages: blessings 04:42:48 INFO - Running setup.py install for blessings 04:42:48 INFO - Successfully installed blessings 04:42:48 INFO - Cleaning up... 04:42:48 INFO - Return code: 0 04:42:48 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:42:48 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:42:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:42:49 INFO - Reading from file tmpfile_stdout 04:42:49 INFO - Current package versions: 04:42:49 INFO - argparse == 1.2.1 04:42:49 INFO - blessings == 1.6 04:42:49 INFO - blobuploader == 1.2.4 04:42:49 INFO - docopt == 0.6.1 04:42:49 INFO - functools32 == 3.2.3-2 04:42:49 INFO - jsonschema == 2.5.1 04:42:49 INFO - manifestparser == 1.1 04:42:49 INFO - mozInstall == 1.12 04:42:49 INFO - mozcrash == 1.0 04:42:49 INFO - mozdebug == 0.1 04:42:49 INFO - mozdevice == 0.49 04:42:49 INFO - mozfile == 1.2 04:42:49 INFO - mozhttpd == 0.7 04:42:49 INFO - mozinfo == 0.9 04:42:49 INFO - mozleak == 0.1 04:42:49 INFO - mozlog == 3.4 04:42:49 INFO - moznetwork == 0.27 04:42:49 INFO - mozprocess == 0.25 04:42:49 INFO - mozprofile == 0.28 04:42:49 INFO - mozrunner == 6.13 04:42:49 INFO - mozscreenshot == 0.1 04:42:49 INFO - mozsystemmonitor == 0.3 04:42:49 INFO - moztest == 0.8 04:42:49 INFO - mozversion == 1.4 04:42:49 INFO - psutil == 3.1.1 04:42:49 INFO - requests == 1.2.3 04:42:49 INFO - wsgiref == 0.1.2 04:42:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:42:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:42:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:42:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:49 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:49 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 04:42:49 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 04:42:49 INFO - Using env: {'DISPLAY': ':0', 04:42:49 INFO - 'HOME': '/home/cltbld', 04:42:49 INFO - 'LANG': 'en_US.UTF-8', 04:42:49 INFO - 'LANGUAGE': 'en_US:en', 04:42:49 INFO - 'LOGNAME': 'cltbld', 04:42:49 INFO - 'MAIL': '/var/mail/cltbld', 04:42:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:49 INFO - 'MOZ_NO_REMOTE': '1', 04:42:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:49 INFO - 'NO_EM_RESTART': '1', 04:42:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:49 INFO - 'PWD': '/builds/slave/test', 04:42:49 INFO - 'SHELL': '/bin/bash', 04:42:49 INFO - 'SHLVL': '1', 04:42:49 INFO - 'TERM': 'linux', 04:42:49 INFO - 'TMOUT': '86400', 04:42:49 INFO - 'USER': 'cltbld', 04:42:49 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:49 INFO - '_': '/tools/buildbot/bin/python'} 04:42:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 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)) 04:42:49 INFO - Cleaning up... 04:42:49 INFO - Return code: 0 04:42:49 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:42:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:42:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:42:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:42:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:42:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:42:51 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 0x24591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2551a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26f6b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, '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': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', '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 04:42:51 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 04:42:51 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 04:42:51 INFO - Using env: {'DISPLAY': ':0', 04:42:51 INFO - 'HOME': '/home/cltbld', 04:42:51 INFO - 'LANG': 'en_US.UTF-8', 04:42:51 INFO - 'LANGUAGE': 'en_US:en', 04:42:51 INFO - 'LOGNAME': 'cltbld', 04:42:51 INFO - 'MAIL': '/var/mail/cltbld', 04:42:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:51 INFO - 'MOZ_NO_REMOTE': '1', 04:42:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:51 INFO - 'NO_EM_RESTART': '1', 04:42:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:51 INFO - 'PWD': '/builds/slave/test', 04:42:51 INFO - 'SHELL': '/bin/bash', 04:42:51 INFO - 'SHLVL': '1', 04:42:51 INFO - 'TERM': 'linux', 04:42:51 INFO - 'TMOUT': '86400', 04:42:51 INFO - 'USER': 'cltbld', 04:42:51 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:42:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:51 INFO - '_': '/tools/buildbot/bin/python'} 04:42:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:42:51 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:42:51 INFO - Cleaning up... 04:42:51 INFO - Return code: 0 04:42:51 INFO - Running post-action listener: _resource_record_post_action 04:42:51 INFO - Running post-action listener: _start_resource_monitoring 04:42:51 INFO - Starting resource monitoring. 04:42:51 INFO - [mozharness: 2017-03-27 11:42:51.322984Z] Finished create-virtualenv step (success) 04:42:51 INFO - [mozharness: 2017-03-27 11:42:51.323458Z] Running install step. 04:42:51 INFO - Running pre-action listener: _resource_record_pre_action 04:42:51 INFO - Running main action method: install 04:42:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:42:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:42:51 INFO - Reading from file tmpfile_stdout 04:42:51 INFO - Detecting whether we're running mozinstall >=1.0... 04:42:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:42:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:42:51 INFO - Reading from file tmpfile_stdout 04:42:51 INFO - Output received: 04:42:51 INFO - Usage: mozinstall [options] installer 04:42:51 INFO - Options: 04:42:51 INFO - -h, --help show this help message and exit 04:42:51 INFO - -d DEST, --destination=DEST 04:42:51 INFO - Directory to install application into. [default: 04:42:51 INFO - "/builds/slave/test"] 04:42:51 INFO - --app=APP Application being installed. [default: firefox] 04:42:51 INFO - mkdir: /builds/slave/test/build/application 04:42:51 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'] 04:42:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 04:43:08 INFO - Reading from file tmpfile_stdout 04:43:08 INFO - Output received: 04:43:08 INFO - /builds/slave/test/build/application/firefox/firefox 04:43:08 INFO - Running post-action listener: _resource_record_post_action 04:43:08 INFO - [mozharness: 2017-03-27 11:43:08.230283Z] Finished install step (success) 04:43:08 INFO - [mozharness: 2017-03-27 11:43:08.230555Z] Running run-tests step. 04:43:08 INFO - Running pre-action listener: _resource_record_pre_action 04:43:08 INFO - Running main action method: run_tests 04:43:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:43:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:43:08 INFO - Python 2.7.3 04:43:08 INFO - Return code: 0 04:43:08 INFO - grabbing minidump binary from tooltool 04:43:08 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')]} 04:43:08 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 0x26f4290>, '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 0x26f4b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26f5040>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:43:08 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 04:43:08 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 04:43:08 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 04:43:08 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:43:08 INFO - Return code: 0 04:43:08 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:43:08 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:43:08 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:43:08 INFO - ENV: RUST_BACKTRACE is now 1 04:43:08 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:43:08 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:43:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-040', '--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 04:43:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-040 --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 04:43:08 INFO - Using env: {'DISPLAY': ':0', 04:43:08 INFO - 'HOME': '/home/cltbld', 04:43:08 INFO - 'LANG': 'en_US.UTF-8', 04:43:08 INFO - 'LANGUAGE': 'en_US:en', 04:43:08 INFO - 'LOGNAME': 'cltbld', 04:43:08 INFO - 'MAIL': '/var/mail/cltbld', 04:43:08 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:43:08 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:43:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:08 INFO - 'MOZ_NO_REMOTE': '1', 04:43:08 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:43:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:08 INFO - 'NO_EM_RESTART': '1', 04:43:08 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:08 INFO - 'PWD': '/builds/slave/test', 04:43:08 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:43:08 INFO - 'RUST_BACKTRACE': '1', 04:43:08 INFO - 'SHELL': '/bin/bash', 04:43:08 INFO - 'SHLVL': '1', 04:43:08 INFO - 'TERM': 'linux', 04:43:08 INFO - 'TMOUT': '86400', 04:43:08 INFO - 'USER': 'cltbld', 04:43:08 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932', 04:43:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:08 INFO - '_': '/tools/buildbot/bin/python'} 04:43:08 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-040', '--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 04:43:08 INFO - mozversion application_buildid: 20170327104638 04:43:08 INFO - mozversion application_changeset: 40527edab13ccbae51459acccd480fd6b394885f 04:43:08 INFO - mozversion application_display_name: FirefoxDeveloperEdition 04:43:08 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:43:08 INFO - mozversion application_name: Firefox 04:43:08 INFO - mozversion application_remotingname: firefox-dev 04:43:08 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 04:43:08 INFO - mozversion application_vendor: Mozilla 04:43:08 INFO - mozversion application_version: 54.0a2 04:43:08 INFO - mozversion platform_buildid: 20170327104638 04:43:08 INFO - mozversion platform_changeset: 40527edab13ccbae51459acccd480fd6b394885f 04:43:08 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 04:43:08 INFO - mozversion platform_version: 54.0a2 04:43:08 INFO - using testdate: 1490614988 04:43:08 INFO - actual date: 1490614988 04:43:08 INFO - starting webserver on 'localhost:38670' 04:43:08 INFO - SUITE-START | Running 2 tests 04:43:08 INFO - TEST-START | dromaeo_css 04:43:08 INFO - operating with platform_type : linux_ 04:43:08 INFO - Initialising browser for dromaeo_css test... 04:43:08 INFO - TEST-INFO | started process 7313 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpw61ryJ/profile http://localhost:38670/getInfo.html) 04:43:12 INFO - PROCESS | 7313 | __metrics Screen width/height:1600/1200 04:43:12 INFO - PROCESS | 7313 | colorDepth:24 04:43:12 INFO - PROCESS | 7313 | Browser inner width/height: 1024/697 04:43:12 INFO - PROCESS | 7313 | __metrics 04:43:13 INFO - PROCESS | 7313 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 04:43:13 INFO - PROCESS | 7313 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:43:14 INFO - TEST-INFO | 7313: exit 0 04:43:14 INFO - Browser initialized. 04:43:14 INFO - Running cycle 1/1 for dromaeo_css test... 04:43:14 INFO - TEST-INFO | started process 7405 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpw61ryJ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:43:26 INFO - PROCESS | 7405 | RSS: Main: 140238848 04:43:26 INFO - PROCESS | 7405 | 04:46:27 INFO - PROCESS | 7405 | Cycle 1(1): loaded http://localhost:38670/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38670/tests/dromaeo/cssquery-ext.html) 04:46:28 INFO - PROCESS | 7405 | RSS: Main: 217976832 04:46:28 INFO - PROCESS | 7405 | 04:48:16 INFO - PROCESS | 7405 | ************************* 04:48:16 INFO - PROCESS | 7405 | A coding exception was thrown and uncaught in a Task. 04:48:16 INFO - PROCESS | 7405 | 04:48:16 ERROR - PROCESS | 7405 | Full message: TypeError: NetworkError when attempting to fetch resource. 04:48:16 INFO - PROCESS | 7405 | Full stack: 04:48:16 INFO - PROCESS | 7405 | ************************* 04:49:31 INFO - PROCESS | 7405 | Cycle 1(1): loaded http://localhost:38670/tests/dromaeo/cssquery-ext.html (next: http://localhost:38670/tests/dromaeo/cssquery-jquery.html) 04:49:31 INFO - PROCESS | 7405 | RSS: Main: 216535040 04:49:31 INFO - PROCESS | 7405 | 04:52:33 INFO - PROCESS | 7405 | Cycle 1(1): loaded http://localhost:38670/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38670/tests/dromaeo/cssquery-mootools.html) 04:52:34 INFO - PROCESS | 7405 | RSS: Main: 170426368 04:52:34 INFO - PROCESS | 7405 | 04:55:36 INFO - PROCESS | 7405 | Cycle 1(1): loaded http://localhost:38670/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38670/tests/dromaeo/cssquery-prototype.html) 04:55:36 INFO - PROCESS | 7405 | RSS: Main: 209711104 04:55:36 INFO - PROCESS | 7405 | 04:58:39 INFO - PROCESS | 7405 | Cycle 1(1): loaded http://localhost:38670/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38670/tests/dromaeo/cssquery-yui.html) 04:58:40 INFO - PROCESS | 7405 | RSS: Main: 176332800 04:58:40 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | Cycle 1(1): loaded http://localhost:38670/tests/dromaeo/cssquery-yui.html (next: http://localhost:38670/tests/dromaeo/cssquery-dojo.html) 05:01:42 INFO - PROCESS | 7405 | RSS: Main: 269914112 05:01:42 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | __start_tp_report 05:01:42 INFO - PROCESS | 7405 | _x_x_mozilla_page_load 05:01:42 INFO - PROCESS | 7405 | _x_x_mozilla_page_load_details 05:01:42 INFO - PROCESS | 7405 | |i|pagename|runs| 05:01:42 INFO - PROCESS | 7405 | |0;dojo.html;3345.5985281766193;3363.24327026419;3381.1209085637743;3414.30006848596;3423.8288085595714;5717.599768016241;5762.9135562966485;5774;5783.277090363699;5810.01229790936;5721.456461636138;5781.219535362725;5788.507976821975;5789.131630255464;5790.160426738121;5128.615353848458;5144.511271429227;5179.559737422323;5182;5215.582753379739;4950.207966725325;5213.687178769286;5227.372715274172;5238.4499627539135;5254.789808407659;5022;5042.974785126069;5067.163917953533;5087.389513258396;5152.768125434346;5157.664751791141;5185.766640501187;5197.272381866561;5198.610104242159;5202.06362854686;5063.063333283318;5105.285260063594;5161.690298582097;5161.767720452589;5196.376434827845;5405.405405405402;5460.262864513319;5577.3028371453565;5596.944030559683;5697.4587414195585;6126.090206827809;6129.920395826272;6130.141780150782;6131.386861313833;6133.16299541884;6173.876522469525;6210.130581718563;6211.689415529206;6212.068189771525;6212.316645169028;5470.2888624478965;5486.478784515504;5697.971510142505;5718.1708652246025;5787.160861675034;6278.058291256348;6293.622382657055;6301.338359472281;6309.274433440213;6311.116443697886;5968.104784282305;6050.48570871472;6062.575619706578;6068.029115341524;6076.908846367308;5873.706314684248;5907;6056.212692350055;6162.168107305456;6167.198264225622;6163.476104531165;6163.7842675506145;6166.044263139221;6169.259688837368;6177.81466556004;5716.256886604715;5745.683987380734;5763.250777398911;6104.267487901391;6111.491261806163;4186.162767446523;4187.623113919762;4191.7275377100395;4210.368444733253;4245.23585754561;3759.9248015039548;3787.9242415151543;3790;3817.8472861085247;3835.67396771272;5832.94167058324;5859.150423188614;5887.293524776968;5971.611845230046;5994.910076348771;6098.69506524672;6137;6141.692915354214;6145.539084568586;6179.876402471926;5710.486056254874;5938.61399009063;5955.404459554096;5968.76124954997;5972.462478376967;5115.923261151086;5120.667156634807;5120.92318615221;5125.69245845243;5133.307003554472;6237.033259844731;6244.781432649836;6247.9062814057825;6357.936420635734;6388.616682999035;6103.438803286574;6145.324014358506;6163.445289923929;6163.660998645118;6188.257409110935;6438.163038804925;6479.963205887036;6511.934880651323;6513.381228783258;6517.837054073497;5756.798512052058;5795.652260864362;6012.549058820518;6117.908231376444;6124.693765311627;6166;6167.475764560063;6175.752969881154;6177.413145751147;6182.103594978793;5981.910271345846;6018.951685147193;6021.277446706424;6031.577789554689;6033.245844269466;5730.3410107838135;5795.043817770021;6004.099385092271;6011.7595296187665;6019.247594050744;5921.911171332347;5939.673317967553;6014.609050411709;6032.758689652364;6050.273967123973;5806.970965145148;5808.36108028125;5811.4188581143235;5978.611390259619;6064.151018857452;5883.058710606282;5892.1161825726485;5941.970290148522;5956.076808094752;5963.493103086113 05:01:42 INFO - PROCESS | 7405 | |1;ext.html;830.4726498673342;884.1335491218607;895.1361935732021;898.8471959766839;964.0407794244727;38199.427008594896;39105.21789564207;42823.57176428235;42837.357439638356;42837.78581107098;38588;38977.41533876987;39047.21905561887;39060.414093788546;39245.21509569807;7613.809654758647;7641.465097443182;7736.883946740803;7742.458027938046;7789.805254868617;10417;10623.681289561326;10626;10641.73395665107;10644.893551064506;10820.350778953249;10836.620718274862;10838.783224335508;10853.077488413493;10857.45712714365;10725.892741072606;10762.677119686383;10765;10770.569177232901;10782.946085269523;10485.528151233213;10527.157827373869;10546.156307495383;10546.472676366151;10549.47252637365;42017;42026;42286;42334.57665423337;42420.78789606032;4164.190340346299;4194.496660400771;4244.575542445762;4311.439512863308;4322.913541729179;29796.553051704243;29976.250593735112;30117.247068823453;30250;31622.683773162204;3851.326017946876;3940.2513522430645;3957.742746721454;3961.5840336764513;4045.9190816183514;223251;226247.8687606568;227235;227470;227581;43744.343834842504;44536.3319550207;47290;51386.48613513892;51410.48589514132;54207.45792542103;54260.45739542554;54378.45621543813;54434.72782636061;54455.455445445834;15910.840891590937;16034.518964431085;16045.358185672676;16049.919750401174;16050.197490125447;13946.442142314396;13976.580702578938;13984.930075349557;13992.650183745487;13996.930015349859;13715.177089374669;13991;13997.230152341719;14036.368363423671;14120.43518259258;5637.267155269788;5656.688882111441;5663.773449062074;5679.403662615448;5750.367459579443;1000.8949060348705;1011.7268337548968;1012.1245122968726;1016.3749294184172;1022.5500779656927;28002.85998570035;28169.43661126766;28172;28186.85906570454;28609.85695071553;1077.849101125843;1080.68660088575;1089.5097206257217;1106.4854842498278;1119.6696974392573;14583.92708036453;14855.777163342558;14959.326830292663;15253.16107614092;15258.542243732705;270472;271181;271370;272131;272343;54719.72640136774;54831.45168548343;54870.72564637151;54936.72531637396;54981;1490.694407646408;1495.835458099608;1549.2253873063469;1551.697419003306;1551.9689606207812;25601.743982559936;26678.866605666848;26894.193174204804;27099.72900270972;27131.1860644181;42497.57502424936;42547.36178957256;42580.78709606432;42592;42595.787021064694;259862;262008;262943;263135;263627;29650;30046.399072018;33921.830390847885;34896.30207395888;35020.64979350174;42942.57057429386;43078.56921430871;43280;43753;44170.55829441793;33936.83031584826;34077.65922340745;34138.82930585331;34172.48741268833;34206.82896585601;33105.83447082749;33143.33713325768;33313.333733325686;33379.83310083434;33407.49888751719;35273.47089793604;36437.817810910776;38784;38905.6109438902;39259.60740392674;29790;29953.251168720955;30091.69908300889;30235.244118897204;30382.54426183653;23791.405214869766;24877.751222487543;24889.62665559982;24932.501349972536;25336.74663253344 05:01:42 INFO - PROCESS | 7405 | |2;jquery.html;444.6976056281727;451.8599234237387;456.7510706664865;464.8047819915635;481.7302310706004;19435.708464373027;21185.364439066852;21197;21270.787292127075;21473.57052858942;21610.135594576197;22378.776212237874;22412.775872241273;22490;22603.886980565076;6587.7035533400995;6875.106236189288;6878.312168783106;7095.858082838366;7259.382952449048;7052.294770522958;7313.414926805869;7400.518966267202;7422;7425.368843648296;7423.777286681408;7448.553086814782;7448.888266676005;7455.179930207672;7515.812104697372;7270.745523906664;7415.851682966338;7442.851142977164;7450.254974502561;7505.286997735207;7088.716451341992;7231.710731570731;7242.674079666428;7275.745348912816;7403.185649578542;25107.748922510906;25426;25548.23355299344;25608;25806.870965645052;3014.668386477486;3030.863611137504;3051.9542206866913;3095.7368623667016;3141.1361875484195;14746.410143594243;15914.363425462967;16412.425565105164;16460.67078658432;16659.583510412336;2177.6733489976473;2200.8899555022185;2208.933731988027;2257.142285931352;2259.6271615183473;114114.42942785316;117062.99999999914;117390;117482;119328.40335798352;17779.28882844672;17921;17924.103794810206;18031.098445077692;18308.542286442946;31802.522962155585;31848.681513185034;31866;31873.84063079716;31893.8405307972;9985.400875947467;10032.498375081217;10054.547545360476;10103.898961010296;10292.845607315896;8433.493990360597;8506.872396914052;8532.829343413097;8692.391532592657;8702.173293537104;8967.551622418852;9177.311701622404;9287.210587100037;9342.299327550461;9401.905980940102;3550.857965681344;3655.8484077515495;3770.849166033383;3856.2094770571966;3931.724779265424;963.942163470194;967.1730670276953;973.2722925582995;978.280963491833;979.8432250839832;20808.167673292897;20840.895795520926;20855.37433876986;21073.367798966057;21085.262015829678;963.7735132243918;973.6105557776946;977.6187286958092;987.9308448408542;1007.2747621712356;10881.183911206692;11573.42132893352;11594;11762.176647634584;11825;598001;600324;612628;614884;633973;78148;79154.6042269785;84229;113555;116444.41777791057;1179.3572502985894;1224.1675660550734;1283.5250957145915;1289.2264641215384;1291.3349624943162;18708.532286692396;18892;19125.426237212905;19143;19158;49985.75007124941;50628.74685626548;51031.489685104156;51551.74224128856;51625;67425;67955;68437;68674;68743.65628171827;11125;11187;11229.38238396896;11332.263402878787;11376.829347559627;12848.678783030498;13078.673033173865;13209.339533023503;13225.338733063116;13435.462581496631;11351.829722554003;11552.249103808226;11581.768364632828;11632.709182270173;11761.294322340345;10266.6406675766;10343.224258180817;10371.688849334532;10405.63580274717;10454.42500662471;11605.129615279056;11929.642110736344;12001;12004.39978001114;12174.57388991381;11439.14206434504;11567.537298507965;11629.709257268298;11764.764704705687;11849;11257.887421125684;11280.32318060919;11390.943045285052;11614.883851161718;11664.88335116672 05:01:42 INFO - PROCESS | 7405 | |3;mootools.html;1590.8170560385558;1593.545839435761;1604.7111519926411;1612.8870979031472;1619.3279788887608;10976.341419514834;11873.406329683525;11875.465604047828;11881.287122772628;11883.346415947119;11235.606753763619;11639.709007274821;11981;12006.45970931308;12008.099392545571;2511.949761004779;2552.094006627639;2556.309796354983;2557.7058638256653;2557.846529208244;2431.1977047574346;2502.4244423782543;2549.222487141421;2549.528337257613;2549.8087643426725;2437.305367970129;2480.3923038855505;2524.5708229601014;2537.7716005559496;2538.4669219463935;2358.96461553076;2429.0648100481353;2437.0373702387546;2462.7414121517163;2473.7402572729784;2252.9549409011893;2254.3462395905167;2284.520250747345;2285.851419657717;2299.7355304139905;11696.649100526998;11900.285982841056;11916.404179790976;11923.880761192364;11924.165308428413;5688.459596338383;5805.303363596396;5817.156512305692;5820.388859169769;5821.330546987108;3442.3803715331233;3470.7570470067108;3529.170644898447;3563.6614521620404;3593.7125029997537;1357.8234829472203;1377.7313423882347;1405.9015868889182;1411.4777532313008;1436.2029073864;17177.82822171787;17192.57018574533;17746.91126544372;18534.258629654796;18643.90678046601;4780.402449693788;4834.71879951813;4858.319835223072;4863.659543831968;4957.603391728653;13675.179489230479;13676.247806370746;13692.041557090908;13696.178229306273;13705.520306789214;5789.8263052108505;5805.7387417566315;5844.12338149281;5856.267966504187;5860.853478663067;5122.644667742635;5199.532042116228;5341.145416733304;5387.568994480433;5390.164524498709;3959.366501359826;4046.5548789633117;4065.065035041957;4081.387791831249;4132.33882578786;1037;1044.9895501045044;1054.2567489919588;1061.3578784835217;1064.7178497698117;1060.570468960057;1077.256692881909;1078.8813230544633;1080.2330345454816;1091.683411810566;7391.519551229153;7468.1672472485425;7504;7574.886376704354;7640.274173953466;994.9154321882577;1004.5579944824254;1063.473580577619;1066.2429674930731;1081.561967403203;4404.317330813729;4558.407407037131;4605.516420775837;4644.907101857944;4656.697314674603;14402.783958240634;14912.403503859725;14995.250237488082;15700.528984130495;15704.136272504893;12597.433115509824;15322.463713769965;15441.30514126867;15559.144247066293;15572.221388930735;9457.76355591102;10643.254972151875;10774.78450430987;10810.081143102925;11182.32906025641;6889.314400815577;7208.243134470805;7381.704731810667;7431.3683336916965;7530.623468826428;13136.27750473733;13539.79690304666;13597.932010339884;13835.446582136601;13845.23851188154;12828.10203285761;13100.410481528164;14099.929500352433;14123.081999669988;14190.503332383318;9799.216062714822;9980;10105.898941010495;10226.59093636276;10366.688999330032;11374.090072794323;11573.13201509907;11615.245009074382;11657;11704.239224450383;9243.537823108953;9246.630134794534;9347.205487533363;9392.342536022687;9413.105754953542;9034.683786067457;9039.95480022622;9063;9173.954130229306;9230.584623692084;8329.750107496784;8442.366822488215;8771.122887711434;8771.91228087711;8773.034966153591;6044.637321760709;6059.575829692056;6153.169322141453;6177;6267.749290028348;6584.901226481702;6690.933090669226;6693.2972037935315;6722.9663851680425;6838.794836154923 05:01:42 INFO - PROCESS | 7405 | |4;prototype.html;411.9794010299484;418.64206103781265;432.7879339123828;438.4081489988516;441.856396671082;5163.218689552104;5210.296609957664;5240.711760853156;5262.868428289295;5276.868078298045;5044.899102017957;5101.821436249732;5108.540231379176;5175.534201921826;5230.450802665722;4327.17783621111;4333.2416827055295;4340.696151269412;4344.348347747848;4345.848350187203;4340.958170039199;4346.587074227959;4375.212461756899;4381.627561657263;4392.155294776202;4227.471566054243;4281.314989601664;4317.122051907415;4332.480102387718;4343.435353404053;4265.786710664454;4267.658587313008;4307.612314891675;4309.6983211175075;4310.181065597527;4051.7974101294817;4052.6555242804397;4061.4720086388875;4070.514262294271;4084.1627466369323;4924.80300787968;5046;5065.442801291855;5080.949190508085;5134;5295.920561191585;5302;5305.628605997582;5348.71630808607;5350.197470379435;5473;5496.422875598045;5589.217509548666;5599;5613.887722245573;4745.742789556423;4805.399325084364;4809.639277054235;4889.046635906;4907.411110666707;5520.944790552083;5601.719914004283;5659.4340565943485;5781.427264867136;5787.363390027093;4993.90012199754;4997.925446029121;5023.974880125576;5024.748762561857;5025.673331233458;4839.153148199051;4963.677360971526;4979.4771548987555;5113.386393632788;5131.87170320745;5210.739463026834;5214.97392513035;5242.895142097137;5249.501297376743;5267.157254839208;5469.288992431038;5498.147787093007;5530.723463826793;5536.622660177289;5549.418415751572;1720.7418887166775;1747.1391584481253;1755.447034184228;1767.770189875308;1768.593223558563;1394.7838085096826;1434.6800943132343;1457.3150619208955;1459.9854001460062;1462.9487967921284;5372.462753724674;5376.758045887945;5424.755885985141;5447.155690867922;5458.935507576064;5359;5610.579206559524;5615.326160860641;5650.717464126859;5665;5365.3293338332705;5414.29614150158;5470.261514695465;5489.505944464938;5493.423190565013;2915.329474220941;2943.617329747119;2950.3214260720156;2964.4663960486887;2965.7330840224054;5509.779608815603;5659.462835727671;5776.3068431787615;5824.126381042877;5844.568080820226;5698.601097923106;5735.713214339266;5738.368779434259;5762.337331206881;5771.509421699203;5662.150677398341;5794.725160464691;5807.751333463326;5825.300963884361;5848.5028772553105;5564.33228012641;5606.953461986427;5621.634593751393;5637.915431268616;5675.233843431084;5293.470652934676;5349.518543331119;5377.300950876361;5424.701641409761;5471.376686699732;5787.884242315215;5823.94176058234;5831.271091113611;5843.918875008138;5860.208871802252;4448.6218671412;4714.457837348612;4951.529604687549;4962.45413004562;5014.373203349582;5585.720713964204;5616.69108199053;5643.379228284967;5646.943530564806;5690.743916523684;5540.390557038642;5547.44525547442;5552.750126244409;5638.943610564006;5704.743286552032;5368.8389348319615;5534.667919924817;5581.6930068846605;5593.944060559343;5626.606137570331;5517.675757818175;5565.499105080562;5566.636174137362;5574.303212098488;5576.665400076008;5396.595255355785;5630.014747419267;5649.350324712711;5663.9716801415725;5666;5421.972890135682;5445.918311225256;5446.537044351275;5483.287172667528;5486.204500347348 05:01:42 INFO - PROCESS | 7405 | |5;yui.html;810.9472884262523;836.9246767790897;890.8218356328734;924.1160466932262;931.3434029009549;15341.84658153418;16300.755488667664;16302.266398012089;16323.183840807971;16327.18364081794;14950.40198392063;16644.08457534835;16741.832581674178;16892.239849206784;16913.323467061302;883.7172104926426;898.6674930275807;909.5815924674657;909.6225066597354;910.1808372464801;894.6510860764307;895.1048951048951;895.5164211325877;896.4666023715879;897.7441429192681;934.3506263147116;937.5921474158729;937.7374335186124;938.0900526489295;938.9108034736723;928.215657769184;930.9813803723888;931.501646619059;933.5285680731188;933.5705575435308;682.276786606199;683.2040672616396;684.9794506164823;685.0546246180239;686.0292685849518;14863;14928.402863885432;15327.693446131127;15704.52886413398;15866.286017129258;13454.798178027337;13537.323133843367;14306.85693143076;14337.21145337006;14356.85643143576;12731.809022864665;12802.871971280354;12813.679658008532;12972.610821675366;12983.28591927453;4050.3316952702767;4053.655439287664;4055.1484188320487;4122.319817230154;4205.537390887;81445.59277203576;81932;82852.58573707093;83198.58400707958;83537.16462835415;10655.094316982988;10875.347479151118;10953;10989.560417583207;11040.668779936615;20873;22525.211617593304;22548.21081262148;22572.66141007886;22710.091596336293;9260.120288572574;9328.253739700944;9354.672586459441;9360.204382627417;9513.952430237805;5041.722705251246;5108.744562771846;5156.303898973591;5162.845114646567;5292.629515933848;3551.6448355164275;3658.908527286839;3664.670179683788;3665.9633403666157;3674.7243956703355;587.9088741245114;593.379917985706;598.1655590451296;599.7181324777434;602.0818252165483;850.6257246811507;872.4895935877456;883.4169448164181;894.5035505294494;896.7758060484879;11423.828642570368;11802.350870702194;12169.20900141488;12561.937190314173;12562.921869621388;847.4788005376649;850.7235148576738;864.0538610221797;871.1680345270379;871.2681347667989;5460.481254280837;5534.640248383842;5551.833444996657;5577.860553486195;5605.5515558755205;82552.58723706462;84762;85197.57401212954;86055;88050.55974720085;58929.41070589325;65303;71265;71544.28455715481;73981.63009184919;65467.67266163734;66179.33820661732;66698.66650666716;66917.3308266911;67595.66202169056;10527.94736026315;10601.946990265307;10611.946940265248;10662.90410416345;10806.837897431387;42401.78799106108;42896;43130.35304470373;43878.12243755171;44232.7788361069;48446;48641.270380943606;48760.75619622021;49785;51235.74382128065;12727.809082863949;12731.490740370651;12961.15752476086;13063.608091757262;13095.738085238052;15109.32008059618;15148.924255378653;15167.620809479851;15258.694826103638;15284.15937123469;14441.711165776836;14615.634609134857;14656.633584160481;14658.413663453342;15697.450589229322;14566.34451449666;14580;14889.776653349993;15808.60478488047;17912.820871791115;15536;15541.533753987398;16352.918235408746;16861.91569042147;17069.82930170732;11543.826842597537;11550.88449115498;11671.824922625998;12074.39628018613;12421.627351179479;12542.686432839251;13771.586852394445;13913.930430347784;14170.14979101216;14178 05:01:42 INFO - PROCESS | 7405 | __end_tp_report 05:01:42 INFO - PROCESS | 7405 | __start_cc_report 05:01:42 INFO - PROCESS | 7405 | _x_x_mozilla_cycle_collect,1476 05:01:42 INFO - PROCESS | 7405 | __end_cc_report 05:01:42 INFO - PROCESS | 7405 | __startTimestamp1490616102977__endTimestamp 05:01:42 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | ------- Summary: start ------- 05:01:42 INFO - PROCESS | 7405 | Number of tests: 6 05:01:42 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | [#0] dojo.html Cycles:165 Average:5652.32 Median:5907.00 stddev:710.75 (12.0%) stddev-sans-first:689.50 05:01:42 INFO - PROCESS | 7405 | Values: 3345.6 3363.2 3381.1 3414.3 3423.8 5717.6 5762.9 5774.0 5783.3 5810.0 5721.5 5781.2 5788.5 5789.1 5790.2 5128.6 5144.5 5179.6 5182.0 5215.6 4950.2 5213.7 5227.4 5238.4 5254.8 5022.0 5043.0 5067.2 5087.4 5152.8 5157.7 5185.8 5197.3 5198.6 5202.1 5063.1 5105.3 5161.7 5161.8 5196.4 5405.4 5460.3 5577.3 5596.9 5697.5 6126.1 6129.9 6130.1 6131.4 6133.2 6173.9 6210.1 6211.7 6212.1 6212.3 5470.3 5486.5 5698.0 5718.2 5787.2 6278.1 6293.6 6301.3 6309.3 6311.1 5968.1 6050.5 6062.6 6068.0 6076.9 5873.7 5907.0 6056.2 6162.2 6167.2 6163.5 6163.8 6166.0 6169.3 6177.8 5716.3 5745.7 5763.3 6104.3 6111.5 4186.2 4187.6 4191.7 4210.4 4245.2 3759.9 3787.9 3790.0 3817.8 3835.7 5832.9 5859.2 5887.3 5971.6 5994.9 6098.7 6137.0 6141.7 6145.5 6179.9 5710.5 5938.6 5955.4 5968.8 5972.5 5115.9 5120.7 5120.9 5125.7 5133.3 6237.0 6244.8 6247.9 6357.9 6388.6 6103.4 6145.3 6163.4 6163.7 6188.3 6438.2 6480.0 6511.9 6513.4 6517.8 5756.8 5795.7 6012.5 6117.9 6124.7 6166.0 6167.5 6175.8 6177.4 6182.1 5981.9 6019.0 6021.3 6031.6 6033.2 5730.3 5795.0 6004.1 6011.8 6019.2 5921.9 5939.7 6014.6 6032.8 6050.3 5807.0 5808.4 5811.4 5978.6 6064.2 5883.1 5892.1 5942.0 5956.1 5963.5 05:01:42 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | [#1] ext.html Cycles:180 Average:42531.95 Median:30069.05 stddev:65962.66 (219.4%) stddev-sans-first:66073.39 05:01:42 INFO - PROCESS | 7405 | Values: 830.5 884.1 895.1 898.8 964.0 38199.4 39105.2 42823.6 42837.4 42837.8 38588.0 38977.4 39047.2 39060.4 39245.2 7613.8 7641.5 7736.9 7742.5 7789.8 10417.0 10623.7 10626.0 10641.7 10644.9 10820.4 10836.6 10838.8 10853.1 10857.5 10725.9 10762.7 10765.0 10770.6 10782.9 10485.5 10527.2 10546.2 10546.5 10549.5 42017.0 42026.0 42286.0 42334.6 42420.8 4164.2 4194.5 4244.6 4311.4 4322.9 29796.6 29976.3 30117.2 30250.0 31622.7 3851.3 3940.3 3957.7 3961.6 4045.9 223251.0 226247.9 227235.0 227470.0 227581.0 43744.3 44536.3 47290.0 51386.5 51410.5 54207.5 54260.5 54378.5 54434.7 54455.5 15910.8 16034.5 16045.4 16049.9 16050.2 13946.4 13976.6 13984.9 13992.7 13996.9 13715.2 13991.0 13997.2 14036.4 14120.4 5637.3 5656.7 5663.8 5679.4 5750.4 1000.9 1011.7 1012.1 1016.4 1022.6 28002.9 28169.4 28172.0 28186.9 28609.9 1077.8 1080.7 1089.5 1106.5 1119.7 14583.9 14855.8 14959.3 15253.2 15258.5 270472.0 271181.0 271370.0 272131.0 272343.0 54719.7 54831.5 54870.7 54936.7 54981.0 1490.7 1495.8 1549.2 1551.7 1552.0 25601.7 26678.9 26894.2 27099.7 27131.2 42497.6 42547.4 42580.8 42592.0 42595.8 259862.0 262008.0 262943.0 263135.0 263627.0 29650.0 30046.4 33921.8 34896.3 35020.6 42942.6 43078.6 43280.0 43753.0 44170.6 33936.8 34077.7 34138.8 34172.5 34206.8 33105.8 33143.3 33313.3 33379.8 33407.5 35273.5 36437.8 38784.0 38905.6 39259.6 29790.0 29953.3 30091.7 30235.2 30382.5 23791.4 24877.8 24889.6 24932.5 25336.7 05:01:42 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | [#2] jquery.html Cycles:180 Average:35750.16 Median:12431.76 stddev:100893.20 (811.6%) stddev-sans-first:101141.40 05:01:42 INFO - PROCESS | 7405 | Values: 444.7 451.9 456.8 464.8 481.7 19435.7 21185.4 21197.0 21270.8 21473.6 21610.1 22378.8 22412.8 22490.0 22603.9 6587.7 6875.1 6878.3 7095.9 7259.4 7052.3 7313.4 7400.5 7422.0 7425.4 7423.8 7448.6 7448.9 7455.2 7515.8 7270.7 7415.9 7442.9 7450.3 7505.3 7088.7 7231.7 7242.7 7275.7 7403.2 25107.7 25426.0 25548.2 25608.0 25806.9 3014.7 3030.9 3052.0 3095.7 3141.1 14746.4 15914.4 16412.4 16460.7 16659.6 2177.7 2200.9 2208.9 2257.1 2259.6 114114.4 117063.0 117390.0 117482.0 119328.4 17779.3 17921.0 17924.1 18031.1 18308.5 31802.5 31848.7 31866.0 31873.8 31893.8 9985.4 10032.5 10054.5 10103.9 10292.8 8433.5 8506.9 8532.8 8692.4 8702.2 8967.6 9177.3 9287.2 9342.3 9401.9 3550.9 3655.8 3770.8 3856.2 3931.7 963.9 967.2 973.3 978.3 979.8 20808.2 20840.9 20855.4 21073.4 21085.3 963.8 973.6 977.6 987.9 1007.3 10881.2 11573.4 11594.0 11762.2 11825.0 598001.0 600324.0 612628.0 614884.0 633973.0 78148.0 79154.6 84229.0 113555.0 116444.4 1179.4 1224.2 1283.5 1289.2 1291.3 18708.5 18892.0 19125.4 19143.0 19158.0 49985.8 50628.7 51031.5 51551.7 51625.0 67425.0 67955.0 68437.0 68674.0 68743.7 11125.0 11187.0 11229.4 11332.3 11376.8 12848.7 13078.7 13209.3 13225.3 13435.5 11351.8 11552.2 11581.8 11632.7 11761.3 10266.6 10343.2 10371.7 10405.6 10454.4 11605.1 11929.6 12001.0 12004.4 12174.6 11439.1 11567.5 11629.7 11764.8 11849.0 11257.9 11280.3 11390.9 11614.9 11664.9 05:01:42 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | [#3] mootools.html Cycles:180 Average:7320.06 Median:2450.02 stddev:4760.05 (194.3%) stddev-sans-first:4753.94 05:01:42 INFO - PROCESS | 7405 | Values: 1590.8 1593.5 1604.7 1612.9 1619.3 10976.3 11873.4 11875.5 11881.3 11883.3 11235.6 11639.7 11981.0 12006.5 12008.1 2511.9 2552.1 2556.3 2557.7 2557.8 2431.2 2502.4 2549.2 2549.5 2549.8 2437.3 2480.4 2524.6 2537.8 2538.5 2359.0 2429.1 2437.0 2462.7 2473.7 2253.0 2254.3 2284.5 2285.9 2299.7 11696.6 11900.3 11916.4 11923.9 11924.2 5688.5 5805.3 5817.2 5820.4 5821.3 3442.4 3470.8 3529.2 3563.7 3593.7 1357.8 1377.7 1405.9 1411.5 1436.2 17177.8 17192.6 17746.9 18534.3 18643.9 4780.4 4834.7 4858.3 4863.7 4957.6 13675.2 13676.2 13692.0 13696.2 13705.5 5789.8 5805.7 5844.1 5856.3 5860.9 5122.6 5199.5 5341.1 5387.6 5390.2 3959.4 4046.6 4065.1 4081.4 4132.3 1037.0 1045.0 1054.3 1061.4 1064.7 1060.6 1077.3 1078.9 1080.2 1091.7 7391.5 7468.2 7504.0 7574.9 7640.3 994.9 1004.6 1063.5 1066.2 1081.6 4404.3 4558.4 4605.5 4644.9 4656.7 14402.8 14912.4 14995.3 15700.5 15704.1 12597.4 15322.5 15441.3 15559.1 15572.2 9457.8 10643.3 10774.8 10810.1 11182.3 6889.3 7208.2 7381.7 7431.4 7530.6 13136.3 13539.8 13597.9 13835.4 13845.2 12828.1 13100.4 14099.9 14123.1 14190.5 9799.2 9980.0 10105.9 10226.6 10366.7 11374.1 11573.1 11615.2 11657.0 11704.2 9243.5 9246.6 9347.2 9392.3 9413.1 9034.7 9040.0 9063.0 9174.0 9230.6 8329.8 8442.4 8771.1 8771.9 8773.0 6044.6 6059.6 6153.2 6177.0 6267.7 6584.9 6690.9 6693.3 6723.0 6838.8 05:01:42 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | [#4] prototype.html Cycles:180 Average:4839.85 Median:5349.86 stddev:1263.31 (23.6%) stddev-sans-first:1222.36 05:01:42 INFO - PROCESS | 7405 | Values: 412.0 418.6 432.8 438.4 441.9 5163.2 5210.3 5240.7 5262.9 5276.9 5044.9 5101.8 5108.5 5175.5 5230.5 4327.2 4333.2 4340.7 4344.3 4345.8 4341.0 4346.6 4375.2 4381.6 4392.2 4227.5 4281.3 4317.1 4332.5 4343.4 4265.8 4267.7 4307.6 4309.7 4310.2 4051.8 4052.7 4061.5 4070.5 4084.2 4924.8 5046.0 5065.4 5080.9 5134.0 5295.9 5302.0 5305.6 5348.7 5350.2 5473.0 5496.4 5589.2 5599.0 5613.9 4745.7 4805.4 4809.6 4889.0 4907.4 5520.9 5601.7 5659.4 5781.4 5787.4 4993.9 4997.9 5024.0 5024.7 5025.7 4839.2 4963.7 4979.5 5113.4 5131.9 5210.7 5215.0 5242.9 5249.5 5267.2 5469.3 5498.1 5530.7 5536.6 5549.4 1720.7 1747.1 1755.4 1767.8 1768.6 1394.8 1434.7 1457.3 1460.0 1462.9 5372.5 5376.8 5424.8 5447.2 5458.9 5359.0 5610.6 5615.3 5650.7 5665.0 5365.3 5414.3 5470.3 5489.5 5493.4 2915.3 2943.6 2950.3 2964.5 2965.7 5509.8 5659.5 5776.3 5824.1 5844.6 5698.6 5735.7 5738.4 5762.3 5771.5 5662.2 5794.7 5807.8 5825.3 5848.5 5564.3 5607.0 5621.6 5637.9 5675.2 5293.5 5349.5 5377.3 5424.7 5471.4 5787.9 5823.9 5831.3 5843.9 5860.2 4448.6 4714.5 4951.5 4962.5 5014.4 5585.7 5616.7 5643.4 5646.9 5690.7 5540.4 5547.4 5552.8 5638.9 5704.7 5368.8 5534.7 5581.7 5593.9 5626.6 5517.7 5565.5 5566.6 5574.3 5576.7 5396.6 5630.0 5649.4 5664.0 5666.0 5422.0 5445.9 5446.5 5483.3 5486.2 05:01:42 INFO - PROCESS | 7405 | 05:01:42 INFO - PROCESS | 7405 | [#5] yui.html Cycles:180 Average:18380.54 Median:42648.89 stddev:23043.61 (54.0%) stddev-sans-first:23070.49 05:01:42 INFO - PROCESS | 7405 | Values: 810.9 836.9 890.8 924.1 931.3 15341.8 16300.8 16302.3 16323.2 16327.2 14950.4 16644.1 16741.8 16892.2 16913.3 883.7 898.7 909.6 909.6 910.2 894.7 895.1 895.5 896.5 897.7 934.4 937.6 937.7 938.1 938.9 928.2 931.0 931.5 933.5 933.6 682.3 683.2 685.0 685.1 686.0 14863.0 14928.4 15327.7 15704.5 15866.3 13454.8 13537.3 14306.9 14337.2 14356.9 12731.8 12802.9 12813.7 12972.6 12983.3 4050.3 4053.7 4055.1 4122.3 4205.5 81445.6 81932.0 82852.6 83198.6 83537.2 10655.1 10875.3 10953.0 10989.6 11040.7 20873.0 22525.2 22548.2 22572.7 22710.1 9260.1 9328.3 9354.7 9360.2 9514.0 5041.7 5108.7 5156.3 5162.8 5292.6 3551.6 3658.9 3664.7 3666.0 3674.7 587.9 593.4 598.2 599.7 602.1 850.6 872.5 883.4 894.5 896.8 11423.8 11802.4 12169.2 12561.9 12562.9 847.5 850.7 864.1 871.2 871.3 5460.5 5534.6 5551.8 5577.9 5605.6 82552.6 84762.0 85197.6 86055.0 88050.6 58929.4 65303.0 71265.0 71544.3 73981.6 65467.7 66179.3 66698.7 66917.3 67595.7 10527.9 10601.9 10611.9 10662.9 10806.8 42401.8 42896.0 43130.4 43878.1 44232.8 48446.0 48641.3 48760.8 49785.0 51235.7 12727.8 12731.5 12961.2 13063.6 13095.7 15109.3 15148.9 15167.6 15258.7 15284.2 14441.7 14615.6 14656.6 14658.4 15697.5 14566.3 14580.0 14889.8 15808.6 17912.8 15536.0 15541.5 16352.9 16861.9 17069.8 11543.8 11550.9 11671.8 12074.4 12421.6 12542.7 13771.6 13913.9 14170.1 14178.0 05:01:42 INFO - PROCESS | 7405 | -------- Summary: end -------- 05:01:42 INFO - PROCESS | 7405 | 05:01:43 INFO - TEST-INFO | 7405: exit 0 05:01:43 INFO - TEST-OK | dromaeo_css | took 1115279ms 05:01:43 INFO - TEST-START | kraken 05:01:43 INFO - operating with platform_type : linux_ 05:01:43 INFO - Initialising browser for kraken test... 05:01:43 INFO - TEST-INFO | started process 7726 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBBgrOK/profile http://localhost:38670/getInfo.html) 05:01:47 INFO - PROCESS | 7726 | __metrics Screen width/height:1600/1200 05:01:47 INFO - PROCESS | 7726 | colorDepth:24 05:01:47 INFO - PROCESS | 7726 | Browser inner width/height: 1024/697 05:01:47 INFO - PROCESS | 7726 | __metrics 05:01:48 INFO - PROCESS | 7726 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 05:01:48 INFO - PROCESS | 7726 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:01:49 INFO - TEST-INFO | 7726: exit 0 05:01:49 INFO - Browser initialized. 05:01:49 INFO - Running cycle 1/1 for kraken test... 05:01:49 INFO - TEST-INFO | started process 7817 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBBgrOK/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:02:01 INFO - PROCESS | 7817 | RSS: Main: 140128256 05:02:01 INFO - PROCESS | 7817 | 05:02:03 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38670/tests/kraken/driver.html?testName=audio-beat-detection) 05:02:04 INFO - PROCESS | 7817 | RSS: Main: 183185408 05:02:04 INFO - PROCESS | 7817 | 05:02:07 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38670/tests/kraken/driver.html?testName=audio-dft) 05:02:07 INFO - PROCESS | 7817 | RSS: Main: 174018560 05:02:07 INFO - PROCESS | 7817 | 05:02:10 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38670/tests/kraken/driver.html?testName=audio-fft) 05:02:11 INFO - PROCESS | 7817 | RSS: Main: 265510912 05:02:11 INFO - PROCESS | 7817 | 05:02:13 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38670/tests/kraken/driver.html?testName=audio-oscillator) 05:02:13 INFO - PROCESS | 7817 | RSS: Main: 171765760 05:02:13 INFO - PROCESS | 7817 | 05:02:16 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38670/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:02:16 INFO - PROCESS | 7817 | RSS: Main: 174391296 05:02:16 INFO - PROCESS | 7817 | 05:02:19 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38670/tests/kraken/driver.html?testName=imaging-darkroom) 05:02:20 INFO - PROCESS | 7817 | RSS: Main: 212762624 05:02:20 INFO - PROCESS | 7817 | 05:02:23 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38670/tests/kraken/driver.html?testName=imaging-desaturate) 05:02:24 INFO - PROCESS | 7817 | RSS: Main: 211632128 05:02:24 INFO - PROCESS | 7817 | 05:02:26 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38670/tests/kraken/driver.html?testName=json-parse-financial) 05:02:27 INFO - PROCESS | 7817 | RSS: Main: 211054592 05:02:27 INFO - PROCESS | 7817 | 05:02:29 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38670/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:02:29 INFO - PROCESS | 7817 | RSS: Main: 173223936 05:02:29 INFO - PROCESS | 7817 | 05:02:31 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38670/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:02:31 INFO - PROCESS | 7817 | RSS: Main: 179699712 05:02:31 INFO - PROCESS | 7817 | 05:02:33 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38670/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:02:34 INFO - PROCESS | 7817 | RSS: Main: 189403136 05:02:34 INFO - PROCESS | 7817 | 05:02:37 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38670/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:02:37 INFO - PROCESS | 7817 | RSS: Main: 198316032 05:02:37 INFO - PROCESS | 7817 | 05:02:40 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38670/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:02:41 INFO - PROCESS | 7817 | RSS: Main: 195170304 05:02:41 INFO - PROCESS | 7817 | 05:02:42 INFO - PROCESS | 7817 | Cycle 1(1): loaded http://localhost:38670/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38670/tests/kraken/driver.html?testName=ai-astar) 05:02:42 INFO - PROCESS | 7817 | RSS: Main: 245743616 05:02:42 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | __start_tp_report 05:02:43 INFO - PROCESS | 7817 | _x_x_mozilla_page_load 05:02:43 INFO - PROCESS | 7817 | _x_x_mozilla_page_load_details 05:02:43 INFO - PROCESS | 7817 | |i|pagename|runs| 05:02:43 INFO - PROCESS | 7817 | |0;ai-astar;109;114;115;112;115;112;112;113;112;112 05:02:43 INFO - PROCESS | 7817 | |1;audio-beat-detection;144;116;115;141;116;121;116;113;136;116 05:02:43 INFO - PROCESS | 7817 | |2;audio-dft;160;161;165;162;161;161;160;161;160;160 05:02:43 INFO - PROCESS | 7817 | |3;audio-fft;77;76;75;114;75;76;75;75;89;77 05:02:43 INFO - PROCESS | 7817 | |4;audio-oscillator;81;80;108;81;80;81;104;83;82;113 05:02:43 INFO - PROCESS | 7817 | |5;imaging-gaussian-blur;114;113;114;113;113;113;113;113;113;113 05:02:43 INFO - PROCESS | 7817 | |6;imaging-darkroom;147;146;146;146;148;146;146;147;147;147 05:02:43 INFO - PROCESS | 7817 | |7;imaging-desaturate;95;97;94;94;94;94;94;94;94;93 05:02:43 INFO - PROCESS | 7817 | |8;json-parse-financial;55;54;55;54;53;55;54;55;55;54 05:02:43 INFO - PROCESS | 7817 | |9;json-stringify-tinderbox;52;53;52;51;52;52;52;52;52;53 05:02:43 INFO - PROCESS | 7817 | |10;stanford-crypto-aes;81;80;79;82;79;77;79;87;77;81 05:02:43 INFO - PROCESS | 7817 | |11;stanford-crypto-ccm;127;122;134;119;119;119;118;119;161;139 05:02:43 INFO - PROCESS | 7817 | |12;stanford-crypto-pbkdf2;155;161;161;159;158;159;163;162;159;161 05:02:43 INFO - PROCESS | 7817 | |13;stanford-crypto-sha256-iterative;67;60;60;65;60;60;60;60;59;59 05:02:43 INFO - PROCESS | 7817 | __end_tp_report 05:02:43 INFO - PROCESS | 7817 | __start_cc_report 05:02:43 INFO - PROCESS | 7817 | _x_x_mozilla_cycle_collect,1706 05:02:43 INFO - PROCESS | 7817 | __end_cc_report 05:02:43 INFO - PROCESS | 7817 | __startTimestamp1490616162999__endTimestamp 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | ------- Summary: start ------- 05:02:43 INFO - PROCESS | 7817 | Number of tests: 14 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#0] ai-astar Cycles:10 Average:112.60 Median:112.50 stddev:1.78 (1.6%) stddev-sans-first:1.32 05:02:43 INFO - PROCESS | 7817 | Values: 109.0 114.0 115.0 112.0 115.0 112.0 112.0 113.0 112.0 112.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#1] audio-beat-detection Cycles:10 Average:123.40 Median:118.50 stddev:12.00 (10.1%) stddev-sans-first:10.15 05:02:43 INFO - PROCESS | 7817 | Values: 144.0 116.0 115.0 141.0 116.0 121.0 116.0 113.0 136.0 116.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#2] audio-dft Cycles:10 Average:161.10 Median:161.00 stddev:1.52 (0.9%) stddev-sans-first:1.56 05:02:43 INFO - PROCESS | 7817 | Values: 160.0 161.0 165.0 162.0 161.0 161.0 160.0 161.0 160.0 160.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#3] audio-fft Cycles:10 Average:80.90 Median:76.00 stddev:12.38 (16.3%) stddev-sans-first:13.05 05:02:43 INFO - PROCESS | 7817 | Values: 77.0 76.0 75.0 114.0 75.0 76.0 75.0 75.0 89.0 77.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#4] audio-oscillator Cycles:10 Average:89.30 Median:81.00 stddev:13.33 (16.5%) stddev-sans-first:13.80 05:02:43 INFO - PROCESS | 7817 | Values: 81.0 80.0 108.0 81.0 80.0 81.0 104.0 83.0 82.0 113.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#5] imaging-gaussian-blur Cycles:10 Average:113.20 Median:113.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 05:02:43 INFO - PROCESS | 7817 | Values: 114.0 113.0 114.0 113.0 113.0 113.0 113.0 113.0 113.0 113.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#6] imaging-darkroom Cycles:10 Average:146.60 Median:147.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 05:02:43 INFO - PROCESS | 7817 | Values: 147.0 146.0 146.0 146.0 148.0 146.0 146.0 147.0 147.0 147.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#7] imaging-desaturate Cycles:10 Average:94.30 Median:94.00 stddev:1.06 (1.1%) stddev-sans-first:1.09 05:02:43 INFO - PROCESS | 7817 | Values: 95.0 97.0 94.0 94.0 94.0 94.0 94.0 94.0 94.0 93.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#8] json-parse-financial Cycles:10 Average:54.40 Median:55.00 stddev:0.70 (1.3%) stddev-sans-first:0.71 05:02:43 INFO - PROCESS | 7817 | Values: 55.0 54.0 55.0 54.0 53.0 55.0 54.0 55.0 55.0 54.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#9] json-stringify-tinderbox Cycles:10 Average:52.10 Median:52.00 stddev:0.57 (1.1%) stddev-sans-first:0.60 05:02:43 INFO - PROCESS | 7817 | Values: 52.0 53.0 52.0 51.0 52.0 52.0 52.0 52.0 52.0 53.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#10] stanford-crypto-aes Cycles:10 Average:80.20 Median:80.50 stddev:2.90 (3.6%) stddev-sans-first:3.06 05:02:43 INFO - PROCESS | 7817 | Values: 81.0 80.0 79.0 82.0 79.0 77.0 79.0 87.0 77.0 81.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#11] stanford-crypto-ccm Cycles:10 Average:127.70 Median:124.50 stddev:13.77 (11.1%) stddev-sans-first:14.60 05:02:43 INFO - PROCESS | 7817 | Values: 127.0 122.0 134.0 119.0 119.0 119.0 118.0 119.0 161.0 139.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:159.80 Median:161.00 stddev:2.30 (1.4%) stddev-sans-first:1.66 05:02:43 INFO - PROCESS | 7817 | Values: 155.0 161.0 161.0 159.0 158.0 159.0 163.0 162.0 159.0 161.0 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - PROCESS | 7817 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:61.00 Median:60.00 stddev:2.71 (4.5%) stddev-sans-first:1.80 05:02:43 INFO - PROCESS | 7817 | Values: 67.0 60.0 60.0 65.0 60.0 60.0 60.0 60.0 59.0 59.0 05:02:43 INFO - PROCESS | 7817 | -------- Summary: end -------- 05:02:43 INFO - PROCESS | 7817 | 05:02:43 INFO - TEST-INFO | 7817: exit 0 05:02:44 INFO - TEST-OK | kraken | took 60216ms 05:02:44 INFO - SUITE-END | took 1175s 05:02:44 INFO - Completed test suite (00:19:35) 05:02:44 INFO - javascript benchmark 05:02:44 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7806.1388855884725, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3345.5985281766193, 3363.24327026419, 3381.1209085637743, 3414.30006848596, 3423.8288085595714, 5717.599768016241, 5762.9135562966485, 5774.0, 5783.277090363699, 5810.01229790936, 5721.456461636138, 5781.219535362725, 5788.507976821975, 5789.131630255464, 5790.160426738121, 5128.615353848458, 5144.511271429227, 5179.559737422323, 5182.0, 5215.582753379739, 4950.207966725325, 5213.687178769286, 5227.372715274172, 5238.4499627539135, 5254.789808407659, 5022.0, 5042.974785126069, 5067.163917953533, 5087.389513258396, 5152.768125434346, 5157.664751791141, 5185.766640501187, 5197.272381866561, 5198.610104242159, 5202.06362854686, 5063.063333283318, 5105.285260063594, 5161.690298582097, 5161.767720452589, 5196.376434827845, 5405.405405405402, 5460.262864513319, 5577.3028371453565, 5596.944030559683, 5697.4587414195585, 6126.090206827809, 6129.920395826272, 6130.141780150782, 6131.386861313833, 6133.16299541884, 6173.876522469525, 6210.130581718563, 6211.689415529206, 6212.068189771525, 6212.316645169028, 5470.2888624478965, 5486.478784515504, 5697.971510142505, 5718.1708652246025, 5787.160861675034, 6278.058291256348, 6293.622382657055, 6301.338359472281, 6309.274433440213, 6311.116443697886, 5968.104784282305, 6050.48570871472, 6062.575619706578, 6068.029115341524, 6076.908846367308, 5873.706314684248, 5907.0, 6056.212692350055, 6162.168107305456, 6167.198264225622, 6163.476104531165, 6163.7842675506145, 6166.044263139221, 6169.259688837368, 6177.81466556004, 5716.256886604715, 5745.683987380734, 5763.250777398911, 6104.267487901391, 6111.491261806163, 4186.162767446523, 4187.623113919762, 4191.7275377100395, 4210.368444733253, 4245.23585754561, 3759.9248015039548, 3787.9242415151543, 3790.0, 3817.8472861085247, 3835.67396771272, 5832.94167058324, 5859.150423188614, 5887.293524776968, 5971.611845230046, 5994.910076348771, 6098.69506524672, 6137.0, 6141.692915354214, 6145.539084568586, 6179.876402471926, 5710.486056254874, 5938.61399009063, 5955.404459554096, 5968.76124954997, 5972.462478376967, 5115.923261151086, 5120.667156634807, 5120.92318615221, 5125.69245845243, 5133.307003554472, 6237.033259844731, 6244.781432649836, 6247.9062814057825, 6357.936420635734, 6388.616682999035, 6103.438803286574, 6145.324014358506, 6163.445289923929, 6163.660998645118, 6188.257409110935, 6438.163038804925, 6479.963205887036, 6511.934880651323, 6513.381228783258, 6517.837054073497, 5756.798512052058, 5795.652260864362, 6012.549058820518, 6117.908231376444, 6124.693765311627, 6166.0, 6167.475764560063, 6175.752969881154, 6177.413145751147, 6182.103594978793, 5981.910271345846, 6018.951685147193, 6021.277446706424, 6031.577789554689, 6033.245844269466, 5730.3410107838135, 5795.043817770021, 6004.099385092271, 6011.7595296187665, 6019.247594050744, 5921.911171332347, 5939.673317967553, 6014.609050411709, 6032.758689652364, 6050.273967123973, 5806.970965145148, 5808.36108028125, 5811.4188581143235, 5978.611390259619, 6064.151018857452, 5883.058710606282, 5892.1161825726485, 5941.970290148522, 5956.076808094752, 5963.493103086113], "value": 5599.813637339862, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [830.4726498673342, 884.1335491218607, 895.1361935732021, 898.8471959766839, 964.0407794244727, 38199.427008594896, 39105.21789564207, 42823.57176428235, 42837.357439638356, 42837.78581107098, 38588.0, 38977.41533876987, 39047.21905561887, 39060.414093788546, 39245.21509569807, 7613.809654758647, 7641.465097443182, 7736.883946740803, 7742.458027938046, 7789.805254868617, 10417.0, 10623.681289561326, 10626.0, 10641.73395665107, 10644.893551064506, 10820.350778953249, 10836.620718274862, 10838.783224335508, 10853.077488413493, 10857.45712714365, 10725.892741072606, 10762.677119686383, 10765.0, 10770.569177232901, 10782.946085269523, 10485.528151233213, 10527.157827373869, 10546.156307495383, 10546.472676366151, 10549.47252637365, 42017.0, 42026.0, 42286.0, 42334.57665423337, 42420.78789606032, 4164.190340346299, 4194.496660400771, 4244.575542445762, 4311.439512863308, 4322.913541729179, 29796.553051704243, 29976.250593735112, 30117.247068823453, 30250.0, 31622.683773162204, 3851.326017946876, 3940.2513522430645, 3957.742746721454, 3961.5840336764513, 4045.9190816183514, 223251.0, 226247.8687606568, 227235.0, 227470.0, 227581.0, 43744.343834842504, 44536.3319550207, 47290.0, 51386.48613513892, 51410.48589514132, 54207.45792542103, 54260.45739542554, 54378.45621543813, 54434.72782636061, 54455.455445445834, 15910.840891590937, 16034.518964431085, 16045.358185672676, 16049.919750401174, 16050.197490125447, 13946.442142314396, 13976.580702578938, 13984.930075349557, 13992.650183745487, 13996.930015349859, 13715.177089374669, 13991.0, 13997.230152341719, 14036.368363423671, 14120.43518259258, 5637.267155269788, 5656.688882111441, 5663.773449062074, 5679.403662615448, 5750.367459579443, 1000.8949060348705, 1011.7268337548968, 1012.1245122968726, 1016.3749294184172, 1022.5500779656927, 28002.85998570035, 28169.43661126766, 28172.0, 28186.85906570454, 28609.85695071553, 1077.849101125843, 1080.68660088575, 1089.5097206257217, 1106.4854842498278, 1119.6696974392573, 14583.92708036453, 14855.777163342558, 14959.326830292663, 15253.16107614092, 15258.542243732705, 270472.0, 271181.0, 271370.0, 272131.0, 272343.0, 54719.72640136774, 54831.45168548343, 54870.72564637151, 54936.72531637396, 54981.0, 1490.694407646408, 1495.835458099608, 1549.2253873063469, 1551.697419003306, 1551.9689606207812, 25601.743982559936, 26678.866605666848, 26894.193174204804, 27099.72900270972, 27131.1860644181, 42497.57502424936, 42547.36178957256, 42580.78709606432, 42592.0, 42595.787021064694, 259862.0, 262008.0, 262943.0, 263135.0, 263627.0, 29650.0, 30046.399072018, 33921.830390847885, 34896.30207395888, 35020.64979350174, 42942.57057429386, 43078.56921430871, 43280.0, 43753.0, 44170.55829441793, 33936.83031584826, 34077.65922340745, 34138.82930585331, 34172.48741268833, 34206.82896585601, 33105.83447082749, 33143.33713325768, 33313.333733325686, 33379.83310083434, 33407.49888751719, 35273.47089793604, 36437.817810910776, 38784.0, 38905.6109438902, 39259.60740392674, 29790.0, 29953.251168720955, 30091.69908300889, 30235.244118897204, 30382.54426183653, 23791.405214869766, 24877.751222487543, 24889.62665559982, 24932.501349972536, 25336.74663253344], "value": 18559.97575906995, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [444.6976056281727, 451.8599234237387, 456.7510706664865, 464.8047819915635, 481.7302310706004, 19435.708464373027, 21185.364439066852, 21197.0, 21270.787292127075, 21473.57052858942, 21610.135594576197, 22378.776212237874, 22412.775872241273, 22490.0, 22603.886980565076, 6587.7035533400995, 6875.106236189288, 6878.312168783106, 7095.858082838366, 7259.382952449048, 7052.294770522958, 7313.414926805869, 7400.518966267202, 7422.0, 7425.368843648296, 7423.777286681408, 7448.553086814782, 7448.888266676005, 7455.179930207672, 7515.812104697372, 7270.745523906664, 7415.851682966338, 7442.851142977164, 7450.254974502561, 7505.286997735207, 7088.716451341992, 7231.710731570731, 7242.674079666428, 7275.745348912816, 7403.185649578542, 25107.748922510906, 25426.0, 25548.23355299344, 25608.0, 25806.870965645052, 3014.668386477486, 3030.863611137504, 3051.9542206866913, 3095.7368623667016, 3141.1361875484195, 14746.410143594243, 15914.363425462967, 16412.425565105164, 16460.67078658432, 16659.583510412336, 2177.6733489976473, 2200.8899555022185, 2208.933731988027, 2257.142285931352, 2259.6271615183473, 114114.42942785316, 117062.99999999914, 117390.0, 117482.0, 119328.40335798352, 17779.28882844672, 17921.0, 17924.103794810206, 18031.098445077692, 18308.542286442946, 31802.522962155585, 31848.681513185034, 31866.0, 31873.84063079716, 31893.8405307972, 9985.400875947467, 10032.498375081217, 10054.547545360476, 10103.898961010296, 10292.845607315896, 8433.493990360597, 8506.872396914052, 8532.829343413097, 8692.391532592657, 8702.173293537104, 8967.551622418852, 9177.311701622404, 9287.210587100037, 9342.299327550461, 9401.905980940102, 3550.857965681344, 3655.8484077515495, 3770.849166033383, 3856.2094770571966, 3931.724779265424, 963.942163470194, 967.1730670276953, 973.2722925582995, 978.280963491833, 979.8432250839832, 20808.167673292897, 20840.895795520926, 20855.37433876986, 21073.367798966057, 21085.262015829678, 963.7735132243918, 973.6105557776946, 977.6187286958092, 987.9308448408542, 1007.2747621712356, 10881.183911206692, 11573.42132893352, 11594.0, 11762.176647634584, 11825.0, 598001.0, 600324.0, 612628.0, 614884.0, 633973.0, 78148.0, 79154.6042269785, 84229.0, 113555.0, 116444.41777791057, 1179.3572502985894, 1224.1675660550734, 1283.5250957145915, 1289.2264641215384, 1291.3349624943162, 18708.532286692396, 18892.0, 19125.426237212905, 19143.0, 19158.0, 49985.75007124941, 50628.74685626548, 51031.489685104156, 51551.74224128856, 51625.0, 67425.0, 67955.0, 68437.0, 68674.0, 68743.65628171827, 11125.0, 11187.0, 11229.38238396896, 11332.263402878787, 11376.829347559627, 12848.678783030498, 13078.673033173865, 13209.339533023503, 13225.338733063116, 13435.462581496631, 11351.829722554003, 11552.249103808226, 11581.768364632828, 11632.709182270173, 11761.294322340345, 10266.6406675766, 10343.224258180817, 10371.688849334532, 10405.63580274717, 10454.42500662471, 11605.129615279056, 11929.642110736344, 12001.0, 12004.39978001114, 12174.57388991381, 11439.14206434504, 11567.537298507965, 11629.709257268298, 11764.764704705687, 11849.0, 11257.887421125684, 11280.32318060919, 11390.943045285052, 11614.883851161718, 11664.88335116672], "value": 11281.513551711969, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1590.8170560385558, 1593.545839435761, 1604.7111519926411, 1612.8870979031472, 1619.3279788887608, 10976.341419514834, 11873.406329683525, 11875.465604047828, 11881.287122772628, 11883.346415947119, 11235.606753763619, 11639.709007274821, 11981.0, 12006.45970931308, 12008.099392545571, 2511.949761004779, 2552.094006627639, 2556.309796354983, 2557.7058638256653, 2557.846529208244, 2431.1977047574346, 2502.4244423782543, 2549.222487141421, 2549.528337257613, 2549.8087643426725, 2437.305367970129, 2480.3923038855505, 2524.5708229601014, 2537.7716005559496, 2538.4669219463935, 2358.96461553076, 2429.0648100481353, 2437.0373702387546, 2462.7414121517163, 2473.7402572729784, 2252.9549409011893, 2254.3462395905167, 2284.520250747345, 2285.851419657717, 2299.7355304139905, 11696.649100526998, 11900.285982841056, 11916.404179790976, 11923.880761192364, 11924.165308428413, 5688.459596338383, 5805.303363596396, 5817.156512305692, 5820.388859169769, 5821.330546987108, 3442.3803715331233, 3470.7570470067108, 3529.170644898447, 3563.6614521620404, 3593.7125029997537, 1357.8234829472203, 1377.7313423882347, 1405.9015868889182, 1411.4777532313008, 1436.2029073864, 17177.82822171787, 17192.57018574533, 17746.91126544372, 18534.258629654796, 18643.90678046601, 4780.402449693788, 4834.71879951813, 4858.319835223072, 4863.659543831968, 4957.603391728653, 13675.179489230479, 13676.247806370746, 13692.041557090908, 13696.178229306273, 13705.520306789214, 5789.8263052108505, 5805.7387417566315, 5844.12338149281, 5856.267966504187, 5860.853478663067, 5122.644667742635, 5199.532042116228, 5341.145416733304, 5387.568994480433, 5390.164524498709, 3959.366501359826, 4046.5548789633117, 4065.065035041957, 4081.387791831249, 4132.33882578786, 1037.0, 1044.9895501045044, 1054.2567489919588, 1061.3578784835217, 1064.7178497698117, 1060.570468960057, 1077.256692881909, 1078.8813230544633, 1080.2330345454816, 1091.683411810566, 7391.519551229153, 7468.1672472485425, 7504.0, 7574.886376704354, 7640.274173953466, 994.9154321882577, 1004.5579944824254, 1063.473580577619, 1066.2429674930731, 1081.561967403203, 4404.317330813729, 4558.407407037131, 4605.516420775837, 4644.907101857944, 4656.697314674603, 14402.783958240634, 14912.403503859725, 14995.250237488082, 15700.528984130495, 15704.136272504893, 12597.433115509824, 15322.463713769965, 15441.30514126867, 15559.144247066293, 15572.221388930735, 9457.76355591102, 10643.254972151875, 10774.78450430987, 10810.081143102925, 11182.32906025641, 6889.314400815577, 7208.243134470805, 7381.704731810667, 7431.3683336916965, 7530.623468826428, 13136.27750473733, 13539.79690304666, 13597.932010339884, 13835.446582136601, 13845.23851188154, 12828.10203285761, 13100.410481528164, 14099.929500352433, 14123.081999669988, 14190.503332383318, 9799.216062714822, 9980.0, 10105.898941010495, 10226.59093636276, 10366.688999330032, 11374.090072794323, 11573.13201509907, 11615.245009074382, 11657.0, 11704.239224450383, 9243.537823108953, 9246.630134794534, 9347.205487533363, 9392.342536022687, 9413.105754953542, 9034.683786067457, 9039.95480022622, 9063.0, 9173.954130229306, 9230.584623692084, 8329.750107496784, 8442.366822488215, 8771.122887711434, 8771.91228087711, 8773.034966153591, 6044.637321760709, 6059.575829692056, 6153.169322141453, 6177.0, 6267.749290028348, 6584.901226481702, 6690.933090669226, 6693.2972037935315, 6722.9663851680425, 6838.794836154923], "value": 5502.747279305472, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [411.9794010299484, 418.64206103781265, 432.7879339123828, 438.4081489988516, 441.856396671082, 5163.218689552104, 5210.296609957664, 5240.711760853156, 5262.868428289295, 5276.868078298045, 5044.899102017957, 5101.821436249732, 5108.540231379176, 5175.534201921826, 5230.450802665722, 4327.17783621111, 4333.2416827055295, 4340.696151269412, 4344.348347747848, 4345.848350187203, 4340.958170039199, 4346.587074227959, 4375.212461756899, 4381.627561657263, 4392.155294776202, 4227.471566054243, 4281.314989601664, 4317.122051907415, 4332.480102387718, 4343.435353404053, 4265.786710664454, 4267.658587313008, 4307.612314891675, 4309.6983211175075, 4310.181065597527, 4051.7974101294817, 4052.6555242804397, 4061.4720086388875, 4070.514262294271, 4084.1627466369323, 4924.80300787968, 5046.0, 5065.442801291855, 5080.949190508085, 5134.0, 5295.920561191585, 5302.0, 5305.628605997582, 5348.71630808607, 5350.197470379435, 5473.0, 5496.422875598045, 5589.217509548666, 5599.0, 5613.887722245573, 4745.742789556423, 4805.399325084364, 4809.639277054235, 4889.046635906, 4907.411110666707, 5520.944790552083, 5601.719914004283, 5659.4340565943485, 5781.427264867136, 5787.363390027093, 4993.90012199754, 4997.925446029121, 5023.974880125576, 5024.748762561857, 5025.673331233458, 4839.153148199051, 4963.677360971526, 4979.4771548987555, 5113.386393632788, 5131.87170320745, 5210.739463026834, 5214.97392513035, 5242.895142097137, 5249.501297376743, 5267.157254839208, 5469.288992431038, 5498.147787093007, 5530.723463826793, 5536.622660177289, 5549.418415751572, 1720.7418887166775, 1747.1391584481253, 1755.447034184228, 1767.770189875308, 1768.593223558563, 1394.7838085096826, 1434.6800943132343, 1457.3150619208955, 1459.9854001460062, 1462.9487967921284, 5372.462753724674, 5376.758045887945, 5424.755885985141, 5447.155690867922, 5458.935507576064, 5359.0, 5610.579206559524, 5615.326160860641, 5650.717464126859, 5665.0, 5365.3293338332705, 5414.29614150158, 5470.261514695465, 5489.505944464938, 5493.423190565013, 2915.329474220941, 2943.617329747119, 2950.3214260720156, 2964.4663960486887, 2965.7330840224054, 5509.779608815603, 5659.462835727671, 5776.3068431787615, 5824.126381042877, 5844.568080820226, 5698.601097923106, 5735.713214339266, 5738.368779434259, 5762.337331206881, 5771.509421699203, 5662.150677398341, 5794.725160464691, 5807.751333463326, 5825.300963884361, 5848.5028772553105, 5564.33228012641, 5606.953461986427, 5621.634593751393, 5637.915431268616, 5675.233843431084, 5293.470652934676, 5349.518543331119, 5377.300950876361, 5424.701641409761, 5471.376686699732, 5787.884242315215, 5823.94176058234, 5831.271091113611, 5843.918875008138, 5860.208871802252, 4448.6218671412, 4714.457837348612, 4951.529604687549, 4962.45413004562, 5014.373203349582, 5585.720713964204, 5616.69108199053, 5643.379228284967, 5646.943530564806, 5690.743916523684, 5540.390557038642, 5547.44525547442, 5552.750126244409, 5638.943610564006, 5704.743286552032, 5368.8389348319615, 5534.667919924817, 5581.6930068846605, 5593.944060559343, 5626.606137570331, 5517.675757818175, 5565.499105080562, 5566.636174137362, 5574.303212098488, 5576.665400076008, 5396.595255355785, 5630.014747419267, 5649.350324712711, 5663.9716801415725, 5666.0, 5421.972890135682, 5445.918311225256, 5446.537044351275, 5483.287172667528, 5486.204500347348], "value": 4482.972110810023, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [810.9472884262523, 836.9246767790897, 890.8218356328734, 924.1160466932262, 931.3434029009549, 15341.84658153418, 16300.755488667664, 16302.266398012089, 16323.183840807971, 16327.18364081794, 14950.40198392063, 16644.08457534835, 16741.832581674178, 16892.239849206784, 16913.323467061302, 883.7172104926426, 898.6674930275807, 909.5815924674657, 909.6225066597354, 910.1808372464801, 894.6510860764307, 895.1048951048951, 895.5164211325877, 896.4666023715879, 897.7441429192681, 934.3506263147116, 937.5921474158729, 937.7374335186124, 938.0900526489295, 938.9108034736723, 928.215657769184, 930.9813803723888, 931.501646619059, 933.5285680731188, 933.5705575435308, 682.276786606199, 683.2040672616396, 684.9794506164823, 685.0546246180239, 686.0292685849518, 14863.0, 14928.402863885432, 15327.693446131127, 15704.52886413398, 15866.286017129258, 13454.798178027337, 13537.323133843367, 14306.85693143076, 14337.21145337006, 14356.85643143576, 12731.809022864665, 12802.871971280354, 12813.679658008532, 12972.610821675366, 12983.28591927453, 4050.3316952702767, 4053.655439287664, 4055.1484188320487, 4122.319817230154, 4205.537390887, 81445.59277203576, 81932.0, 82852.58573707093, 83198.58400707958, 83537.16462835415, 10655.094316982988, 10875.347479151118, 10953.0, 10989.560417583207, 11040.668779936615, 20873.0, 22525.211617593304, 22548.21081262148, 22572.66141007886, 22710.091596336293, 9260.120288572574, 9328.253739700944, 9354.672586459441, 9360.204382627417, 9513.952430237805, 5041.722705251246, 5108.744562771846, 5156.303898973591, 5162.845114646567, 5292.629515933848, 3551.6448355164275, 3658.908527286839, 3664.670179683788, 3665.9633403666157, 3674.7243956703355, 587.9088741245114, 593.379917985706, 598.1655590451296, 599.7181324777434, 602.0818252165483, 850.6257246811507, 872.4895935877456, 883.4169448164181, 894.5035505294494, 896.7758060484879, 11423.828642570368, 11802.350870702194, 12169.20900141488, 12561.937190314173, 12562.921869621388, 847.4788005376649, 850.7235148576738, 864.0538610221797, 871.1680345270379, 871.2681347667989, 5460.481254280837, 5534.640248383842, 5551.833444996657, 5577.860553486195, 5605.5515558755205, 82552.58723706462, 84762.0, 85197.57401212954, 86055.0, 88050.55974720085, 58929.41070589325, 65303.0, 71265.0, 71544.28455715481, 73981.63009184919, 65467.67266163734, 66179.33820661732, 66698.66650666716, 66917.3308266911, 67595.66202169056, 10527.94736026315, 10601.946990265307, 10611.946940265248, 10662.90410416345, 10806.837897431387, 42401.78799106108, 42896.0, 43130.35304470373, 43878.12243755171, 44232.7788361069, 48446.0, 48641.270380943606, 48760.75619622021, 49785.0, 51235.74382128065, 12727.809082863949, 12731.490740370651, 12961.15752476086, 13063.608091757262, 13095.738085238052, 15109.32008059618, 15148.924255378653, 15167.620809479851, 15258.694826103638, 15284.15937123469, 14441.711165776836, 14615.634609134857, 14656.633584160481, 14658.413663453342, 15697.450589229322, 14566.34451449666, 14580.0, 14889.776653349993, 15808.60478488047, 17912.820871791115, 15536.0, 15541.533753987398, 16352.918235408746, 16861.91569042147, 17069.82930170732, 11543.826842597537, 11550.88449115498, 11671.824922625998, 12074.39628018613, 12421.627351179479, 12542.686432839251, 13771.586852394445, 13913.930430347784, 14170.14979101216, 14178.0], "value": 7821.980650658591, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1456.6, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 114.0, 115.0, 112.0, 115.0, 112.0, 112.0, 113.0, 112.0, 112.0], "value": 112.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 116.0, 115.0, 141.0, 116.0, 121.0, 116.0, 113.0, 136.0, 116.0], "value": 123.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 161.0, 165.0, 162.0, 161.0, 161.0, 160.0, 161.0, 160.0, 160.0], "value": 161.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 76.0, 75.0, 114.0, 75.0, 76.0, 75.0, 75.0, 89.0, 77.0], "value": 80.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 80.0, 108.0, 81.0, 80.0, 81.0, 104.0, 83.0, 82.0, 113.0], "value": 89.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 113.0, 114.0, 113.0, 113.0, 113.0, 113.0, 113.0, 113.0, 113.0], "value": 113.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 146.0, 146.0, 148.0, 146.0, 146.0, 147.0, 147.0, 147.0], "value": 146.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 97.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 93.0], "value": 94.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 54.0, 55.0, 54.0, 53.0, 55.0, 54.0, 55.0, 55.0, 54.0], "value": 54.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 53.0, 52.0, 51.0, 52.0, 52.0, 52.0, 52.0, 52.0, 53.0], "value": 52.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 80.0, 79.0, 82.0, 79.0, 77.0, 79.0, 87.0, 77.0, 81.0], "value": 80.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [127.0, 122.0, 134.0, 119.0, 119.0, 119.0, 118.0, 119.0, 161.0, 139.0], "value": 127.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 161.0, 161.0, 159.0, 158.0, 159.0, 163.0, 162.0, 159.0, 161.0], "value": 159.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 60.0, 60.0, 65.0, 60.0, 60.0, 60.0, 60.0, 59.0, 59.0], "value": 61.0, "unit": "score"}]}]} 05:02:44 INFO - Return code: 0 05:02:44 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:02:44 ERROR - # TBPL SUCCESS # 05:02:44 INFO - Running post-action listener: _resource_record_post_action 05:02:44 INFO - [mozharness: 2017-03-27 12:02:44.322919Z] Finished run-tests step (success) 05:02:44 INFO - Running post-run listener: _resource_record_post_run 05:02:44 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 4096; Write bytes: 254558208; Read time: 8; Write time: 154784 05:02:44 INFO - TinderboxPrint: CPU usage
13.1% 05:02:44 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 05:02:44 INFO - TinderboxPrint: I/O write bytes / time
254,558,208 / 154,784 05:02:44 INFO - TinderboxPrint: CPU idle
8,262.8 (86.9%) 05:02:44 INFO - TinderboxPrint: CPU user
1,202.7 (12.6%) 05:02:44 INFO - TinderboxPrint: Swap in / out
0 / 0 05:02:44 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 1769472; Read time: 0; Write time: 416 05:02:44 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 4096; Write bytes: 252682240; Read time: 8; Write time: 154348 05:02:44 INFO - Running post-run listener: _upload_blobber_files 05:02:44 INFO - Blob upload gear active. 05:02:44 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:02:44 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 05:02:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:02:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:02:45 INFO - (blobuploader) - INFO - Open directory for files ... 05:02:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 05:02:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:02:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:02:48 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 05:02:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:02:48 INFO - (blobuploader) - INFO - Done attempting. 05:02:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:02:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:02:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:02:52 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:02:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:02:52 INFO - (blobuploader) - INFO - Done attempting. 05:02:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:02:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:02:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:02:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:02:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:02:54 INFO - (blobuploader) - INFO - Done attempting. 05:02:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 05:02:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:02:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:02:56 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:02:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:02:56 INFO - (blobuploader) - INFO - Done attempting. 05:02:56 INFO - (blobuploader) - INFO - Iteration through files over. 05:02:56 INFO - Return code: 0 05:02:56 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:02:56 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:02:56 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/42b858da6d208afd5336e768c9c0edfde8f47c80c699ccff270cfbe587066e554c6bdea26786bd9fb15c124e5243a18ef1055c776385ad29f0a903bafc5c2773", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/689d0db650ba6d7c836f7a7c28dd23a2b523aabe4bbd5212c08871891a2dae15c3b828b1c1e106b77164cb9c948b5a3fe9b416f3187faedd363241be8f87dd17", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b7ec2d1f0f555b5ad18f207582e6e2ca5100ebe65b78c00cec81ad2bd7eaa860b8c4f0d6e2b874b83122279443884978c84f99ca10fd8775fb09b31a56989f90", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/88794fa69c9cf4dd1669c8db2eaa47335684bfa8d80665452bf39bb666993db2877082f804c843288d794089d8cb4531a2d3d8c843e036c2b0bba09a2ec47a04"} 05:02:56 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:02:56 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:02:56 INFO - Contents: 05:02:56 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/42b858da6d208afd5336e768c9c0edfde8f47c80c699ccff270cfbe587066e554c6bdea26786bd9fb15c124e5243a18ef1055c776385ad29f0a903bafc5c2773", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/689d0db650ba6d7c836f7a7c28dd23a2b523aabe4bbd5212c08871891a2dae15c3b828b1c1e106b77164cb9c948b5a3fe9b416f3187faedd363241be8f87dd17", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b7ec2d1f0f555b5ad18f207582e6e2ca5100ebe65b78c00cec81ad2bd7eaa860b8c4f0d6e2b874b83122279443884978c84f99ca10fd8775fb09b31a56989f90", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/88794fa69c9cf4dd1669c8db2eaa47335684bfa8d80665452bf39bb666993db2877082f804c843288d794089d8cb4531a2d3d8c843e036c2b0bba09a2ec47a04"} 05:02:56 INFO - Running post-run listener: copy_logs_to_upload_dir 05:02:56 INFO - Copying logs to upload dir... 05:02:56 INFO - mkdir: /builds/slave/test/build/upload/logs 05:02:56 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1319.849119 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 59 secs) (at 2017-03-27 05:02:54.685647) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-27 05:02:54.689464) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/42b858da6d208afd5336e768c9c0edfde8f47c80c699ccff270cfbe587066e554c6bdea26786bd9fb15c124e5243a18ef1055c776385ad29f0a903bafc5c2773", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/689d0db650ba6d7c836f7a7c28dd23a2b523aabe4bbd5212c08871891a2dae15c3b828b1c1e106b77164cb9c948b5a3fe9b416f3187faedd363241be8f87dd17", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b7ec2d1f0f555b5ad18f207582e6e2ca5100ebe65b78c00cec81ad2bd7eaa860b8c4f0d6e2b874b83122279443884978c84f99ca10fd8775fb09b31a56989f90", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/88794fa69c9cf4dd1669c8db2eaa47335684bfa8d80665452bf39bb666993db2877082f804c843288d794089d8cb4531a2d3d8c843e036c2b0bba09a2ec47a04"} build_url:https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011359 build_url: 'https://queue.taskcluster.net/v1/task/A_SPqbwxTpqT6Ns8olz7xQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/42b858da6d208afd5336e768c9c0edfde8f47c80c699ccff270cfbe587066e554c6bdea26786bd9fb15c124e5243a18ef1055c776385ad29f0a903bafc5c2773", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/689d0db650ba6d7c836f7a7c28dd23a2b523aabe4bbd5212c08871891a2dae15c3b828b1c1e106b77164cb9c948b5a3fe9b416f3187faedd363241be8f87dd17", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b7ec2d1f0f555b5ad18f207582e6e2ca5100ebe65b78c00cec81ad2bd7eaa860b8c4f0d6e2b874b83122279443884978c84f99ca10fd8775fb09b31a56989f90", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/88794fa69c9cf4dd1669c8db2eaa47335684bfa8d80665452bf39bb666993db2877082f804c843288d794089d8cb4531a2d3d8c843e036c2b0bba09a2ec47a04"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-27 05:02:54.714216) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-27 05:02:54.714536) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1490614847.788726-1130847932 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004473 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-27 05:02:54.800153) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-27 05:02:54.800464) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-27 05:02:54.800777) ========= ========= Total master_lag: 0.17 =========