builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-011 starttime: 1491047090.6 results: success (0) revision: 7bc9570270b395dc53be1739391cc34b42d1b834 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:50.605023) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:50.605721) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:50.606082) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:50.632472) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:50.632729) ========= 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=5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-04-01 04:44: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.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 101M=0s 2017-04-01 04:44:51 (101 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.163274 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:50.813497) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:50.813775) ========= 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=5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020879 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:50.865515) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-04-01 04:44:50.865824) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 7bc9570270b395dc53be1739391cc34b42d1b834 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 7bc9570270b395dc53be1739391cc34b42d1b834 --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=5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-04-01 04:44:51,501 truncating revision to first 12 chars 2017-04-01 04:44:51,501 Setting DEBUG logging. 2017-04-01 04:44:51,501 attempt 1/10 2017-04-01 04:44:51,501 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/7bc9570270b3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-04-01 04:44:52,864 unpacking tar archive at: mozilla-central-7bc9570270b3/testing/mozharness/ program finished with exit code 0 elapsedTime=1.691893 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-04-01 04:44:52.571930) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:52.572248) ========= script_repo_revision: 7bc9570270b395dc53be1739391cc34b42d1b834 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:52.572619) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:52.572876) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-01 04:44:52.581871) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2017-04-01 04:44:52.582164) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:44:53 INFO - MultiFileLogger online at 20170401 04:44:53 in /builds/slave/test 04:44:53 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 04:44:53 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:44:53 INFO - {'append_to_log': False, 04:44:53 INFO - 'base_work_dir': '/builds/slave/test', 04:44:53 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 04:44:53 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:44:53 INFO - 'branch': 'Firefox-Non-PGO', 04:44:53 INFO - 'buildbot_json_path': 'buildprops.json', 04:44:53 INFO - 'config_files': ('talos/linux_config.py',), 04:44:53 INFO - 'default_actions': ('clobber', 04:44:53 INFO - 'read-buildbot-config', 04:44:53 INFO - 'download-and-extract', 04:44:53 INFO - 'populate-webroot', 04:44:53 INFO - 'create-virtualenv', 04:44:53 INFO - 'install', 04:44:53 INFO - 'run-tests'), 04:44:53 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:44:53 INFO - 'download_minidump_stackwalk': True, 04:44:53 INFO - 'download_symbols': 'ondemand', 04:44:53 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:44:53 INFO - 'tooltool.py': '/tools/tooltool.py', 04:44:53 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:44:53 INFO - '/tools/misc-python/virtualenv.py')}, 04:44:53 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:44:53 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:44:53 INFO - 'gecko_profile': False, 04:44:53 INFO - 'gecko_profile_interval': 0, 04:44:53 INFO - 'installer_path': 'installer.exe', 04:44:53 INFO - 'log_level': 'info', 04:44:53 INFO - 'log_name': 'talos', 04:44:53 INFO - 'log_to_console': True, 04:44:53 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:44:53 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:44:53 INFO - 'opt_config_files': (), 04:44:53 INFO - 'pip_index': False, 04:44:53 INFO - 'suite': 'dromaeojs', 04:44:53 INFO - 'system_bits': '32', 04:44:53 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:44:53 INFO - 'title': 'talos-linux64-ix-011', 04:44:53 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:44:53 INFO - 'use_talos_json': True, 04:44:53 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:44:53 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:44:53 INFO - 'work_dir': 'build'} 04:44:53 INFO - [mozharness: 2017-04-01 11:44:53.319138Z] Running clobber step. 04:44:53 INFO - Running pre-action listener: _resource_record_pre_action 04:44:53 INFO - Running main action method: clobber 04:44:53 INFO - rmtree: /builds/slave/test/build 04:44:53 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:44:54 INFO - Running post-action listener: _resource_record_post_action 04:44:54 INFO - [mozharness: 2017-04-01 11:44:54.253817Z] Finished clobber step (success) 04:44:54 INFO - [mozharness: 2017-04-01 11:44:54.253917Z] Running read-buildbot-config step. 04:44:54 INFO - Running pre-action listener: _resource_record_pre_action 04:44:54 INFO - Running main action method: read_buildbot_config 04:44:54 INFO - Using buildbot properties: 04:44:54 INFO - { 04:44:54 INFO - "project": "", 04:44:54 INFO - "product": "firefox", 04:44:54 INFO - "who": "archaeopteryx@coole-files.de", 04:44:54 INFO - "installer_path": "public/build/target.tar.bz2", 04:44:54 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 04:44:54 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 04:44:54 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 04:44:54 INFO - "stage_platform": "linux64", 04:44:54 INFO - "basedir": "/builds/slave/test", 04:44:54 INFO - "buildnumber": 520, 04:44:54 INFO - "platform": "ubuntu64_hw", 04:44:54 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 04:44:54 INFO - "slavebuilddir": "test", 04:44:54 INFO - "taskId": "UnmDRD6oRMecG0jaS3_HPQ", 04:44:54 INFO - "branch": "mozilla-central", 04:44:54 INFO - "script_repo_revision": "production", 04:44:54 INFO - "revision": "7bc9570270b395dc53be1739391cc34b42d1b834", 04:44:54 INFO - "slavename": "talos-linux64-ix-011", 04:44:54 INFO - "repo_path": "mozilla-central" 04:44:54 INFO - } 04:44:54 INFO - Finding installer, test and symbols from parent task. 04:44:54 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/UnmDRD6oRMecG0jaS3_HPQ'}, attempt #1 04:44:54 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/UnmDRD6oRMecG0jaS3_HPQ'}, attempt #1 04:44:55 INFO - Task dependencies: ApBbcpfuQhG--UwXH3UUZQ 04:44:55 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ'}, attempt #1 04:44:55 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.tar.bz2 04:44:55 INFO - Set test_url: https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/test_packages.json 04:44:55 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.crashreporter-symbols.zip 04:44:55 INFO - Running post-action listener: _resource_record_post_action 04:44:55 INFO - [mozharness: 2017-04-01 11:44:55.702424Z] Finished read-buildbot-config step (success) 04:44:55 INFO - [mozharness: 2017-04-01 11:44:55.702641Z] Running download-and-extract step. 04:44:55 INFO - Running pre-action listener: _resource_record_pre_action 04:44:55 INFO - Running main action method: download_and_extract 04:44:55 INFO - mkdir: /builds/slave/test/build/tests 04:44:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:44:55 INFO - trying https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.test_packages.json 04:44:55 INFO - Downloading https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 04:44:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 04:44:56 INFO - Downloaded 986 bytes. 04:44:56 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 04:44:56 INFO - Using the following test package requirements: 04:44:56 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 04:44:56 INFO - u'common': [u'target.common.tests.zip'], 04:44:56 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 04:44:56 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 04:44:56 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 04:44:56 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 04:44:56 INFO - u'mozbase': [u'target.common.tests.zip'], 04:44:56 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 04:44:56 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 04:44:56 INFO - u'web-platform': [u'target.common.tests.zip', 04:44:56 INFO - u'target.web-platform.tests.zip'], 04:44:56 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 04:44:56 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 04:44:56 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.common.tests.zip 04:44:56 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:44:56 INFO - Fetch https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.common.tests.zip into memory 04:44:57 INFO - Expected file size: 58235457 04:44:57 INFO - Obtained file size: 58235457 04:45:07 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 04:45:07 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.common.tests.zip 04:45:07 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:45:07 INFO - Fetch https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.common.tests.zip into memory 04:45:09 INFO - Expected file size: 58235457 04:45:09 INFO - Obtained file size: 58235457 04:45:19 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.talos.tests.zip 04:45:19 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 04:45:19 INFO - Fetch https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.talos.tests.zip into memory 04:45:20 INFO - Expected file size: 14404152 04:45:20 INFO - Obtained file size: 14404152 04:45:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:20 INFO - trying https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.tar.bz2 04:45:20 INFO - Downloading https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 04:45:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 04:45:22 INFO - Downloaded 62505676 bytes. 04:45:22 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.tar.bz2 04:45:22 INFO - mkdir: /builds/slave/test/properties 04:45:22 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:45:22 INFO - Writing to file /builds/slave/test/properties/build_url 04:45:22 INFO - Contents: 04:45:22 INFO - build_url:https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.tar.bz2 04:45:22 INFO - Running post-action listener: _resource_record_post_action 04:45:22 INFO - Running post-action listener: set_extra_try_arguments 04:45:22 INFO - [mozharness: 2017-04-01 11:45:22.138809Z] Finished download-and-extract step (success) 04:45:22 INFO - [mozharness: 2017-04-01 11:45:22.138905Z] Running populate-webroot step. 04:45:22 INFO - Running pre-action listener: _resource_record_pre_action 04:45:22 INFO - Running main action method: populate_webroot 04:45:22 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:45:22 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:45:22 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:45:22 INFO - '--tppagecycles', 04:45:22 INFO - '7'], 04:45:22 INFO - 'tests': ['tsvgm']}}, 04:45:22 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:45:22 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:45:22 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:45:22 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:45:22 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 04:45:22 INFO - 'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:45:22 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 04:45:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:45:22 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 04:45:22 INFO - 'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['damp', 'tps']}, 04:45:22 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 04:45:22 INFO - 'tests': ['damp', 'tps']}, 04:45:22 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['dromaeo_dom']}, 04:45:22 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:45:22 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['basic_compositor_video']}, 04:45:22 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 04:45:22 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['a11yr', 04:45:22 INFO - 'ts_paint', 04:45:22 INFO - 'tpaint', 04:45:22 INFO - 'sessionrestore', 04:45:22 INFO - 'sessionrestore_no_auto_restore', 04:45:22 INFO - 'tabpaint']}, 04:45:22 INFO - 'other-e10s': {'tests': ['a11yr', 04:45:22 INFO - 'ts_paint', 04:45:22 INFO - 'tpaint', 04:45:22 INFO - 'sessionrestore', 04:45:22 INFO - 'sessionrestore_no_auto_restore', 04:45:22 INFO - 'tabpaint']}, 04:45:22 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:45:22 INFO - 'ts_paint', 04:45:22 INFO - 'tpaint', 04:45:22 INFO - 'sessionrestore', 04:45:22 INFO - 'sessionrestore_no_auto_restore', 04:45:22 INFO - 'tabpaint']}, 04:45:22 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:45:22 INFO - 'ts_paint', 04:45:22 INFO - 'tpaint', 04:45:22 INFO - 'sessionrestore', 04:45:22 INFO - 'sessionrestore_no_auto_restore', 04:45:22 INFO - 'tabpaint']}, 04:45:22 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['a11yr', 04:45:22 INFO - 'ts_paint', 04:45:22 INFO - 'tpaint', 04:45:22 INFO - 'sessionrestore', 04:45:22 INFO - 'sessionrestore_no_auto_restore', 04:45:22 INFO - 'tabpaint']}, 04:45:22 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['a11yr', 04:45:22 INFO - 'ts_paint', 04:45:22 INFO - 'tpaint', 04:45:22 INFO - 'sessionrestore', 04:45:22 INFO - 'sessionrestore_no_auto_restore', 04:45:22 INFO - 'tabpaint']}, 04:45:22 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['tsvgx', 04:45:22 INFO - 'tsvgr_opacity', 04:45:22 INFO - 'tart', 04:45:22 INFO - 'tscrollx', 04:45:22 INFO - 'cart', 04:45:22 INFO - 'tsvg_static']}, 04:45:22 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:45:22 INFO - 'tsvgr_opacity', 04:45:22 INFO - 'tart', 04:45:22 INFO - 'tscrollx', 04:45:22 INFO - 'cart', 04:45:22 INFO - 'tsvg_static']}, 04:45:22 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 04:45:22 INFO - 'talos_options': ['--disable-e10s'], 04:45:22 INFO - 'tests': ['tp5o']}, 04:45:22 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 04:45:22 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 04:45:22 INFO - 'talos_options': ['--disable-e10s', 04:45:22 INFO - '--xperf_path', 04:45:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:45:22 INFO - 'tests': ['tp5n']}, 04:45:22 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 04:45:22 INFO - 'talos_options': ['--xperf_path', 04:45:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:45:22 INFO - 'tests': ['tp5n']}}, 04:45:22 INFO - 'talos.zip': {'path': '', 04:45:22 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:45:22 INFO - Running post-action listener: _resource_record_post_action 04:45:22 INFO - [mozharness: 2017-04-01 11:45:22.151990Z] Finished populate-webroot step (success) 04:45:22 INFO - [mozharness: 2017-04-01 11:45:22.152079Z] Running create-virtualenv step. 04:45:22 INFO - Running pre-action listener: _resource_record_pre_action 04:45:22 INFO - Running main action method: create_virtualenv 04:45:22 INFO - Creating virtualenv /builds/slave/test/build/venv 04:45:22 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:45:22 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:45:22 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:45:22 INFO - Using real prefix '/usr' 04:45:22 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:45:22 INFO - Installing distribute.............................................................................................................................................................................................done. 04:45:24 INFO - Installing pip.................done. 04:45:24 INFO - Return code: 0 04:45:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 04:45:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 04:45:24 INFO - Reading from file tmpfile_stdout 04:45:24 INFO - Output received: 04:45:24 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:45:24 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:45:24 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:45:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:24 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:45:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:24 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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:24 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:45:24 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:45:24 INFO - Using env: {'DISPLAY': ':0', 04:45:24 INFO - 'HOME': '/home/cltbld', 04:45:24 INFO - 'LANG': 'en_US.UTF-8', 04:45:24 INFO - 'LANGUAGE': 'en_US:en', 04:45:24 INFO - 'LOGNAME': 'cltbld', 04:45:24 INFO - 'MAIL': '/var/mail/cltbld', 04:45:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:24 INFO - 'MOZ_NO_REMOTE': '1', 04:45:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:24 INFO - 'NO_EM_RESTART': '1', 04:45:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:24 INFO - 'PWD': '/builds/slave/test', 04:45:24 INFO - 'SHELL': '/bin/bash', 04:45:24 INFO - 'SHLVL': '1', 04:45:24 INFO - 'TERM': 'linux', 04:45:24 INFO - 'TMOUT': '86400', 04:45:24 INFO - 'USER': 'cltbld', 04:45:24 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:24 INFO - '_': '/tools/buildbot/bin/python'} 04:45:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:25 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:45:25 INFO - Cleaning up... 04:45:25 INFO - Return code: 0 04:45:25 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:45:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 04:45:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 04:45:25 INFO - Using env: {'DISPLAY': ':0', 04:45:25 INFO - 'HOME': '/home/cltbld', 04:45:25 INFO - 'LANG': 'en_US.UTF-8', 04:45:25 INFO - 'LANGUAGE': 'en_US:en', 04:45:25 INFO - 'LOGNAME': 'cltbld', 04:45:25 INFO - 'MAIL': '/var/mail/cltbld', 04:45:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:25 INFO - 'MOZ_NO_REMOTE': '1', 04:45:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:25 INFO - 'NO_EM_RESTART': '1', 04:45:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:25 INFO - 'PWD': '/builds/slave/test', 04:45:25 INFO - 'SHELL': '/bin/bash', 04:45:25 INFO - 'SHLVL': '1', 04:45:25 INFO - 'TERM': 'linux', 04:45:25 INFO - 'TMOUT': '86400', 04:45:25 INFO - 'USER': 'cltbld', 04:45:25 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:25 INFO - '_': '/tools/buildbot/bin/python'} 04:45:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:25 INFO - Downloading/unpacking psutil>=3.1.1 04:45:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:45:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:45:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:45:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:45:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:45:27 INFO - Installing collected packages: psutil 04:45:27 INFO - Running setup.py install for psutil 04:45:27 INFO - building 'psutil._psutil_linux' extension 04:45:27 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:45:27 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:45:27 INFO - building 'psutil._psutil_posix' extension 04:45:27 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:45:27 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:45:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:45:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:45:28 INFO - Successfully installed psutil 04:45:28 INFO - Cleaning up... 04:45:28 INFO - Return code: 0 04:45:28 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:45:28 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:45:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:28 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:45:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:28 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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:28 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:45:28 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:45:28 INFO - Using env: {'DISPLAY': ':0', 04:45:28 INFO - 'HOME': '/home/cltbld', 04:45:28 INFO - 'LANG': 'en_US.UTF-8', 04:45:28 INFO - 'LANGUAGE': 'en_US:en', 04:45:28 INFO - 'LOGNAME': 'cltbld', 04:45:28 INFO - 'MAIL': '/var/mail/cltbld', 04:45:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:28 INFO - 'MOZ_NO_REMOTE': '1', 04:45:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:28 INFO - 'NO_EM_RESTART': '1', 04:45:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:28 INFO - 'PWD': '/builds/slave/test', 04:45:28 INFO - 'SHELL': '/bin/bash', 04:45:28 INFO - 'SHLVL': '1', 04:45:28 INFO - 'TERM': 'linux', 04:45:28 INFO - 'TMOUT': '86400', 04:45:28 INFO - 'USER': 'cltbld', 04:45:28 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:28 INFO - '_': '/tools/buildbot/bin/python'} 04:45:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:28 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:45:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:45:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:45:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:30 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:45:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:45:30 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:45:30 INFO - Installing collected packages: mozsystemmonitor 04:45:30 INFO - Running setup.py install for mozsystemmonitor 04:45:30 INFO - Successfully installed mozsystemmonitor 04:45:30 INFO - Cleaning up... 04:45:30 INFO - Return code: 0 04:45:30 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:45:30 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:45:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:30 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:45:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:30 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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:30 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:45:30 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:45:30 INFO - Using env: {'DISPLAY': ':0', 04:45:30 INFO - 'HOME': '/home/cltbld', 04:45:30 INFO - 'LANG': 'en_US.UTF-8', 04:45:30 INFO - 'LANGUAGE': 'en_US:en', 04:45:30 INFO - 'LOGNAME': 'cltbld', 04:45:30 INFO - 'MAIL': '/var/mail/cltbld', 04:45:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:30 INFO - 'MOZ_NO_REMOTE': '1', 04:45:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:30 INFO - 'NO_EM_RESTART': '1', 04:45:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:30 INFO - 'PWD': '/builds/slave/test', 04:45:30 INFO - 'SHELL': '/bin/bash', 04:45:30 INFO - 'SHLVL': '1', 04:45:30 INFO - 'TERM': 'linux', 04:45:30 INFO - 'TMOUT': '86400', 04:45:30 INFO - 'USER': 'cltbld', 04:45:30 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:30 INFO - '_': '/tools/buildbot/bin/python'} 04:45:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:30 INFO - Downloading/unpacking jsonschema==2.5.1 04:45: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:45: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:45: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:45: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:45: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:45: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:45:32 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:45:32 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:45:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:32 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:45:32 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:45:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:33 INFO - Downloading functools32-3.2.3-2.tar.gz 04:45:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:45:33 INFO - warning: no files found matching '*.txt' 04:45:33 INFO - no previously-included directories found matching 'build' 04:45:33 INFO - no previously-included directories found matching 'dist' 04:45:33 INFO - no previously-included directories found matching '.git*' 04:45:33 INFO - Installing collected packages: jsonschema, functools32 04:45:33 INFO - Running setup.py install for functools32 04:45:33 INFO - warning: no files found matching '*.txt' 04:45:33 INFO - no previously-included directories found matching 'build' 04:45:33 INFO - no previously-included directories found matching 'dist' 04:45:33 INFO - no previously-included directories found matching '.git*' 04:45:33 INFO - Successfully installed jsonschema functools32 04:45:33 INFO - Cleaning up... 04:45:33 INFO - Return code: 0 04:45:33 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:45:33 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:45:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:33 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:45:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:33 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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:33 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:45:33 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:45:33 INFO - Using env: {'DISPLAY': ':0', 04:45:33 INFO - 'HOME': '/home/cltbld', 04:45:33 INFO - 'LANG': 'en_US.UTF-8', 04:45:33 INFO - 'LANGUAGE': 'en_US:en', 04:45:33 INFO - 'LOGNAME': 'cltbld', 04:45:33 INFO - 'MAIL': '/var/mail/cltbld', 04:45:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:33 INFO - 'MOZ_NO_REMOTE': '1', 04:45:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:33 INFO - 'NO_EM_RESTART': '1', 04:45:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:33 INFO - 'PWD': '/builds/slave/test', 04:45:33 INFO - 'SHELL': '/bin/bash', 04:45:33 INFO - 'SHLVL': '1', 04:45:33 INFO - 'TERM': 'linux', 04:45:33 INFO - 'TMOUT': '86400', 04:45:33 INFO - 'USER': 'cltbld', 04:45:33 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:33 INFO - '_': '/tools/buildbot/bin/python'} 04:45:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:33 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:45:33 INFO - Cleaning up... 04:45:33 INFO - Return code: 0 04:45:33 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:45:33 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:45:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:33 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:45:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:33 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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:33 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:45:33 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:45:33 INFO - Using env: {'DISPLAY': ':0', 04:45:33 INFO - 'HOME': '/home/cltbld', 04:45:33 INFO - 'LANG': 'en_US.UTF-8', 04:45:33 INFO - 'LANGUAGE': 'en_US:en', 04:45:33 INFO - 'LOGNAME': 'cltbld', 04:45:33 INFO - 'MAIL': '/var/mail/cltbld', 04:45:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:33 INFO - 'MOZ_NO_REMOTE': '1', 04:45:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:33 INFO - 'NO_EM_RESTART': '1', 04:45:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:33 INFO - 'PWD': '/builds/slave/test', 04:45:33 INFO - 'SHELL': '/bin/bash', 04:45:33 INFO - 'SHLVL': '1', 04:45:33 INFO - 'TERM': 'linux', 04:45:33 INFO - 'TMOUT': '86400', 04:45:33 INFO - 'USER': 'cltbld', 04:45:33 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:33 INFO - '_': '/tools/buildbot/bin/python'} 04:45:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:33 INFO - Downloading/unpacking blobuploader==1.2.4 04:45: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:45: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:45: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:45: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:45: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:45: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:45:35 INFO - Downloading blobuploader-1.2.4.tar.gz 04:45:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:45:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:45:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:35 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:45:35 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:45:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:45:36 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:45:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:36 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:45:36 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:45:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:45:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:45:36 INFO - Downloading docopt-0.6.1.tar.gz 04:45:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:45:36 INFO - Installing collected packages: blobuploader, requests, docopt 04:45:36 INFO - Running setup.py install for blobuploader 04:45:36 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:45:36 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:45:36 INFO - Running setup.py install for requests 04:45:37 INFO - Running setup.py install for docopt 04:45:37 INFO - Successfully installed blobuploader requests docopt 04:45:37 INFO - Cleaning up... 04:45:37 INFO - Return code: 0 04:45:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:45:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:37 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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:37 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:45:37 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:45:37 INFO - Using env: {'DISPLAY': ':0', 04:45:37 INFO - 'HOME': '/home/cltbld', 04:45:37 INFO - 'LANG': 'en_US.UTF-8', 04:45:37 INFO - 'LANGUAGE': 'en_US:en', 04:45:37 INFO - 'LOGNAME': 'cltbld', 04:45:37 INFO - 'MAIL': '/var/mail/cltbld', 04:45:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:37 INFO - 'MOZ_NO_REMOTE': '1', 04:45:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:37 INFO - 'NO_EM_RESTART': '1', 04:45:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:37 INFO - 'PWD': '/builds/slave/test', 04:45:37 INFO - 'SHELL': '/bin/bash', 04:45:37 INFO - 'SHLVL': '1', 04:45:37 INFO - 'TERM': 'linux', 04:45:37 INFO - 'TMOUT': '86400', 04:45:37 INFO - 'USER': 'cltbld', 04:45:37 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:37 INFO - '_': '/tools/buildbot/bin/python'} 04:45:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:45:37 INFO - Running setup.py (path:/tmp/pip-qJkLI4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:45:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:45:37 INFO - Running setup.py (path:/tmp/pip-Zko75t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:45:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:45:37 INFO - Running setup.py (path:/tmp/pip-nsh4WQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:45:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:45:37 INFO - Running setup.py (path:/tmp/pip-mXfpal-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:45:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:45:37 INFO - Running setup.py (path:/tmp/pip-PQ3M2o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:45:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:45:37 INFO - Running setup.py (path:/tmp/pip-pF3VjC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:45:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:45:37 INFO - Running setup.py (path:/tmp/pip-1JNvDc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:45:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:45:37 INFO - Running setup.py (path:/tmp/pip-XadDOO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:45:38 INFO - Running setup.py (path:/tmp/pip-GhDulG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:45:38 INFO - Running setup.py (path:/tmp/pip-sCyNTr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:45:38 INFO - Running setup.py (path:/tmp/pip-omHf9y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:45:38 INFO - Running setup.py (path:/tmp/pip-U0IGWW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:45:38 INFO - Running setup.py (path:/tmp/pip-rr14WO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:45:38 INFO - Running setup.py (path:/tmp/pip-ZrLBre-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:45:38 INFO - Running setup.py (path:/tmp/pip-quLBcE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:45:38 INFO - Running setup.py (path:/tmp/pip-3aWOOE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:45:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:45:38 INFO - Running setup.py (path:/tmp/pip-xDUyvE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:45:38 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:45:38 INFO - Running setup.py install for manifestparser 04:45:38 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:45:38 INFO - Running setup.py install for mozcrash 04:45:38 INFO - Running setup.py install for mozdebug 04:45:38 INFO - Running setup.py install for mozdevice 04:45:39 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Running setup.py install for mozfile 04:45:39 INFO - Running setup.py install for mozhttpd 04:45:39 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Running setup.py install for mozinfo 04:45:39 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Running setup.py install for mozInstall 04:45:39 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Running setup.py install for mozleak 04:45:39 INFO - Running setup.py install for mozlog 04:45:39 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Running setup.py install for moznetwork 04:45:39 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:45:39 INFO - Running setup.py install for mozprocess 04:45:39 INFO - Running setup.py install for mozprofile 04:45:40 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:45:40 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:45:40 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:45:40 INFO - Running setup.py install for mozrunner 04:45:40 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:45:40 INFO - Running setup.py install for mozscreenshot 04:45:40 INFO - Running setup.py install for moztest 04:45:40 INFO - Running setup.py install for mozversion 04:45:40 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:45:40 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:45:40 INFO - Cleaning up... 04:45:40 INFO - Return code: 0 04:45:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:45:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:40 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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:40 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:45:40 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:45:40 INFO - Using env: {'DISPLAY': ':0', 04:45:40 INFO - 'HOME': '/home/cltbld', 04:45:40 INFO - 'LANG': 'en_US.UTF-8', 04:45:40 INFO - 'LANGUAGE': 'en_US:en', 04:45:40 INFO - 'LOGNAME': 'cltbld', 04:45:40 INFO - 'MAIL': '/var/mail/cltbld', 04:45:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:40 INFO - 'MOZ_NO_REMOTE': '1', 04:45:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:40 INFO - 'NO_EM_RESTART': '1', 04:45:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:40 INFO - 'PWD': '/builds/slave/test', 04:45:40 INFO - 'SHELL': '/bin/bash', 04:45:40 INFO - 'SHLVL': '1', 04:45:40 INFO - 'TERM': 'linux', 04:45:40 INFO - 'TMOUT': '86400', 04:45:40 INFO - 'USER': 'cltbld', 04:45:40 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:40 INFO - '_': '/tools/buildbot/bin/python'} 04:45:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:45:40 INFO - Running setup.py (path:/tmp/pip-6KvY_j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:45:40 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:45:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:45:40 INFO - Running setup.py (path:/tmp/pip-OoXBfO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:45:40 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:45:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:45:40 INFO - Running setup.py (path:/tmp/pip-Gc1tWC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:45:40 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:45:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:45:40 INFO - Running setup.py (path:/tmp/pip-w5oEk1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:45:41 INFO - Running setup.py (path:/tmp/pip-GKBApE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:45:41 INFO - Running setup.py (path:/tmp/pip-F6dI6c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:45:41 INFO - Running setup.py (path:/tmp/pip-J3dnEB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:45:41 INFO - Running setup.py (path:/tmp/pip-T9ngFC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:45:41 INFO - Running setup.py (path:/tmp/pip-r2SBln-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:45:41 INFO - Running setup.py (path:/tmp/pip-2kQyTd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:45:41 INFO - Running setup.py (path:/tmp/pip-XnguXD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:45:41 INFO - Running setup.py (path:/tmp/pip-Risul9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:45:41 INFO - Running setup.py (path:/tmp/pip-Tio2Sb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:45:41 INFO - Running setup.py (path:/tmp/pip-HqysTS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:45:41 INFO - Running setup.py (path:/tmp/pip-RSIg9m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:45:41 INFO - Running setup.py (path:/tmp/pip-_W4AXh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:45:41 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:45:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:45:41 INFO - Running setup.py (path:/tmp/pip-HOLKcz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:45:41 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:45:41 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:45:41 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:45:41 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:45:41 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:45:41 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:45:41 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:45:41 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:45:41 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:45:41 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:45:41 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:45:41 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:45:41 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:45:43 INFO - Downloading blessings-1.6.tar.gz 04:45:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:45:44 INFO - Installing collected packages: blessings 04:45:44 INFO - Running setup.py install for blessings 04:45:44 INFO - Successfully installed blessings 04:45:44 INFO - Cleaning up... 04:45:44 INFO - Return code: 0 04:45:44 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:45:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:45:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:45:44 INFO - Reading from file tmpfile_stdout 04:45:44 INFO - Current package versions: 04:45:44 INFO - argparse == 1.2.1 04:45:44 INFO - blessings == 1.6 04:45:44 INFO - blobuploader == 1.2.4 04:45:44 INFO - docopt == 0.6.1 04:45:44 INFO - functools32 == 3.2.3-2 04:45:44 INFO - jsonschema == 2.5.1 04:45:44 INFO - manifestparser == 1.1 04:45:44 INFO - mozInstall == 1.12 04:45:44 INFO - mozcrash == 1.0 04:45:44 INFO - mozdebug == 0.1 04:45:44 INFO - mozdevice == 0.49 04:45:44 INFO - mozfile == 1.2 04:45:44 INFO - mozhttpd == 0.7 04:45:44 INFO - mozinfo == 0.9 04:45:44 INFO - mozleak == 0.1 04:45:44 INFO - mozlog == 3.4 04:45:44 INFO - moznetwork == 0.27 04:45:44 INFO - mozprocess == 0.25 04:45:44 INFO - mozprofile == 0.28 04:45:44 INFO - mozrunner == 6.13 04:45:44 INFO - mozscreenshot == 0.1 04:45:44 INFO - mozsystemmonitor == 0.3 04:45:44 INFO - moztest == 0.8 04:45:44 INFO - mozversion == 1.4 04:45:44 INFO - psutil == 3.1.1 04:45:44 INFO - requests == 1.2.3 04:45:44 INFO - wsgiref == 0.1.2 04:45:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:45:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:44 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 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:44 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:45:44 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:45:44 INFO - Using env: {'DISPLAY': ':0', 04:45:44 INFO - 'HOME': '/home/cltbld', 04:45:44 INFO - 'LANG': 'en_US.UTF-8', 04:45:44 INFO - 'LANGUAGE': 'en_US:en', 04:45:44 INFO - 'LOGNAME': 'cltbld', 04:45:44 INFO - 'MAIL': '/var/mail/cltbld', 04:45:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:44 INFO - 'MOZ_NO_REMOTE': '1', 04:45:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:44 INFO - 'NO_EM_RESTART': '1', 04:45:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:44 INFO - 'PWD': '/builds/slave/test', 04:45:44 INFO - 'SHELL': '/bin/bash', 04:45:44 INFO - 'SHLVL': '1', 04:45:44 INFO - 'TERM': 'linux', 04:45:44 INFO - 'TMOUT': '86400', 04:45:44 INFO - 'USER': 'cltbld', 04:45:44 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:44 INFO - '_': '/tools/buildbot/bin/python'} 04:45:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:44 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:45:44 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:45:44 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:45:44 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:45:44 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:45:44 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:45:44 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:45:44 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:45:44 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:45:44 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:45:44 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:45:44 INFO - Cleaning up... 04:45:44 INFO - Return code: 0 04:45:44 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:45:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:45:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:45:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:45:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:45:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e3d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f35a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20dab10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, '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': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', '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:45:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:45:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:45:44 INFO - Using env: {'DISPLAY': ':0', 04:45:44 INFO - 'HOME': '/home/cltbld', 04:45:44 INFO - 'LANG': 'en_US.UTF-8', 04:45:44 INFO - 'LANGUAGE': 'en_US:en', 04:45:44 INFO - 'LOGNAME': 'cltbld', 04:45:44 INFO - 'MAIL': '/var/mail/cltbld', 04:45:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:45:44 INFO - 'MOZ_NO_REMOTE': '1', 04:45:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:45:44 INFO - 'NO_EM_RESTART': '1', 04:45:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:45:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:45:44 INFO - 'PWD': '/builds/slave/test', 04:45:44 INFO - 'SHELL': '/bin/bash', 04:45:44 INFO - 'SHLVL': '1', 04:45:44 INFO - 'TERM': 'linux', 04:45:44 INFO - 'TMOUT': '86400', 04:45:44 INFO - 'USER': 'cltbld', 04:45:44 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:45:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:45:44 INFO - '_': '/tools/buildbot/bin/python'} 04:45:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:45:44 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:45:44 INFO - Cleaning up... 04:45:44 INFO - Return code: 0 04:45:44 INFO - Running post-action listener: _resource_record_post_action 04:45:44 INFO - Running post-action listener: _start_resource_monitoring 04:45:44 INFO - Starting resource monitoring. 04:45:44 INFO - [mozharness: 2017-04-01 11:45:44.917248Z] Finished create-virtualenv step (success) 04:45:44 INFO - [mozharness: 2017-04-01 11:45:44.917761Z] Running install step. 04:45:44 INFO - Running pre-action listener: _resource_record_pre_action 04:45:44 INFO - Running main action method: install 04:45:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:45:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:45:45 INFO - Reading from file tmpfile_stdout 04:45:45 INFO - Detecting whether we're running mozinstall >=1.0... 04:45:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:45:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:45:45 INFO - Reading from file tmpfile_stdout 04:45:45 INFO - Output received: 04:45:45 INFO - Usage: mozinstall [options] installer 04:45:45 INFO - Options: 04:45:45 INFO - -h, --help show this help message and exit 04:45:45 INFO - -d DEST, --destination=DEST 04:45:45 INFO - Directory to install application into. [default: 04:45:45 INFO - "/builds/slave/test"] 04:45:45 INFO - --app=APP Application being installed. [default: firefox] 04:45:45 INFO - mkdir: /builds/slave/test/build/application 04:45:45 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:45:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 04:46:00 INFO - Reading from file tmpfile_stdout 04:46:00 INFO - Output received: 04:46:00 INFO - /builds/slave/test/build/application/firefox/firefox 04:46:00 INFO - Running post-action listener: _resource_record_post_action 04:46:00 INFO - [mozharness: 2017-04-01 11:46:00.894315Z] Finished install step (success) 04:46:00 INFO - [mozharness: 2017-04-01 11:46:00.894585Z] Running run-tests step. 04:46:00 INFO - Running pre-action listener: _resource_record_pre_action 04:46:00 INFO - Running main action method: run_tests 04:46:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:46:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:46:00 INFO - Python 2.7.3 04:46:00 INFO - Return code: 0 04:46:00 INFO - grabbing minidump binary from tooltool 04:46:00 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:46:00 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 0x20d8290>, '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 0x20d8b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20d9040>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:46:00 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:46:00 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:46:00 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:46:00 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:46:00 INFO - Return code: 0 04:46:00 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:46:00 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:46:00 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:46:00 INFO - ENV: RUST_BACKTRACE is now 1 04:46:00 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:46:00 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:46:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--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:46:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-011 --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:46:00 INFO - Using env: {'DISPLAY': ':0', 04:46:00 INFO - 'HOME': '/home/cltbld', 04:46:00 INFO - 'LANG': 'en_US.UTF-8', 04:46:00 INFO - 'LANGUAGE': 'en_US:en', 04:46:00 INFO - 'LOGNAME': 'cltbld', 04:46:00 INFO - 'MAIL': '/var/mail/cltbld', 04:46:00 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:46:00 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:46:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:46:00 INFO - 'MOZ_NO_REMOTE': '1', 04:46:00 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:46:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:46:00 INFO - 'NO_EM_RESTART': '1', 04:46:00 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:46:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:46:00 INFO - 'PWD': '/builds/slave/test', 04:46:00 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:46:00 INFO - 'RUST_BACKTRACE': '1', 04:46:00 INFO - 'SHELL': '/bin/bash', 04:46:00 INFO - 'SHLVL': '1', 04:46:00 INFO - 'TERM': 'linux', 04:46:00 INFO - 'TMOUT': '86400', 04:46:00 INFO - 'USER': 'cltbld', 04:46:00 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908', 04:46:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:46:00 INFO - '_': '/tools/buildbot/bin/python'} 04:46:00 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--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:46:01 INFO - mozversion application_buildid: 20170401111011 04:46:01 INFO - mozversion application_changeset: 7bc9570270b395dc53be1739391cc34b42d1b834 04:46:01 INFO - mozversion application_display_name: Nightly 04:46:01 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:46:01 INFO - mozversion application_name: Firefox 04:46:01 INFO - mozversion application_remotingname: firefox 04:46:01 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:46:01 INFO - mozversion application_vendor: Mozilla 04:46:01 INFO - mozversion application_version: 55.0a1 04:46:01 INFO - mozversion platform_buildid: 20170401111011 04:46:01 INFO - mozversion platform_changeset: 7bc9570270b395dc53be1739391cc34b42d1b834 04:46:01 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:46:01 INFO - mozversion platform_version: 55.0a1 04:46:01 INFO - using testdate: 1491047161 04:46:01 INFO - actual date: 1491047161 04:46:01 INFO - starting webserver on 'localhost:36027' 04:46:01 INFO - SUITE-START | Running 2 tests 04:46:01 INFO - TEST-START | dromaeo_css 04:46:01 INFO - operating with platform_type : linux_ 04:46:01 INFO - Initialising browser for dromaeo_css test... 04:46:01 INFO - TEST-INFO | started process 9553 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmditcR/profile http://localhost:36027/getInfo.html) 04:46:05 INFO - PID 9553 | __metrics Screen width/height:1600/1200 04:46:05 INFO - PID 9553 | colorDepth:24 04:46:05 INFO - PID 9553 | Browser inner width/height: 1024/697 04:46:05 INFO - PID 9553 | __metrics 04:46:06 INFO - PID 9553 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 04:46:06 INFO - PID 9553 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:46:07 INFO - TEST-INFO | 9553: exit 0 04:46:07 INFO - Browser initialized. 04:46:07 INFO - Running cycle 1/1 for dromaeo_css test... 04:46:07 INFO - TEST-INFO | started process 9645 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmditcR/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:46:19 INFO - PID 9645 | RSS: Main: 149217280 04:46:19 INFO - PID 9645 | 04:49:26 INFO - PID 9645 | Cycle 1(1): loaded http://localhost:36027/tests/dromaeo/cssquery-dojo.html (next: http://localhost:36027/tests/dromaeo/cssquery-ext.html) 04:49:28 INFO - PID 9645 | RSS: Main: 300544000 04:49:28 INFO - PID 9645 | 04:51:10 INFO - PID 9645 | ************************* 04:51:10 INFO - PID 9645 | A coding exception was thrown and uncaught in a Task. 04:51:10 INFO - PID 9645 | 04:51:10 ERROR - PID 9645 | Full message: TypeError: NetworkError when attempting to fetch resource. 04:51:10 INFO - PID 9645 | Full stack: 04:51:10 INFO - PID 9645 | ************************* 04:51:10 INFO - PID 9645 | ************************* 04:51:10 INFO - PID 9645 | A coding exception was thrown and uncaught in a Task. 04:51:10 INFO - PID 9645 | 04:51:10 ERROR - PID 9645 | Full message: TypeError: NetworkError when attempting to fetch resource. 04:51:10 INFO - PID 9645 | Full stack: 04:51:10 INFO - PID 9645 | ************************* 04:51:10 INFO - PID 9645 | ************************* 04:51:10 INFO - PID 9645 | A coding exception was thrown and uncaught in a Task. 04:51:10 INFO - PID 9645 | 04:51:10 ERROR - PID 9645 | Full message: TypeError: NetworkError when attempting to fetch resource. 04:51:10 INFO - PID 9645 | Full stack: 04:51:10 INFO - PID 9645 | ************************* 04:51:10 INFO - PID 9645 | ************************* 04:51:10 INFO - PID 9645 | A coding exception was thrown and uncaught in a Task. 04:51:10 INFO - PID 9645 | 04:51:10 ERROR - PID 9645 | Full message: TypeError: NetworkError when attempting to fetch resource. 04:51:10 INFO - PID 9645 | Full stack: 04:51:10 INFO - PID 9645 | ************************* 04:52:30 INFO - PID 9645 | Cycle 1(1): loaded http://localhost:36027/tests/dromaeo/cssquery-ext.html (next: http://localhost:36027/tests/dromaeo/cssquery-jquery.html) 04:52:31 INFO - PID 9645 | RSS: Main: 247541760 04:52:31 INFO - PID 9645 | 04:55:33 INFO - PID 9645 | Cycle 1(1): loaded http://localhost:36027/tests/dromaeo/cssquery-jquery.html (next: http://localhost:36027/tests/dromaeo/cssquery-mootools.html) 04:55:34 INFO - PID 9645 | RSS: Main: 179830784 04:55:34 INFO - PID 9645 | 04:58:36 INFO - PID 9645 | Cycle 1(1): loaded http://localhost:36027/tests/dromaeo/cssquery-mootools.html (next: http://localhost:36027/tests/dromaeo/cssquery-prototype.html) 04:58:37 INFO - PID 9645 | RSS: Main: 226312192 04:58:37 INFO - PID 9645 | 05:01:40 INFO - PID 9645 | Cycle 1(1): loaded http://localhost:36027/tests/dromaeo/cssquery-prototype.html (next: http://localhost:36027/tests/dromaeo/cssquery-yui.html) 05:01:41 INFO - PID 9645 | RSS: Main: 188170240 05:01:41 INFO - PID 9645 | 05:04:43 INFO - PID 9645 | Cycle 1(1): loaded http://localhost:36027/tests/dromaeo/cssquery-yui.html (next: http://localhost:36027/tests/dromaeo/cssquery-dojo.html) 05:04:44 INFO - PID 9645 | RSS: Main: 280530944 05:04:44 INFO - PID 9645 | 05:04:44 INFO - PID 9645 | __start_tp_report 05:04:44 INFO - PID 9645 | _x_x_mozilla_page_load 05:04:44 INFO - PID 9645 | _x_x_mozilla_page_load_details 05:04:44 INFO - PID 9645 | |i|pagename|runs| 05:04:44 INFO - PID 9645 | |0;dojo.html;2655.867206639668;2689.462107578485;2702.0677866136184;2720.8231464954774;2726.972730272698;5092.719900405476;5211.218317252414;5215.791368345262;5235.371755389354;5292.391374991872;5157.252198431225;5158.406783219931;5176.896462070757;5183.041137389576;5191.351081114851;4588.678792484519;4599.747013914233;4628.490866004737;4630.097131059445;4667.463241727194;4636.605888499482;4669.252919532875;4670.346151538787;4675.672702910798;4678.625709943213;4662.673612847102;4664.160451118797;4669.34629151919;4670.042641258551;4673.252279635259;4652.395188625474;4657.743824089674;4666.043461090469;4734.976325118387;4739.6208303336;4718.339432479455;4725.905481890343;4726.574608285271;4733.337332773414;4771.546703063238;5235.947640523584;5236.581073514109;5279.366476022902;5291.523762861322;5310.761015754261;5156.819511317086;5515.145152501329;5546.556275497991;5613.494785469286;5614.887702245932;5721.799737009184;5751.683657398841;5752.5110365618975;5768.048272035109;5788.160716696056;5287.576993840484;5302.178162384759;5302.416734159239;5304.469553044664;5308.708021058879;5665.745041473144;5840.269966254218;5856.414358564195;5857.495127868585;5860.882782344329;5476.479734425223;5517.117261238182;5543;5598.97200514003;5611.775528978795;5655.208270842086;5656.830295091154;5657.20799088128;5660.575456840754;5704.11586204139;5595.356533998561;5596.552275817925;5608;5609.4390560943575;5613.270274864241;5443.891122177534;5497.697626630574;5510.6969116698965;5595.18869763882;5600.691961942132;4628.907421851612;4642.883927901762;4643.094596553708;4645.396098507173;4675.275332323496;3973.6821054315587;3979.900502487403;3989.2819292527624;3995.9400608990886;4038.697097717683;4652.488226295105;4715.882102947454;4727.858164255078;4748.0978614063215;4753.667243292936;5665.065264231438;5670.177824215466;5675.631083979528;5694.743736531866;5705.5720820938595;4735.289706543977;4737.976310118427;4740;4742.146413645508;4778.092162489185;4786.234202527578;4881.658283920163;4934;4949.727764972961;4953.628477864103;5254.211868219798;5265.842024739264;5267.13092339775;5306.734663266744;5317.521423071942;5631.436856314336;5636.971815140898;5638.746256418389;5648.068068768772;5649.322081350264;5083.745812709423;5163.690178589297;5242.554382877498;5242.921356179584;5293.841184764463;5448.155535891943;5475.041867673221;5478.972605136949;5518.613697041329;5521.69630670317;5610.7194640268635;5667.03660377745;5671.6029877909805;5671.631343962629;5674.801381951777;5379.784808607612;5397.946020539902;5415.160650099241;5461.371942226695;5467.781288748405;5509.917351239655;5520.337559492887;5536.114221724505;5540.196671482693;5544.61187716856;5403.972980135074;5406.621536492407;5420.674759514442;5431.158170483582;5454;5459.143891077053;5489.478499542537;5501.312335958005;5508.889822203453;5512.724363781715;5252.028374750684;5282.366116066097;5340.145576707708;5367.1680889462195;5398.8110416136815 05:04:44 INFO - PID 9645 | |1;ext.html;685.1401491128632;748.2891253309356;770.5607803551974;1074.8763892152406;1091.677955003274;27663.17010489686;28412.147635570913;28438.85780571094;28448.57327140092;28457.288567785814;33298.16754581137;33987.49018764721;34062.8296858516;34095.488567671506;34162.658373416256;7162.498625096232;7309.963450182741;7315.817104572375;7316.817079573027;7319.12170539536;5524.889502209953;7133.500654954155;7230.963845180767;7240.588085323364;7247.528910620819;5729.684867332295;7100.431965442752;7316.122065352165;7323.926760732378;7324.670389832444;7329.157146928118;7387.224341444125;7395.926040739631;7400.888986665204;7405.81485462865;5522.502974732253;7201.927980720178;7286.417086633057;7290.81772955675;7292.562446253189;26115.608265876028;26394.73605263961;26406.6039009415;31280;31770.364592708018;2646.073874144053;2651.164883061829;2658.601209818543;2659.2155314182364;2676.7992400570033;23548.64677029846;23741.525169496686;23812.761872381227;24010.7598924012;24054.278371648703;2618.3061488705316;2651.4962157190266;2652.244110428538;2653.2173008962404;2671.679398472176;145366;145959;146222.2688886549;146349.2682536591;146362;42477.362839557434;42535.361969570484;42558.57441425546;42587.36118958218;42653.57346426558;44314.556854431685;44542.77728611336;44627.10745785066;44652;44724.329135063;12551.623451296477;12891.806622900664;13035.869641303465;13100.803487947689;13127.540536081191;10567.89432105669;10570.947145264377;10573.471326433648;10586.100181484506;10589.258751887293;11303.886961130283;11550.768984620428;13069;13088.345582721016;13161.868381316255;5152.355955505562;5409.83770486886;5422.240886275925;5446.537044351196;5451.127819548853;870.6386849457531;902.3863772634671;912.5802131019673;916.5783739479781;936.3305236755616;20448.284310049374;21150.576988460143;21234.681479777817;21285.255016074672;21447;956.1920177450044;969.9951500242454;973.6202880876464;1003.3979612232602;1005.9044390782864;10820.78358432827;11237.55049797999;11277;11304.378259195659;11355.261907975955;205020;207486;208215;208268;236710;48038.51961480411;48526.75736621294;48698;48717.75641121772;48746.75626621915;1216.416120262279;1237.8019516877257;1239.9876001240052;1254.5922575163108;1258.8552316483722;23972.52054958926;24258.393540161636;25050.874745626155;25132.874335628938;25397.238082857544;31394.52908206333;31545;31574.210644734067;31586.842065789522;31595.526067109473;240351;240621;241350;241447;242109.78902110353;28647.713522864506;28811.135665930055;29030.27424314409;29323.70676293295;29335.853320734113;26522;31960.36079278448;33826.49260261147;33860;35011.29977400387;24972.37569060788;25934.481310374063;26253.868730656224;27066.72933270642;27330;25152.49695006126;25854.095106671175;25885.6117158239;26261.4747705041;26856.32859178536;28095.297617558906;28193.295167620974;28234.294142645776;28433.573496397985;29036.419271614872;25629.743702562737;25646.102386416387;25656.743432565436;25902.611460827724;26109.869450652626;19942;20893.686594701394;21001.26495572709;21021.57956840885;21026.789732103094 05:04:44 INFO - PID 9645 | |2;jquery.html;413.73314212333065;422.5605370414769;423.6166269526079;431.9157764235973;437.44881449373787;18187.27250909962;18196.81803181968;18305.45083647491;19001.71497427536;19149.329773457932;18818;19015.429537113872;19606.411807645793;19774.901125494387;19796;5658.632188907708;5679.687617181054;5850.122481627747;5868.559858010645;5901.645901245939;5598.048331783607;5678.716064196794;5723.51350135239;5731.684757338345;5732.5127364174095;5637.633553819009;5743.282089738783;5781.248437703114;5788.536917046647;5790.420957904197;5616.382197958263;5654.802081927154;5753.827385178431;5818.156367326735;5824.941750582503;5169.508896654812;5171.818986335498;5171.948280517185;5176.2235664650225;5176.7929282828645;22712.54574908509;22832.315030548943;22898.42753931165;23026.424339391648;23040.539189216288;1547.9071255724693;1575.086449859079;1582.9366825326972;1633.7631043498745;1634.9591260218472;13821.378037988316;14528;14545.636359091002;14604.634884127876;14912.17983010934;1828.3235202974984;1879.4643526594855;1903.1626084522904;1910.4650697804636;1991;72171.90286870109;75626.24373756247;76137;76328.23671763322;90416;8566.729816598607;10513;11296.43517824122;11378.943105284421;11399.259048161843;15688.137152456724;15690.137042462775;15753.054816711034;15815.446459373867;15817.209139542976;7747.573883436465;7767.689292428353;7982.201779822088;8020.518768873886;8025.478343907627;7239.384652304508;7247.565146091251;7266.96366518164;7401.707009934225;7441.293077157661;7035.637904499244;7076.433885289164;7108.075950126554;7148.713231618359;7163.570185788869;2053.2813515269836;2053.4455696961736;2071.4510654676524;2075.3877606105934;2076.0761461149646;810.9716159934374;848.3891598049395;873.5675840459013;874.0734821089666;893.8748575199477;16815.579610509834;17159.571010724583;17341.132943353034;17606.943583384997;17805.109744512723;866.2723312417473;875.8248350329959;875.9343049271203;882.5940067568862;897.0536084430988;9084;9487.47818869955;9586.616535338508;9591.136797688241;9777.951110244545;454128;465389;471852;474353;475141;87757.5612121948;92896.53551732199;94366.52816735873;94935.52532237433;95051.52474237584;962.9807403851884;1054.7890421915647;1069.550788668761;1128.785530749155;1138.6697857621198;17692.82307176963;17703.78702662167;18333.79158647205;18503.259869605605;18594.2562297512;43108.353374698774;43218;43767.343489847044;44998.55001449944;45996.310055349866;53732.731336343066;54064.189037163684;54302.45697542974;54893.72553137209;57429.13856292075;8127.2279133482225;8322.625481853453;8339.749807505785;8727.519986400808;8748.956255218684;12722.936385318015;13157.276349800853;13270.336483175995;13609;13950.09324393911;11442.771144576895;11526.481308340977;11557;11723.237989530995;12095.516179352728;10346.482675866026;10430.113440357654;10488.475576221312;10522.368657880552;10758;11741.76516469683;11945.880541194825;11992.40037998114;12097.274163550215;12109.728478509629;8057.194280571896;8314.334853211607;8411.411201215857;8434.957825210835;8557.657693692432;10330.741731456474;11255;11355.772884542428;11417.714557135805;11844.881551184379 05:04:44 INFO - PID 9645 | |3;mootools.html;1212.2423485321674;1279.9680007999798;1296.598054603073;1310.4954592481893;1312.8949684025276;9535.475548844819;9978.351407158547;9985.650502232424;9992.300538962276;9996.050375214352;9662.92247166859;9990.45052522111;10038.849417258747;10049.69850904474;10055.899441005588;2209.734831820184;2254.0532976150057;2259.1641092795608;2259.288324177887;2262.8529145605567;1865.7761068671712;1942.854285928554;2135.2099723102474;2227.5878962392007;2290.679304897316;2169.8481106322565;2249.8875056247202;2253.278950735765;2257.119723307911;2262.5248697773486;2129.2015494189677;2187.3547303545492;2193.846430749848;2195.879226642542;2291.9083236670513;2184.9890750546306;2193.451637090727;2194.7585765565773;2195.10000899632;2195.7255343082115;9764.707058788248;9855.162311203556;9856.112949834549;9860;9860.950695246478;5492.286002819648;5698.800541981011;5700.743466543974;5706.343770466408;5719.59962802604;2843.3744576193203;3012.3523442459978;3072.339447018902;3084.8611812468494;3088.274255549944;940.1256831147031;949.3307218411004;954.0602506531061;994.5524513968743;1004.9899501004969;14247;14390.136591804421;14407.711845763131;14413.639659008504;14432.061915975533;4549.135664223787;4900.240462728283;4906.9263961040615;4936.703797772073;4945.060438516671;10558.31370960885;10565.524551395205;10598.523066462029;10610.151187904949;10623.256372053882;5476.151196564539;5479.3424789024775;5492.313460817398;5494.615376923577;5528.143137813645;4901.411830580353;5050.368703912011;5129.487051294841;5201.141811601044;5209.947900521022;3745.775253484745;3891.4357418174204;3909.198614284065;3971.4241434991764;3972.6424621784176;993.2798720927415;1132.8753837077916;1135.7387800805695;1135.8807325230896;1168.3515648814819;625.4933503861887;703.9753608623776;728.0753443127198;735.02976071585;741.7218543046357;5500.064988951888;5580.358258800209;5603.159526071122;5651.660900345993;5765.8558536036935;803.1807556292549;820.261764412022;833.1168960901464;834.1533343656193;842.7219017724259;3759.9436008459893;3918.8243526941806;3987.4018897165656;4004.479417675742;4019.33680942647;11969.281843089442;12872.22766634005;12940;12943.158694684815;12961.092723509264;12704.936475317565;12845.678858028437;12846.871531284567;13014.739705205842;13046.217226966412;9234.907650923406;9416.482093484925;9468.289878259158;9469.526523673789;9506.762330941643;5875.588708790344;5879.529637628894;5989.760409583568;5990.251218597676;6077.331493535796;11538.076953843505;11572.710682233012;11643.941780291045;11644.475998580254;11795.646130616095;11522.654320370402;12108.394580270775;12176.269423834598;12183.512659493521;12199.3290369027;7458.92541074604;7561.773146805384;7563.546187228784;7567.394608431202;7572.8485430292185;8873.825912651184;9067.09329067088;9160.770980725269;9183.265338772748;9187.54062296869;7843.568603726621;7974.720884769005;8016.8797468036855;8087.716929907425;8239.340852731648;7549.471536992358;7707.34487568563;7711.305982461606;7735.265149810759;7801.45389822707;7186.1376634804155;7313.451491138079;7319.085114360705;7321.121465424183;7323.414126869944;5045.8738531537;5077.974610126926;5133.7689803958165;5157.484251574812;5405.675659460445;5367.543758780547;5412.78348866041;5540.307461567304;5541.5289700375915;5639.555394346513 05:04:44 INFO - PID 9645 | |4;prototype.html;371.7917965939074;386.7930657098452;388.06282826972864;390.13974186917847;390.6464649492209;5322.574194064475;5342.893142137155;5358.517733403993;5359.866003349918;5371.623986320959;5022.949770502294;5185.55922746567;5193.80542475231;5227.895442091156;5237.711925844077;3977.403389491578;3978.3688687637928;3992.4410582518326;3993.700472464562;4000.2999475091888;3967.821448034845;3974.9006274843214;3983.741056831311;3985.6213659702426;3994.5206575211014;3865.9806700966456;3867.3425517662067;3954.4661470701517;3955.406688996645;3975.880723578283;3927.9607203928167;3933.311670457673;3936.881893543198;3940.3695408734466;3951.897760258212;3414.095264754817;3437.9656203437894;3441.4493681011168;3446.6897979181995;3450.896473105811;4974.552290293855;5087.3386459759995;5106.923396149061;5112.846614601568;5120.487951204887;4638.5593368629925;4640.257558790578;4653.348531205634;4664.463586687541;4670.159371313162;5513.173024046385;5562.360328562227;5570.832875013715;5575.54675942584;5603.579731520153;3770.377887648562;3879.631435013669;3886.9222615547815;3894.279558281727;3910.8240129194255;5629.0034075806225;5724.942750572524;5775.249217601727;5824.796132135355;5897.233359663259;3943.171933893857;3943.507061617298;3949.4865667463046;3958.089639382958;3961.3859851723028;4008.719389642697;4011.7793521356607;4014.498187726534;4021.276170289376;4024.4566983457444;4453.643708503312;4470.776461176928;4578.862634120982;4650.09323181983;4661.68567832671;5534.501894829485;5556.694381809039;5585.692786896679;5597.160425936142;5597.272354593877;1401.9158850469005;1411.2449839336111;1415.3418660323;1416.5467050543932;1418.1207651256286;910.5583791860943;944.730751735752;948.0898337595847;962.3552220012608;963.9566219520138;4777.856664300077;4782.258749893772;4782.689125206851;4783.784729687172;4790.592799612072;5772.307323121252;5772.6536407815665;5774.335951365647;5784.421557844182;5798.971005144947;4683.718976861399;4766.475687674353;4790.880227994328;4803.471618122004;4823.421189457287;3023.425549145655;3038.5745995560637;3044.4777611194404;3047.756179505634;3057.480228361184;5346.311045378677;5349.4650534946195;5368.4631536846;5379.1662292344745;5402;5678.744456499468;5853.560982926298;5860.824175274749;5872.530197584183;5901.3508514063415;5350.090484617546;5355.9020400817735;5376.843978544632;5388.380336261223;5390.407055223922;5545.667259964415;5749.942500575108;5754.741036653444;5779.0062428462115;5784.94215057844;5658.971705141448;5667.971660141838;5691.402402747652;5691.686957217227;5701.717113649562;5165.819196328111;5226.346706661668;5294.814681486129;5359.3032905722;5383.973080134574;4033.9394909076973;4035.858744943913;4035.9798201008807;4040.252553277653;4047.2310261050307;5790;5805.564582656233;5809.128630705428;5809.50619197373;5816.69564522242;5401.756920938488;5596.356419011703;5608.775648974159;5612.522935550524;5637.295338082739;5551.555875530029;5569.053260945568;5588.441155884379;5604.747786349542;5618.185363122243;5386.48828361305;5511.614187006871;5520.861978450571;5529.281193444826;5562.915231529812;5598.888022239614;5600.551955843442;5636.436356364495;5639.7744090237575;5651.180578816131;5444.455554444524;5482.616216864782;5497.202905578749;5498;5514.6691198528215 05:04:44 INFO - PID 9645 | |5;yui.html;642.1844257792601;650.0996120373281;652.6573548886834;652.7389044382248;676.8646270745852;12351.629451116458;12731.04517161212;12777.041721870874;12860.099793014493;12884.935575322123;13071.281079540622;13426.39581218845;13473.528426505074;13508.257045862498;13508.932455337734;882.9470231786081;897.3270047464401;901.6483571407157;902.9638814447414;903.1555495611624;897.5153417154729;907.314977192219;911.7583840282331;935.2611436964789;943.4103685196752;989.1938070472578;992.4938281476462;992.5483904823324;993.4089216915924;999.605155963394;991.9752006199831;992.1071036067561;993.2451336983872;993.8161440133526;994.0854413939157;730.7369347035063;734.3611058379191;734.6326836581709;734.8971144039785;734.9595772232525;14254.144751314954;14553.854461455461;14608.926955365156;14624.049436786574;14647.560573182822;14005.509807156803;14811.555653330417;14968.326425310886;14989.175595342253;15255.923720381437;9910.35582687123;10052.798944021079;10311.175105991502;10588.735281617945;10697.572097116185;2646.722094180122;2665.466906618684;2666.4267182555845;2689.0588294097106;2737.0693964052316;58613;59559.70220148915;72302.27697723008;72425;73750;10704.94647526773;10812;11168.441577921072;11300.157946298297;11772.587959421378;21346.57306853885;21456.356309310744;21731.891340543196;21741.67387489189;21963.23128690488;6550.951847704345;6640.734370625218;6679.265280819106;6728.529002969745;6741.966290168616;3230.418524665583;3269.476883698597;3286.8520916558814;3323.6011678598725;3359.798412095282;3586.6951309138494;3668.9816550917076;3701.7038636908983;3702.3705969985167;3728.2729867676085;694.2952902803659;702.2029995954526;702.6873041496485;709.5671640299413;724.3372314332327;553.0929275987384;557.8382269141985;561.9297587801525;568.9544836413077;570.3147200023919;8423.957880210559;9188.954055229815;9290.72127836166;9449.480278584744;9450.43297402158;531.7607076815449;546.1561886884773;562.839590716652;564.8136115082013;565.7567246084141;3836.2519308734527;3911.882643520699;3939.862104826317;4082.2039702258367;4104.958950410517;62995.6850215746;63754.362456374845;65183;65653.67173164104;66751;57240.42759572351;57375.42624573784;57998.7100064497;58382.70808645929;58902.705486472296;48712.51287487151;50263;50601.999999999265;51137.74431127895;52331.215031774555;7768.53388796674;8142.10436851934;8227.83544329098;8244.752657420288;8283.95858020706;27180.184594461407;27287.317817054733;27402.725972740816;27535.31161720973;28446.715532844406;32323.545440454767;33094;33343;34035.48946765751;34476.482852757734;9966.352187107816;10005.899941000496;10066.949665251626;10379.84430233532;10609.469526523488;11463.770724585294;11585.942070289595;11598.71003224926;12130.6500559015;12278.386080696107;10799.67600971972;11032.724181895195;11184.832227516756;11619.883801161881;11641.825372619249;10957.945210273898;11001.889981100087;11013.889861101286;11023.543545339855;11130.499127539118;9725.221982241545;9764.218862491125;10035.046670566284;10228.232882533988;10275.126614237874;7776.572288524186;7873.448858579844;8012.3590112792;8096.635651395819;8108;8981.191692747683;9099.1810737034;9134.954325228331;9172.174504294646;9228.861567076634 05:04:44 INFO - PID 9645 | __end_tp_report 05:04:44 INFO - PID 9645 | __start_cc_report 05:04:44 INFO - PID 9645 | _x_x_mozilla_cycle_collect,1692 05:04:44 INFO - PID 9645 | __end_cc_report 05:04:44 INFO - PID 9645 | __startTimestamp1491048284240__endTimestamp 05:04:44 INFO - PID 9645 | 05:04:44 INFO - PID 9645 | ------- Summary: start ------- 05:04:44 INFO - PID 9645 | Number of tests: 6 05:04:44 INFO - PID 9645 | 05:04:44 INFO - PID 9645 | [#0] dojo.html Cycles:165 Average:5139.91 Median:5302.42 stddev:612.53 (11.6%) stddev-sans-first:582.59 05:04:44 INFO - PID 9645 | Values: 2655.9 2689.5 2702.1 2720.8 2727.0 5092.7 5211.2 5215.8 5235.4 5292.4 5157.3 5158.4 5176.9 5183.0 5191.4 4588.7 4599.7 4628.5 4630.1 4667.5 4636.6 4669.3 4670.3 4675.7 4678.6 4662.7 4664.2 4669.3 4670.0 4673.3 4652.4 4657.7 4666.0 4735.0 4739.6 4718.3 4725.9 4726.6 4733.3 4771.5 5235.9 5236.6 5279.4 5291.5 5310.8 5156.8 5515.1 5546.6 5613.5 5614.9 5721.8 5751.7 5752.5 5768.0 5788.2 5287.6 5302.2 5302.4 5304.5 5308.7 5665.7 5840.3 5856.4 5857.5 5860.9 5476.5 5517.1 5543.0 5599.0 5611.8 5655.2 5656.8 5657.2 5660.6 5704.1 5595.4 5596.6 5608.0 5609.4 5613.3 5443.9 5497.7 5510.7 5595.2 5600.7 4628.9 4642.9 4643.1 4645.4 4675.3 3973.7 3979.9 3989.3 3995.9 4038.7 4652.5 4715.9 4727.9 4748.1 4753.7 5665.1 5670.2 5675.6 5694.7 5705.6 4735.3 4738.0 4740.0 4742.1 4778.1 4786.2 4881.7 4934.0 4949.7 4953.6 5254.2 5265.8 5267.1 5306.7 5317.5 5631.4 5637.0 5638.7 5648.1 5649.3 5083.7 5163.7 5242.6 5242.9 5293.8 5448.2 5475.0 5479.0 5518.6 5521.7 5610.7 5667.0 5671.6 5671.6 5674.8 5379.8 5397.9 5415.2 5461.4 5467.8 5509.9 5520.3 5536.1 5540.2 5544.6 5404.0 5406.6 5420.7 5431.2 5454.0 5459.1 5489.5 5501.3 5508.9 5512.7 5252.0 5282.4 5340.1 5367.2 5398.8 05:04:44 INFO - PID 9645 | 05:04:44 INFO - PID 9645 | [#1] ext.html Cycles:180 Average:33713.96 Median:26961.53 stddev:53302.17 (197.7%) stddev-sans-first:53394.01 05:04:44 INFO - PID 9645 | Values: 685.1 748.3 770.6 1074.9 1091.7 27663.2 28412.1 28438.9 28448.6 28457.3 33298.2 33987.5 34062.8 34095.5 34162.7 7162.5 7310.0 7315.8 7316.8 7319.1 5524.9 7133.5 7231.0 7240.6 7247.5 5729.7 7100.4 7316.1 7323.9 7324.7 7329.2 7387.2 7395.9 7400.9 7405.8 5522.5 7201.9 7286.4 7290.8 7292.6 26115.6 26394.7 26406.6 31280.0 31770.4 2646.1 2651.2 2658.6 2659.2 2676.8 23548.6 23741.5 23812.8 24010.8 24054.3 2618.3 2651.5 2652.2 2653.2 2671.7 145366.0 145959.0 146222.3 146349.3 146362.0 42477.4 42535.4 42558.6 42587.4 42653.6 44314.6 44542.8 44627.1 44652.0 44724.3 12551.6 12891.8 13035.9 13100.8 13127.5 10567.9 10570.9 10573.5 10586.1 10589.3 11303.9 11550.8 13069.0 13088.3 13161.9 5152.4 5409.8 5422.2 5446.5 5451.1 870.6 902.4 912.6 916.6 936.3 20448.3 21150.6 21234.7 21285.3 21447.0 956.2 970.0 973.6 1003.4 1005.9 10820.8 11237.6 11277.0 11304.4 11355.3 205020.0 207486.0 208215.0 208268.0 236710.0 48038.5 48526.8 48698.0 48717.8 48746.8 1216.4 1237.8 1240.0 1254.6 1258.9 23972.5 24258.4 25050.9 25132.9 25397.2 31394.5 31545.0 31574.2 31586.8 31595.5 240351.0 240621.0 241350.0 241447.0 242109.8 28647.7 28811.1 29030.3 29323.7 29335.9 26522.0 31960.4 33826.5 33860.0 35011.3 24972.4 25934.5 26253.9 27066.7 27330.0 25152.5 25854.1 25885.6 26261.5 26856.3 28095.3 28193.3 28234.3 28433.6 29036.4 25629.7 25646.1 25656.7 25902.6 26109.9 19942.0 20893.7 21001.3 21021.6 21026.8 05:04:44 INFO - PID 9645 | 05:04:44 INFO - PID 9645 | [#2] jquery.html Cycles:180 Average:28333.00 Median:44382.95 stddev:77285.38 (174.1%) stddev-sans-first:77473.76 05:04:44 INFO - PID 9645 | Values: 413.7 422.6 423.6 431.9 437.4 18187.3 18196.8 18305.5 19001.7 19149.3 18818.0 19015.4 19606.4 19774.9 19796.0 5658.6 5679.7 5850.1 5868.6 5901.6 5598.0 5678.7 5723.5 5731.7 5732.5 5637.6 5743.3 5781.2 5788.5 5790.4 5616.4 5654.8 5753.8 5818.2 5824.9 5169.5 5171.8 5171.9 5176.2 5176.8 22712.5 22832.3 22898.4 23026.4 23040.5 1547.9 1575.1 1582.9 1633.8 1635.0 13821.4 14528.0 14545.6 14604.6 14912.2 1828.3 1879.5 1903.2 1910.5 1991.0 72171.9 75626.2 76137.0 76328.2 90416.0 8566.7 10513.0 11296.4 11378.9 11399.3 15688.1 15690.1 15753.1 15815.4 15817.2 7747.6 7767.7 7982.2 8020.5 8025.5 7239.4 7247.6 7267.0 7401.7 7441.3 7035.6 7076.4 7108.1 7148.7 7163.6 2053.3 2053.4 2071.5 2075.4 2076.1 811.0 848.4 873.6 874.1 893.9 16815.6 17159.6 17341.1 17606.9 17805.1 866.3 875.8 875.9 882.6 897.1 9084.0 9487.5 9586.6 9591.1 9778.0 454128.0 465389.0 471852.0 474353.0 475141.0 87757.6 92896.5 94366.5 94935.5 95051.5 963.0 1054.8 1069.6 1128.8 1138.7 17692.8 17703.8 18333.8 18503.3 18594.3 43108.4 43218.0 43767.3 44998.6 45996.3 53732.7 54064.2 54302.5 54893.7 57429.1 8127.2 8322.6 8339.7 8727.5 8749.0 12722.9 13157.3 13270.3 13609.0 13950.1 11442.8 11526.5 11557.0 11723.2 12095.5 10346.5 10430.1 10488.5 10522.4 10758.0 11741.8 11945.9 11992.4 12097.3 12109.7 8057.2 8314.3 8411.4 8435.0 8557.7 10330.7 11255.0 11355.8 11417.7 11844.9 05:04:44 INFO - PID 9645 | 05:04:44 INFO - PID 9645 | [#3] mootools.html Cycles:180 Average:6198.16 Median:5064.17 stddev:3916.96 (77.3%) stddev-sans-first:3910.03 05:04:44 INFO - PID 9645 | Values: 1212.2 1280.0 1296.6 1310.5 1312.9 9535.5 9978.4 9985.7 9992.3 9996.1 9662.9 9990.5 10038.8 10049.7 10055.9 2209.7 2254.1 2259.2 2259.3 2262.9 1865.8 1942.9 2135.2 2227.6 2290.7 2169.8 2249.9 2253.3 2257.1 2262.5 2129.2 2187.4 2193.8 2195.9 2291.9 2185.0 2193.5 2194.8 2195.1 2195.7 9764.7 9855.2 9856.1 9860.0 9861.0 5492.3 5698.8 5700.7 5706.3 5719.6 2843.4 3012.4 3072.3 3084.9 3088.3 940.1 949.3 954.1 994.6 1005.0 14247.0 14390.1 14407.7 14413.6 14432.1 4549.1 4900.2 4906.9 4936.7 4945.1 10558.3 10565.5 10598.5 10610.2 10623.3 5476.2 5479.3 5492.3 5494.6 5528.1 4901.4 5050.4 5129.5 5201.1 5209.9 3745.8 3891.4 3909.2 3971.4 3972.6 993.3 1132.9 1135.7 1135.9 1168.4 625.5 704.0 728.1 735.0 741.7 5500.1 5580.4 5603.2 5651.7 5765.9 803.2 820.3 833.1 834.2 842.7 3759.9 3918.8 3987.4 4004.5 4019.3 11969.3 12872.2 12940.0 12943.2 12961.1 12704.9 12845.7 12846.9 13014.7 13046.2 9234.9 9416.5 9468.3 9469.5 9506.8 5875.6 5879.5 5989.8 5990.3 6077.3 11538.1 11572.7 11643.9 11644.5 11795.6 11522.7 12108.4 12176.3 12183.5 12199.3 7458.9 7561.8 7563.5 7567.4 7572.8 8873.8 9067.1 9160.8 9183.3 9187.5 7843.6 7974.7 8016.9 8087.7 8239.3 7549.5 7707.3 7711.3 7735.3 7801.5 7186.1 7313.5 7319.1 7321.1 7323.4 5045.9 5078.0 5133.8 5157.5 5405.7 5367.5 5412.8 5540.3 5541.5 5639.6 05:04:44 INFO - PID 9645 | 05:04:44 INFO - PID 9645 | [#4] prototype.html Cycles:180 Average:4579.01 Median:5232.80 stddev:1356.14 (25.9%) stddev-sans-first:1322.66 05:04:44 INFO - PID 9645 | Values: 371.8 386.8 388.1 390.1 390.6 5322.6 5342.9 5358.5 5359.9 5371.6 5022.9 5185.6 5193.8 5227.9 5237.7 3977.4 3978.4 3992.4 3993.7 4000.3 3967.8 3974.9 3983.7 3985.6 3994.5 3866.0 3867.3 3954.5 3955.4 3975.9 3928.0 3933.3 3936.9 3940.4 3951.9 3414.1 3438.0 3441.4 3446.7 3450.9 4974.6 5087.3 5106.9 5112.8 5120.5 4638.6 4640.3 4653.3 4664.5 4670.2 5513.2 5562.4 5570.8 5575.5 5603.6 3770.4 3879.6 3886.9 3894.3 3910.8 5629.0 5724.9 5775.2 5824.8 5897.2 3943.2 3943.5 3949.5 3958.1 3961.4 4008.7 4011.8 4014.5 4021.3 4024.5 4453.6 4470.8 4578.9 4650.1 4661.7 5534.5 5556.7 5585.7 5597.2 5597.3 1401.9 1411.2 1415.3 1416.5 1418.1 910.6 944.7 948.1 962.4 964.0 4777.9 4782.3 4782.7 4783.8 4790.6 5772.3 5772.7 5774.3 5784.4 5799.0 4683.7 4766.5 4790.9 4803.5 4823.4 3023.4 3038.6 3044.5 3047.8 3057.5 5346.3 5349.5 5368.5 5379.2 5402.0 5678.7 5853.6 5860.8 5872.5 5901.4 5350.1 5355.9 5376.8 5388.4 5390.4 5545.7 5749.9 5754.7 5779.0 5784.9 5659.0 5668.0 5691.4 5691.7 5701.7 5165.8 5226.3 5294.8 5359.3 5384.0 4033.9 4035.9 4036.0 4040.3 4047.2 5790.0 5805.6 5809.1 5809.5 5816.7 5401.8 5596.4 5608.8 5612.5 5637.3 5551.6 5569.1 5588.4 5604.7 5618.2 5386.5 5511.6 5520.9 5529.3 5562.9 5598.9 5600.6 5636.4 5639.8 5651.2 5444.5 5482.6 5497.2 5498.0 5514.7 05:04:44 INFO - PID 9645 | 05:04:44 INFO - PID 9645 | [#5] yui.html Cycles:180 Average:14344.22 Median:26431.49 stddev:18035.49 (68.2%) stddev-sans-first:18056.73 05:04:44 INFO - PID 9645 | Values: 642.2 650.1 652.7 652.7 676.9 12351.6 12731.0 12777.0 12860.1 12884.9 13071.3 13426.4 13473.5 13508.3 13508.9 882.9 897.3 901.6 903.0 903.2 897.5 907.3 911.8 935.3 943.4 989.2 992.5 992.5 993.4 999.6 992.0 992.1 993.2 993.8 994.1 730.7 734.4 734.6 734.9 735.0 14254.1 14553.9 14608.9 14624.0 14647.6 14005.5 14811.6 14968.3 14989.2 15255.9 9910.4 10052.8 10311.2 10588.7 10697.6 2646.7 2665.5 2666.4 2689.1 2737.1 58613.0 59559.7 72302.3 72425.0 73750.0 10704.9 10812.0 11168.4 11300.2 11772.6 21346.6 21456.4 21731.9 21741.7 21963.2 6551.0 6640.7 6679.3 6728.5 6742.0 3230.4 3269.5 3286.9 3323.6 3359.8 3586.7 3669.0 3701.7 3702.4 3728.3 694.3 702.2 702.7 709.6 724.3 553.1 557.8 561.9 569.0 570.3 8424.0 9189.0 9290.7 9449.5 9450.4 531.8 546.2 562.8 564.8 565.8 3836.3 3911.9 3939.9 4082.2 4105.0 62995.7 63754.4 65183.0 65653.7 66751.0 57240.4 57375.4 57998.7 58382.7 58902.7 48712.5 50263.0 50602.0 51137.7 52331.2 7768.5 8142.1 8227.8 8244.8 8284.0 27180.2 27287.3 27402.7 27535.3 28446.7 32323.5 33094.0 33343.0 34035.5 34476.5 9966.4 10005.9 10066.9 10379.8 10609.5 11463.8 11585.9 11598.7 12130.7 12278.4 10799.7 11032.7 11184.8 11619.9 11641.8 10957.9 11001.9 11013.9 11023.5 11130.5 9725.2 9764.2 10035.0 10228.2 10275.1 7776.6 7873.4 8012.4 8096.6 8108.0 8981.2 9099.2 9135.0 9172.2 9228.9 05:04:44 INFO - PID 9645 | -------- Summary: end -------- 05:04:44 INFO - PID 9645 | 05:04:45 INFO - TEST-INFO | 9645: exit 0 05:04:45 INFO - TEST-OK | dromaeo_css | took 1124030ms 05:04:45 INFO - TEST-START | kraken 05:04:45 INFO - operating with platform_type : linux_ 05:04:45 INFO - Initialising browser for kraken test... 05:04:45 INFO - TEST-INFO | started process 9967 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpI9V6Yj/profile http://localhost:36027/getInfo.html) 05:04:49 INFO - PID 9967 | __metrics Screen width/height:1600/1200 05:04:49 INFO - PID 9967 | colorDepth:24 05:04:49 INFO - PID 9967 | Browser inner width/height: 1024/697 05:04:49 INFO - PID 9967 | __metrics 05:04:50 INFO - PID 9967 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 05:04:50 INFO - PID 9967 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:04:51 INFO - TEST-INFO | 9967: exit 0 05:04:51 INFO - Browser initialized. 05:04:51 INFO - Running cycle 1/1 for kraken test... 05:04:51 INFO - TEST-INFO | started process 10059 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpI9V6Yj/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:05:03 INFO - PID 10059 | RSS: Main: 149254144 05:05:03 INFO - PID 10059 | 05:05:06 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:36027/tests/kraken/driver.html?testName=audio-beat-detection) 05:05:07 INFO - PID 10059 | RSS: Main: 202694656 05:05:07 INFO - PID 10059 | 05:05:10 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:36027/tests/kraken/driver.html?testName=audio-dft) 05:05:10 INFO - PID 10059 | RSS: Main: 183652352 05:05:10 INFO - PID 10059 | 05:05:13 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:36027/tests/kraken/driver.html?testName=audio-fft) 05:05:14 INFO - PID 10059 | RSS: Main: 265859072 05:05:14 INFO - PID 10059 | 05:05:16 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:36027/tests/kraken/driver.html?testName=audio-oscillator) 05:05:17 INFO - PID 10059 | RSS: Main: 175591424 05:05:17 INFO - PID 10059 | 05:05:19 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:36027/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:05:20 INFO - PID 10059 | RSS: Main: 181030912 05:05:20 INFO - PID 10059 | 05:05:23 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:36027/tests/kraken/driver.html?testName=imaging-darkroom) 05:05:23 INFO - PID 10059 | RSS: Main: 218853376 05:05:23 INFO - PID 10059 | 05:05:27 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:36027/tests/kraken/driver.html?testName=imaging-desaturate) 05:05:28 INFO - PID 10059 | RSS: Main: 213766144 05:05:28 INFO - PID 10059 | 05:05:31 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:36027/tests/kraken/driver.html?testName=json-parse-financial) 05:05:31 INFO - PID 10059 | RSS: Main: 215195648 05:05:31 INFO - PID 10059 | 05:05:33 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:36027/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:05:33 INFO - PID 10059 | RSS: Main: 179707904 05:05:33 INFO - PID 10059 | 05:05:35 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:36027/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:05:36 INFO - PID 10059 | RSS: Main: 187375616 05:05:36 INFO - PID 10059 | 05:05:38 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:36027/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:05:39 INFO - PID 10059 | RSS: Main: 196894720 05:05:39 INFO - PID 10059 | 05:05:41 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:36027/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:05:42 INFO - PID 10059 | RSS: Main: 206000128 05:05:42 INFO - PID 10059 | 05:05:45 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:36027/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:05:46 INFO - PID 10059 | RSS: Main: 202252288 05:05:46 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | Cycle 1(1): loaded http://localhost:36027/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:36027/tests/kraken/driver.html?testName=ai-astar) 05:05:48 INFO - PID 10059 | RSS: Main: 271003648 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | __start_tp_report 05:05:48 INFO - PID 10059 | _x_x_mozilla_page_load 05:05:48 INFO - PID 10059 | _x_x_mozilla_page_load_details 05:05:48 INFO - PID 10059 | |i|pagename|runs| 05:05:48 INFO - PID 10059 | |0;ai-astar;105;113;112;112;115;111;113;112;112;112 05:05:48 INFO - PID 10059 | |1;audio-beat-detection;150;130;124;164;131;130;130;133;153;130 05:05:48 INFO - PID 10059 | |2;audio-dft;164;164;164;167;166;165;167;167;164;166 05:05:48 INFO - PID 10059 | |3;audio-fft;76;75;77;107;75;76;75;76;97;74 05:05:48 INFO - PID 10059 | |4;audio-oscillator;84;84;109;86;85;85;102;85;84;110 05:05:48 INFO - PID 10059 | |5;imaging-gaussian-blur;114;114;113;113;114;114;113;114;114;115 05:05:48 INFO - PID 10059 | |6;imaging-darkroom;151;150;151;150;151;150;151;150;155;150 05:05:48 INFO - PID 10059 | |7;imaging-desaturate;94;95;95;94;96;95;96;95;94;95 05:05:48 INFO - PID 10059 | |8;json-parse-financial;53;53;52;53;60;53;53;52;54;54 05:05:48 INFO - PID 10059 | |9;json-stringify-tinderbox;56;56;56;56;56;57;57;57;57;56 05:05:48 INFO - PID 10059 | |10;stanford-crypto-aes;88;82;84;84;82;81;82;82;84;83 05:05:48 INFO - PID 10059 | |11;stanford-crypto-ccm;138;140;145;144;145;135;134;136;181;143 05:05:48 INFO - PID 10059 | |12;stanford-crypto-pbkdf2;196;197;210;197;196;196;199;200;188;202 05:05:48 INFO - PID 10059 | |13;stanford-crypto-sha256-iterative;73;71;73;71;71;71;70;71;71;71 05:05:48 INFO - PID 10059 | __end_tp_report 05:05:48 INFO - PID 10059 | __start_cc_report 05:05:48 INFO - PID 10059 | _x_x_mozilla_cycle_collect,2014 05:05:48 INFO - PID 10059 | __end_cc_report 05:05:48 INFO - PID 10059 | __startTimestamp1491048348684__endTimestamp 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | ------- Summary: start ------- 05:05:48 INFO - PID 10059 | Number of tests: 14 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#0] ai-astar Cycles:10 Average:111.70 Median:112.00 stddev:2.58 (2.3%) stddev-sans-first:1.13 05:05:48 INFO - PID 10059 | Values: 105.0 113.0 112.0 112.0 115.0 111.0 113.0 112.0 112.0 112.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#1] audio-beat-detection Cycles:10 Average:137.50 Median:132.00 stddev:13.20 (10.0%) stddev-sans-first:13.20 05:05:48 INFO - PID 10059 | Values: 150.0 130.0 124.0 164.0 131.0 130.0 130.0 133.0 153.0 130.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#2] audio-dft Cycles:10 Average:165.40 Median:166.00 stddev:1.35 (0.8%) stddev-sans-first:1.33 05:05:48 INFO - PID 10059 | Values: 164.0 164.0 164.0 167.0 166.0 165.0 167.0 167.0 164.0 166.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#3] audio-fft Cycles:10 Average:80.80 Median:76.00 stddev:11.45 (15.1%) stddev-sans-first:12.01 05:05:48 INFO - PID 10059 | Values: 76.0 75.0 77.0 107.0 75.0 76.0 75.0 76.0 97.0 74.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#4] audio-oscillator Cycles:10 Average:91.40 Median:84.50 stddev:10.98 (13.0%) stddev-sans-first:11.31 05:05:48 INFO - PID 10059 | Values: 84.0 84.0 109.0 86.0 85.0 85.0 102.0 85.0 84.0 110.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#5] imaging-gaussian-blur Cycles:10 Average:113.80 Median:114.00 stddev:0.63 (0.6%) stddev-sans-first:0.67 05:05:48 INFO - PID 10059 | Values: 114.0 114.0 113.0 113.0 114.0 114.0 113.0 114.0 114.0 115.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#6] imaging-darkroom Cycles:10 Average:150.90 Median:151.00 stddev:1.52 (1.0%) stddev-sans-first:1.62 05:05:48 INFO - PID 10059 | Values: 151.0 150.0 151.0 150.0 151.0 150.0 151.0 150.0 155.0 150.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#7] imaging-desaturate Cycles:10 Average:94.90 Median:95.00 stddev:0.74 (0.8%) stddev-sans-first:0.71 05:05:48 INFO - PID 10059 | Values: 94.0 95.0 95.0 94.0 96.0 95.0 96.0 95.0 94.0 95.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#8] json-parse-financial Cycles:10 Average:53.70 Median:53.00 stddev:2.31 (4.4%) stddev-sans-first:2.44 05:05:48 INFO - PID 10059 | Values: 53.0 53.0 52.0 53.0 60.0 53.0 53.0 52.0 54.0 54.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#9] json-stringify-tinderbox Cycles:10 Average:56.40 Median:56.50 stddev:0.52 (0.9%) stddev-sans-first:0.53 05:05:48 INFO - PID 10059 | Values: 56.0 56.0 56.0 56.0 56.0 57.0 57.0 57.0 57.0 56.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#10] stanford-crypto-aes Cycles:10 Average:83.20 Median:83.50 stddev:1.99 (2.4%) stddev-sans-first:1.12 05:05:48 INFO - PID 10059 | Values: 88.0 82.0 84.0 84.0 82.0 81.0 82.0 82.0 84.0 83.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#11] stanford-crypto-ccm Cycles:10 Average:144.10 Median:143.50 stddev:13.62 (9.5%) stddev-sans-first:14.26 05:05:48 INFO - PID 10059 | Values: 138.0 140.0 145.0 144.0 145.0 135.0 134.0 136.0 181.0 143.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:198.10 Median:198.00 stddev:5.57 (2.8%) stddev-sans-first:5.85 05:05:48 INFO - PID 10059 | Values: 196.0 197.0 210.0 197.0 196.0 196.0 199.0 200.0 188.0 202.0 05:05:48 INFO - PID 10059 | 05:05:48 INFO - PID 10059 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.30 Median:71.00 stddev:0.95 (1.3%) stddev-sans-first:0.78 05:05:48 INFO - PID 10059 | Values: 73.0 71.0 73.0 71.0 71.0 71.0 70.0 71.0 71.0 71.0 05:05:48 INFO - PID 10059 | -------- Summary: end -------- 05:05:48 INFO - PID 10059 | 05:05:50 INFO - TEST-INFO | 10059: exit 0 05:05:50 INFO - TEST-OK | kraken | took 64931ms 05:05:50 INFO - SUITE-END | took 1188s 05:05:50 INFO - Completed test suite (00:19:49) 05:05:50 INFO - javascript benchmark 05:05:50 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6617.672294321192, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2655.867206639668, 2689.462107578485, 2702.0677866136184, 2720.8231464954774, 2726.972730272698, 5092.719900405476, 5211.218317252414, 5215.791368345262, 5235.371755389354, 5292.391374991872, 5157.252198431225, 5158.406783219931, 5176.896462070757, 5183.041137389576, 5191.351081114851, 4588.678792484519, 4599.747013914233, 4628.490866004737, 4630.097131059445, 4667.463241727194, 4636.605888499482, 4669.252919532875, 4670.346151538787, 4675.672702910798, 4678.625709943213, 4662.673612847102, 4664.160451118797, 4669.34629151919, 4670.042641258551, 4673.252279635259, 4652.395188625474, 4657.743824089674, 4666.043461090469, 4734.976325118387, 4739.6208303336, 4718.339432479455, 4725.905481890343, 4726.574608285271, 4733.337332773414, 4771.546703063238, 5235.947640523584, 5236.581073514109, 5279.366476022902, 5291.523762861322, 5310.761015754261, 5156.819511317086, 5515.145152501329, 5546.556275497991, 5613.494785469286, 5614.887702245932, 5721.799737009184, 5751.683657398841, 5752.5110365618975, 5768.048272035109, 5788.160716696056, 5287.576993840484, 5302.178162384759, 5302.416734159239, 5304.469553044664, 5308.708021058879, 5665.745041473144, 5840.269966254218, 5856.414358564195, 5857.495127868585, 5860.882782344329, 5476.479734425223, 5517.117261238182, 5543.0, 5598.97200514003, 5611.775528978795, 5655.208270842086, 5656.830295091154, 5657.20799088128, 5660.575456840754, 5704.11586204139, 5595.356533998561, 5596.552275817925, 5608.0, 5609.4390560943575, 5613.270274864241, 5443.891122177534, 5497.697626630574, 5510.6969116698965, 5595.18869763882, 5600.691961942132, 4628.907421851612, 4642.883927901762, 4643.094596553708, 4645.396098507173, 4675.275332323496, 3973.6821054315587, 3979.900502487403, 3989.2819292527624, 3995.9400608990886, 4038.697097717683, 4652.488226295105, 4715.882102947454, 4727.858164255078, 4748.0978614063215, 4753.667243292936, 5665.065264231438, 5670.177824215466, 5675.631083979528, 5694.743736531866, 5705.5720820938595, 4735.289706543977, 4737.976310118427, 4740.0, 4742.146413645508, 4778.092162489185, 4786.234202527578, 4881.658283920163, 4934.0, 4949.727764972961, 4953.628477864103, 5254.211868219798, 5265.842024739264, 5267.13092339775, 5306.734663266744, 5317.521423071942, 5631.436856314336, 5636.971815140898, 5638.746256418389, 5648.068068768772, 5649.322081350264, 5083.745812709423, 5163.690178589297, 5242.554382877498, 5242.921356179584, 5293.841184764463, 5448.155535891943, 5475.041867673221, 5478.972605136949, 5518.613697041329, 5521.69630670317, 5610.7194640268635, 5667.03660377745, 5671.6029877909805, 5671.631343962629, 5674.801381951777, 5379.784808607612, 5397.946020539902, 5415.160650099241, 5461.371942226695, 5467.781288748405, 5509.917351239655, 5520.337559492887, 5536.114221724505, 5540.196671482693, 5544.61187716856, 5403.972980135074, 5406.621536492407, 5420.674759514442, 5431.158170483582, 5454.0, 5459.143891077053, 5489.478499542537, 5501.312335958005, 5508.889822203453, 5512.724363781715, 5252.028374750684, 5282.366116066097, 5340.145576707708, 5367.1680889462195, 5398.8110416136815], "value": 5094.813225548892, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [685.1401491128632, 748.2891253309356, 770.5607803551974, 1074.8763892152406, 1091.677955003274, 27663.17010489686, 28412.147635570913, 28438.85780571094, 28448.57327140092, 28457.288567785814, 33298.16754581137, 33987.49018764721, 34062.8296858516, 34095.488567671506, 34162.658373416256, 7162.498625096232, 7309.963450182741, 7315.817104572375, 7316.817079573027, 7319.12170539536, 5524.889502209953, 7133.500654954155, 7230.963845180767, 7240.588085323364, 7247.528910620819, 5729.684867332295, 7100.431965442752, 7316.122065352165, 7323.926760732378, 7324.670389832444, 7329.157146928118, 7387.224341444125, 7395.926040739631, 7400.888986665204, 7405.81485462865, 5522.502974732253, 7201.927980720178, 7286.417086633057, 7290.81772955675, 7292.562446253189, 26115.608265876028, 26394.73605263961, 26406.6039009415, 31280.0, 31770.364592708018, 2646.073874144053, 2651.164883061829, 2658.601209818543, 2659.2155314182364, 2676.7992400570033, 23548.64677029846, 23741.525169496686, 23812.761872381227, 24010.7598924012, 24054.278371648703, 2618.3061488705316, 2651.4962157190266, 2652.244110428538, 2653.2173008962404, 2671.679398472176, 145366.0, 145959.0, 146222.2688886549, 146349.2682536591, 146362.0, 42477.362839557434, 42535.361969570484, 42558.57441425546, 42587.36118958218, 42653.57346426558, 44314.556854431685, 44542.77728611336, 44627.10745785066, 44652.0, 44724.329135063, 12551.623451296477, 12891.806622900664, 13035.869641303465, 13100.803487947689, 13127.540536081191, 10567.89432105669, 10570.947145264377, 10573.471326433648, 10586.100181484506, 10589.258751887293, 11303.886961130283, 11550.768984620428, 13069.0, 13088.345582721016, 13161.868381316255, 5152.355955505562, 5409.83770486886, 5422.240886275925, 5446.537044351196, 5451.127819548853, 870.6386849457531, 902.3863772634671, 912.5802131019673, 916.5783739479781, 936.3305236755616, 20448.284310049374, 21150.576988460143, 21234.681479777817, 21285.255016074672, 21447.0, 956.1920177450044, 969.9951500242454, 973.6202880876464, 1003.3979612232602, 1005.9044390782864, 10820.78358432827, 11237.55049797999, 11277.0, 11304.378259195659, 11355.261907975955, 205020.0, 207486.0, 208215.0, 208268.0, 236710.0, 48038.51961480411, 48526.75736621294, 48698.0, 48717.75641121772, 48746.75626621915, 1216.416120262279, 1237.8019516877257, 1239.9876001240052, 1254.5922575163108, 1258.8552316483722, 23972.52054958926, 24258.393540161636, 25050.874745626155, 25132.874335628938, 25397.238082857544, 31394.52908206333, 31545.0, 31574.210644734067, 31586.842065789522, 31595.526067109473, 240351.0, 240621.0, 241350.0, 241447.0, 242109.78902110353, 28647.713522864506, 28811.135665930055, 29030.27424314409, 29323.70676293295, 29335.853320734113, 26522.0, 31960.36079278448, 33826.49260261147, 33860.0, 35011.29977400387, 24972.37569060788, 25934.481310374063, 26253.868730656224, 27066.72933270642, 27330.0, 25152.49695006126, 25854.095106671175, 25885.6117158239, 26261.4747705041, 26856.32859178536, 28095.297617558906, 28193.295167620974, 28234.294142645776, 28433.573496397985, 29036.419271614872, 25629.743702562737, 25646.102386416387, 25656.743432565436, 25902.611460827724, 26109.869450652626, 19942.0, 20893.686594701394, 21001.26495572709, 21021.57956840885, 21026.789732103094], "value": 14635.211321128714, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [413.73314212333065, 422.5605370414769, 423.6166269526079, 431.9157764235973, 437.44881449373787, 18187.27250909962, 18196.81803181968, 18305.45083647491, 19001.71497427536, 19149.329773457932, 18818.0, 19015.429537113872, 19606.411807645793, 19774.901125494387, 19796.0, 5658.632188907708, 5679.687617181054, 5850.122481627747, 5868.559858010645, 5901.645901245939, 5598.048331783607, 5678.716064196794, 5723.51350135239, 5731.684757338345, 5732.5127364174095, 5637.633553819009, 5743.282089738783, 5781.248437703114, 5788.536917046647, 5790.420957904197, 5616.382197958263, 5654.802081927154, 5753.827385178431, 5818.156367326735, 5824.941750582503, 5169.508896654812, 5171.818986335498, 5171.948280517185, 5176.2235664650225, 5176.7929282828645, 22712.54574908509, 22832.315030548943, 22898.42753931165, 23026.424339391648, 23040.539189216288, 1547.9071255724693, 1575.086449859079, 1582.9366825326972, 1633.7631043498745, 1634.9591260218472, 13821.378037988316, 14528.0, 14545.636359091002, 14604.634884127876, 14912.17983010934, 1828.3235202974984, 1879.4643526594855, 1903.1626084522904, 1910.4650697804636, 1991.0, 72171.90286870109, 75626.24373756247, 76137.0, 76328.23671763322, 90416.0, 8566.729816598607, 10513.0, 11296.43517824122, 11378.943105284421, 11399.259048161843, 15688.137152456724, 15690.137042462775, 15753.054816711034, 15815.446459373867, 15817.209139542976, 7747.573883436465, 7767.689292428353, 7982.201779822088, 8020.518768873886, 8025.478343907627, 7239.384652304508, 7247.565146091251, 7266.96366518164, 7401.707009934225, 7441.293077157661, 7035.637904499244, 7076.433885289164, 7108.075950126554, 7148.713231618359, 7163.570185788869, 2053.2813515269836, 2053.4455696961736, 2071.4510654676524, 2075.3877606105934, 2076.0761461149646, 810.9716159934374, 848.3891598049395, 873.5675840459013, 874.0734821089666, 893.8748575199477, 16815.579610509834, 17159.571010724583, 17341.132943353034, 17606.943583384997, 17805.109744512723, 866.2723312417473, 875.8248350329959, 875.9343049271203, 882.5940067568862, 897.0536084430988, 9084.0, 9487.47818869955, 9586.616535338508, 9591.136797688241, 9777.951110244545, 454128.0, 465389.0, 471852.0, 474353.0, 475141.0, 87757.5612121948, 92896.53551732199, 94366.52816735873, 94935.52532237433, 95051.52474237584, 962.9807403851884, 1054.7890421915647, 1069.550788668761, 1128.785530749155, 1138.6697857621198, 17692.82307176963, 17703.78702662167, 18333.79158647205, 18503.259869605605, 18594.2562297512, 43108.353374698774, 43218.0, 43767.343489847044, 44998.55001449944, 45996.310055349866, 53732.731336343066, 54064.189037163684, 54302.45697542974, 54893.72553137209, 57429.13856292075, 8127.2279133482225, 8322.625481853453, 8339.749807505785, 8727.519986400808, 8748.956255218684, 12722.936385318015, 13157.276349800853, 13270.336483175995, 13609.0, 13950.09324393911, 11442.771144576895, 11526.481308340977, 11557.0, 11723.237989530995, 12095.516179352728, 10346.482675866026, 10430.113440357654, 10488.475576221312, 10522.368657880552, 10758.0, 11741.76516469683, 11945.880541194825, 11992.40037998114, 12097.274163550215, 12109.728478509629, 8057.194280571896, 8314.334853211607, 8411.411201215857, 8434.957825210835, 8557.657693692432, 10330.741731456474, 11255.0, 11355.772884542428, 11417.714557135805, 11844.881551184379], "value": 9136.531309922813, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1212.2423485321674, 1279.9680007999798, 1296.598054603073, 1310.4954592481893, 1312.8949684025276, 9535.475548844819, 9978.351407158547, 9985.650502232424, 9992.300538962276, 9996.050375214352, 9662.92247166859, 9990.45052522111, 10038.849417258747, 10049.69850904474, 10055.899441005588, 2209.734831820184, 2254.0532976150057, 2259.1641092795608, 2259.288324177887, 2262.8529145605567, 1865.7761068671712, 1942.854285928554, 2135.2099723102474, 2227.5878962392007, 2290.679304897316, 2169.8481106322565, 2249.8875056247202, 2253.278950735765, 2257.119723307911, 2262.5248697773486, 2129.2015494189677, 2187.3547303545492, 2193.846430749848, 2195.879226642542, 2291.9083236670513, 2184.9890750546306, 2193.451637090727, 2194.7585765565773, 2195.10000899632, 2195.7255343082115, 9764.707058788248, 9855.162311203556, 9856.112949834549, 9860.0, 9860.950695246478, 5492.286002819648, 5698.800541981011, 5700.743466543974, 5706.343770466408, 5719.59962802604, 2843.3744576193203, 3012.3523442459978, 3072.339447018902, 3084.8611812468494, 3088.274255549944, 940.1256831147031, 949.3307218411004, 954.0602506531061, 994.5524513968743, 1004.9899501004969, 14247.0, 14390.136591804421, 14407.711845763131, 14413.639659008504, 14432.061915975533, 4549.135664223787, 4900.240462728283, 4906.9263961040615, 4936.703797772073, 4945.060438516671, 10558.31370960885, 10565.524551395205, 10598.523066462029, 10610.151187904949, 10623.256372053882, 5476.151196564539, 5479.3424789024775, 5492.313460817398, 5494.615376923577, 5528.143137813645, 4901.411830580353, 5050.368703912011, 5129.487051294841, 5201.141811601044, 5209.947900521022, 3745.775253484745, 3891.4357418174204, 3909.198614284065, 3971.4241434991764, 3972.6424621784176, 993.2798720927415, 1132.8753837077916, 1135.7387800805695, 1135.8807325230896, 1168.3515648814819, 625.4933503861887, 703.9753608623776, 728.0753443127198, 735.02976071585, 741.7218543046357, 5500.064988951888, 5580.358258800209, 5603.159526071122, 5651.660900345993, 5765.8558536036935, 803.1807556292549, 820.261764412022, 833.1168960901464, 834.1533343656193, 842.7219017724259, 3759.9436008459893, 3918.8243526941806, 3987.4018897165656, 4004.479417675742, 4019.33680942647, 11969.281843089442, 12872.22766634005, 12940.0, 12943.158694684815, 12961.092723509264, 12704.936475317565, 12845.678858028437, 12846.871531284567, 13014.739705205842, 13046.217226966412, 9234.907650923406, 9416.482093484925, 9468.289878259158, 9469.526523673789, 9506.762330941643, 5875.588708790344, 5879.529637628894, 5989.760409583568, 5990.251218597676, 6077.331493535796, 11538.076953843505, 11572.710682233012, 11643.941780291045, 11644.475998580254, 11795.646130616095, 11522.654320370402, 12108.394580270775, 12176.269423834598, 12183.512659493521, 12199.3290369027, 7458.92541074604, 7561.773146805384, 7563.546187228784, 7567.394608431202, 7572.8485430292185, 8873.825912651184, 9067.09329067088, 9160.770980725269, 9183.265338772748, 9187.54062296869, 7843.568603726621, 7974.720884769005, 8016.8797468036855, 8087.716929907425, 8239.340852731648, 7549.471536992358, 7707.34487568563, 7711.305982461606, 7735.265149810759, 7801.45389822707, 7186.1376634804155, 7313.451491138079, 7319.085114360705, 7321.121465424183, 7323.414126869944, 5045.8738531537, 5077.974610126926, 5133.7689803958165, 5157.484251574812, 5405.675659460445, 5367.543758780547, 5412.78348866041, 5540.307461567304, 5541.5289700375915, 5639.555394346513], "value": 4683.846352132062, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [371.7917965939074, 386.7930657098452, 388.06282826972864, 390.13974186917847, 390.6464649492209, 5322.574194064475, 5342.893142137155, 5358.517733403993, 5359.866003349918, 5371.623986320959, 5022.949770502294, 5185.55922746567, 5193.80542475231, 5227.895442091156, 5237.711925844077, 3977.403389491578, 3978.3688687637928, 3992.4410582518326, 3993.700472464562, 4000.2999475091888, 3967.821448034845, 3974.9006274843214, 3983.741056831311, 3985.6213659702426, 3994.5206575211014, 3865.9806700966456, 3867.3425517662067, 3954.4661470701517, 3955.406688996645, 3975.880723578283, 3927.9607203928167, 3933.311670457673, 3936.881893543198, 3940.3695408734466, 3951.897760258212, 3414.095264754817, 3437.9656203437894, 3441.4493681011168, 3446.6897979181995, 3450.896473105811, 4974.552290293855, 5087.3386459759995, 5106.923396149061, 5112.846614601568, 5120.487951204887, 4638.5593368629925, 4640.257558790578, 4653.348531205634, 4664.463586687541, 4670.159371313162, 5513.173024046385, 5562.360328562227, 5570.832875013715, 5575.54675942584, 5603.579731520153, 3770.377887648562, 3879.631435013669, 3886.9222615547815, 3894.279558281727, 3910.8240129194255, 5629.0034075806225, 5724.942750572524, 5775.249217601727, 5824.796132135355, 5897.233359663259, 3943.171933893857, 3943.507061617298, 3949.4865667463046, 3958.089639382958, 3961.3859851723028, 4008.719389642697, 4011.7793521356607, 4014.498187726534, 4021.276170289376, 4024.4566983457444, 4453.643708503312, 4470.776461176928, 4578.862634120982, 4650.09323181983, 4661.68567832671, 5534.501894829485, 5556.694381809039, 5585.692786896679, 5597.160425936142, 5597.272354593877, 1401.9158850469005, 1411.2449839336111, 1415.3418660323, 1416.5467050543932, 1418.1207651256286, 910.5583791860943, 944.730751735752, 948.0898337595847, 962.3552220012608, 963.9566219520138, 4777.856664300077, 4782.258749893772, 4782.689125206851, 4783.784729687172, 4790.592799612072, 5772.307323121252, 5772.6536407815665, 5774.335951365647, 5784.421557844182, 5798.971005144947, 4683.718976861399, 4766.475687674353, 4790.880227994328, 4803.471618122004, 4823.421189457287, 3023.425549145655, 3038.5745995560637, 3044.4777611194404, 3047.756179505634, 3057.480228361184, 5346.311045378677, 5349.4650534946195, 5368.4631536846, 5379.1662292344745, 5402.0, 5678.744456499468, 5853.560982926298, 5860.824175274749, 5872.530197584183, 5901.3508514063415, 5350.090484617546, 5355.9020400817735, 5376.843978544632, 5388.380336261223, 5390.407055223922, 5545.667259964415, 5749.942500575108, 5754.741036653444, 5779.0062428462115, 5784.94215057844, 5658.971705141448, 5667.971660141838, 5691.402402747652, 5691.686957217227, 5701.717113649562, 5165.819196328111, 5226.346706661668, 5294.814681486129, 5359.3032905722, 5383.973080134574, 4033.9394909076973, 4035.858744943913, 4035.9798201008807, 4040.252553277653, 4047.2310261050307, 5790.0, 5805.564582656233, 5809.128630705428, 5809.50619197373, 5816.69564522242, 5401.756920938488, 5596.356419011703, 5608.775648974159, 5612.522935550524, 5637.295338082739, 5551.555875530029, 5569.053260945568, 5588.441155884379, 5604.747786349542, 5618.185363122243, 5386.48828361305, 5511.614187006871, 5520.861978450571, 5529.281193444826, 5562.915231529812, 5598.888022239614, 5600.551955843442, 5636.436356364495, 5639.7744090237575, 5651.180578816131, 5444.455554444524, 5482.616216864782, 5497.202905578749, 5498.0, 5514.6691198528215], "value": 4166.980024532517, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [642.1844257792601, 650.0996120373281, 652.6573548886834, 652.7389044382248, 676.8646270745852, 12351.629451116458, 12731.04517161212, 12777.041721870874, 12860.099793014493, 12884.935575322123, 13071.281079540622, 13426.39581218845, 13473.528426505074, 13508.257045862498, 13508.932455337734, 882.9470231786081, 897.3270047464401, 901.6483571407157, 902.9638814447414, 903.1555495611624, 897.5153417154729, 907.314977192219, 911.7583840282331, 935.2611436964789, 943.4103685196752, 989.1938070472578, 992.4938281476462, 992.5483904823324, 993.4089216915924, 999.605155963394, 991.9752006199831, 992.1071036067561, 993.2451336983872, 993.8161440133526, 994.0854413939157, 730.7369347035063, 734.3611058379191, 734.6326836581709, 734.8971144039785, 734.9595772232525, 14254.144751314954, 14553.854461455461, 14608.926955365156, 14624.049436786574, 14647.560573182822, 14005.509807156803, 14811.555653330417, 14968.326425310886, 14989.175595342253, 15255.923720381437, 9910.35582687123, 10052.798944021079, 10311.175105991502, 10588.735281617945, 10697.572097116185, 2646.722094180122, 2665.466906618684, 2666.4267182555845, 2689.0588294097106, 2737.0693964052316, 58613.0, 59559.70220148915, 72302.27697723008, 72425.0, 73750.0, 10704.94647526773, 10812.0, 11168.441577921072, 11300.157946298297, 11772.587959421378, 21346.57306853885, 21456.356309310744, 21731.891340543196, 21741.67387489189, 21963.23128690488, 6550.951847704345, 6640.734370625218, 6679.265280819106, 6728.529002969745, 6741.966290168616, 3230.418524665583, 3269.476883698597, 3286.8520916558814, 3323.6011678598725, 3359.798412095282, 3586.6951309138494, 3668.9816550917076, 3701.7038636908983, 3702.3705969985167, 3728.2729867676085, 694.2952902803659, 702.2029995954526, 702.6873041496485, 709.5671640299413, 724.3372314332327, 553.0929275987384, 557.8382269141985, 561.9297587801525, 568.9544836413077, 570.3147200023919, 8423.957880210559, 9188.954055229815, 9290.72127836166, 9449.480278584744, 9450.43297402158, 531.7607076815449, 546.1561886884773, 562.839590716652, 564.8136115082013, 565.7567246084141, 3836.2519308734527, 3911.882643520699, 3939.862104826317, 4082.2039702258367, 4104.958950410517, 62995.6850215746, 63754.362456374845, 65183.0, 65653.67173164104, 66751.0, 57240.42759572351, 57375.42624573784, 57998.7100064497, 58382.70808645929, 58902.705486472296, 48712.51287487151, 50263.0, 50601.999999999265, 51137.74431127895, 52331.215031774555, 7768.53388796674, 8142.10436851934, 8227.83544329098, 8244.752657420288, 8283.95858020706, 27180.184594461407, 27287.317817054733, 27402.725972740816, 27535.31161720973, 28446.715532844406, 32323.545440454767, 33094.0, 33343.0, 34035.48946765751, 34476.482852757734, 9966.352187107816, 10005.899941000496, 10066.949665251626, 10379.84430233532, 10609.469526523488, 11463.770724585294, 11585.942070289595, 11598.71003224926, 12130.6500559015, 12278.386080696107, 10799.67600971972, 11032.724181895195, 11184.832227516756, 11619.883801161881, 11641.825372619249, 10957.945210273898, 11001.889981100087, 11013.889861101286, 11023.543545339855, 11130.499127539118, 9725.221982241545, 9764.218862491125, 10035.046670566284, 10228.232882533988, 10275.126614237874, 7776.572288524186, 7873.448858579844, 8012.3590112792, 8096.635651395819, 8108.0, 8981.191692747683, 9099.1810737034, 9134.954325228331, 9172.174504294646, 9228.861567076634], "value": 6316.3252937231055, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1553.1999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 113.0, 112.0, 112.0, 115.0, 111.0, 113.0, 112.0, 112.0, 112.0], "value": 111.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 130.0, 124.0, 164.0, 131.0, 130.0, 130.0, 133.0, 153.0, 130.0], "value": 137.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 164.0, 164.0, 167.0, 166.0, 165.0, 167.0, 167.0, 164.0, 166.0], "value": 165.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 77.0, 107.0, 75.0, 76.0, 75.0, 76.0, 97.0, 74.0], "value": 80.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 109.0, 86.0, 85.0, 85.0, 102.0, 85.0, 84.0, 110.0], "value": 91.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 113.0, 113.0, 114.0, 114.0, 113.0, 114.0, 114.0, 115.0], "value": 113.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 150.0, 151.0, 150.0, 151.0, 150.0, 151.0, 150.0, 155.0, 150.0], "value": 150.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 95.0, 94.0, 96.0, 95.0, 96.0, 95.0, 94.0, 95.0], "value": 94.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 53.0, 52.0, 53.0, 60.0, 53.0, 53.0, 52.0, 54.0, 54.0], "value": 53.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 56.0, 56.0, 56.0, 56.0, 57.0, 57.0, 57.0, 57.0, 56.0], "value": 56.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 82.0, 84.0, 84.0, 82.0, 81.0, 82.0, 82.0, 84.0, 83.0], "value": 83.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [138.0, 140.0, 145.0, 144.0, 145.0, 135.0, 134.0, 136.0, 181.0, 143.0], "value": 144.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [196.0, 197.0, 210.0, 197.0, 196.0, 196.0, 199.0, 200.0, 188.0, 202.0], "value": 198.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 71.0, 73.0, 71.0, 71.0, 71.0, 70.0, 71.0, 71.0, 71.0], "value": 71.3, "unit": "score"}]}]} 05:05:50 INFO - Return code: 0 05:05:50 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:05:50 ERROR - # TBPL SUCCESS # 05:05:50 INFO - Running post-action listener: _resource_record_post_action 05:05:50 INFO - [mozharness: 2017-04-01 12:05:50.488642Z] Finished run-tests step (success) 05:05:50 INFO - Running post-run listener: _resource_record_post_run 05:05:50 INFO - Total resource usage - Wall time: 1205s; CPU: 13.0%; Read bytes: 4096; Write bytes: 365490176; Read time: 20; Write time: 310960 05:05:50 INFO - TinderboxPrint: CPU usage
13.0% 05:05:50 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 20 05:05:50 INFO - TinderboxPrint: I/O write bytes / time
365,490,176 / 310,960 05:05:50 INFO - TinderboxPrint: CPU idle
8,365.7 (87.0%) 05:05:50 INFO - TinderboxPrint: CPU user
1,204.6 (12.5%) 05:05:50 INFO - TinderboxPrint: Swap in / out
0 / 0 05:05:50 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 105746432; Read time: 0; Write time: 131708 05:05:50 INFO - run-tests - Wall time: 1190s; CPU: 13.0%; Read bytes: 4096; Write bytes: 259743744; Read time: 20; Write time: 179252 05:05:51 INFO - Running post-run listener: _upload_blobber_files 05:05:51 INFO - Blob upload gear active. 05:05:51 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:05:51 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:05:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:05:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:05:51 INFO - (blobuploader) - INFO - Open directory for files ... 05:05:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 05:05:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:05:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:05:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:05:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:05:52 INFO - (blobuploader) - INFO - Done attempting. 05:05:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:05:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:05:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:05:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:05:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:05:52 INFO - (blobuploader) - INFO - Done attempting. 05:05:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:05:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:05:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:05:57 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:05:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:05:57 INFO - (blobuploader) - INFO - Done attempting. 05:05:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 05:05:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:05:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:05:59 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 05:05:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:05:59 INFO - (blobuploader) - INFO - Done attempting. 05:05:59 INFO - (blobuploader) - INFO - Iteration through files over. 05:05:59 INFO - Return code: 0 05:05:59 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:05:59 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:05:59 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/65e9263f57231b850520a3cd723d5a10430dc0c4c41ef0b2bea68702406dea9bbf5854a5420f37ecd5f228b99c4c811f6c35309459258a26efc92241ac7b75c2", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ed2f692ba9e6bb61f7fac24b0bb8e4ca09b637dd559219ea65873facf6aa8dc454c287a06ecc359da587433fd97adca2e5451bbd590c1c3dc42cbb245a358584", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/470784d97d8884c2023207628f109ec58778650ad08b35c670b752571d590f68550afb68cd1ab31b484b7a9334e7a245888d52c2fb652e42e306ffd5a1c8a165", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/462c70ed7fd6da94c6dcdcf22c5c576dc309c978ef1c7865d8264ac9b78df84546b1ad66f8a693608ba4c4b73ad551d6f784978f2d803191c3546564e50e3314"} 05:05:59 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:05:59 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:05:59 INFO - Contents: 05:05:59 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/65e9263f57231b850520a3cd723d5a10430dc0c4c41ef0b2bea68702406dea9bbf5854a5420f37ecd5f228b99c4c811f6c35309459258a26efc92241ac7b75c2", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ed2f692ba9e6bb61f7fac24b0bb8e4ca09b637dd559219ea65873facf6aa8dc454c287a06ecc359da587433fd97adca2e5451bbd590c1c3dc42cbb245a358584", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/470784d97d8884c2023207628f109ec58778650ad08b35c670b752571d590f68550afb68cd1ab31b484b7a9334e7a245888d52c2fb652e42e306ffd5a1c8a165", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/462c70ed7fd6da94c6dcdcf22c5c576dc309c978ef1c7865d8264ac9b78df84546b1ad66f8a693608ba4c4b73ad551d6f784978f2d803191c3546564e50e3314"} 05:05:59 INFO - Running post-run listener: copy_logs_to_upload_dir 05:05:59 INFO - Copying logs to upload dir... 05:05:59 INFO - mkdir: /builds/slave/test/build/upload/logs 05:05:59 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1266.086465 ========= master_lag: 0.10 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2017-04-01 05:05:58.767195) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-01 05:05:58.769325) ========= 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=5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/65e9263f57231b850520a3cd723d5a10430dc0c4c41ef0b2bea68702406dea9bbf5854a5420f37ecd5f228b99c4c811f6c35309459258a26efc92241ac7b75c2", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ed2f692ba9e6bb61f7fac24b0bb8e4ca09b637dd559219ea65873facf6aa8dc454c287a06ecc359da587433fd97adca2e5451bbd590c1c3dc42cbb245a358584", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/470784d97d8884c2023207628f109ec58778650ad08b35c670b752571d590f68550afb68cd1ab31b484b7a9334e7a245888d52c2fb652e42e306ffd5a1c8a165", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/462c70ed7fd6da94c6dcdcf22c5c576dc309c978ef1c7865d8264ac9b78df84546b1ad66f8a693608ba4c4b73ad551d6f784978f2d803191c3546564e50e3314"} build_url:https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011311 build_url: 'https://queue.taskcluster.net/v1/task/ApBbcpfuQhG--UwXH3UUZQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/65e9263f57231b850520a3cd723d5a10430dc0c4c41ef0b2bea68702406dea9bbf5854a5420f37ecd5f228b99c4c811f6c35309459258a26efc92241ac7b75c2", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ed2f692ba9e6bb61f7fac24b0bb8e4ca09b637dd559219ea65873facf6aa8dc454c287a06ecc359da587433fd97adca2e5451bbd590c1c3dc42cbb245a358584", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/470784d97d8884c2023207628f109ec58778650ad08b35c670b752571d590f68550afb68cd1ab31b484b7a9334e7a245888d52c2fb652e42e306ffd5a1c8a165", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/462c70ed7fd6da94c6dcdcf22c5c576dc309c978ef1c7865d8264ac9b78df84546b1ad66f8a693608ba4c4b73ad551d6f784978f2d803191c3546564e50e3314"}' ========= master_lag: 0.22 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-01 05:05:58.998247) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-01 05:05:58.998574) ========= 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=5cf47e208febbcd81da23b2e0000026f-1491041110.287379-302775908 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004445 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-01 05:05:59.056733) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-01 05:05:59.057068) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-01 05:05:59.057387) ========= ========= Total master_lag: 0.43 =========